activate_scenario.sh
Mon May 27 06:46:56 CEST 2024
scenario: vorraumOn
phoneName: 0
'day' <--> DayTime=checked , NightTime=checked
-> execution of scenario
-> sending email(s) to 'thomas@miglinci.name'
scenario: 'Vorzimmer EIN' - 'vorraumOn' - 'vorraumon'
Licht Vorzimmer (/srv/www/viehai/shelly/log_scenarios/2024/05/27/_0.log)
vorher: 06:46:56.984
http://192.168.12.103/relay/0?turn=on |
|---|
"ison": true,
"has_timer": false,
"timer_started": 0,
"timer_duration": 0,
"timer_remaining": 0,
"overpower": false,
"source": "http"
|
nachher: 06:46:57.011
Dauer: 27 msec
phName: 'phoneName:'0''
scenario: 'Vorzimmer EIN' - 'vorraumOn' - 'vorraumon'
urls : 1
vorher : 06:46:56.966
nachher: 06:46:57.018
Dauer : 51 msec
outfile: '/srv/www/viehai/shelly/log_scenarios/2024/05/27//scene_vorraumOn_20240527_064656.txt'
syslog
May 27 06:43:01 srv4hai CRON[8130]: (root) CMD (/etc/linetest/linetest.sh)
May 27 06:43:03 srv4hai dovecot: imap-login: Login: user=, method=PLAIN, rip=::1, lip=::1, mpid=8139, secured, session=<+UkVJ2gZMsUAAAAAAAAAAAAAAAAAAAAB>
May 27 06:43:03 srv4hai dovecot: imap(miglincit)<8139><+UkVJ2gZMsUAAAAAAAAAAAAAAAAAAAAB>: Logged out in=226 out=1285 deleted=0 expunged=0 trashed=0 hdr_count=0 hdr_bytes=0 body_count=0 body_bytes=0
May 27 06:43:05 srv4hai ping_SP[26300]: SHELLY (1) - ping 192.168.12.62 1 sucessfully @~1716784985 - 'ping_SP_1'
May 27 06:43:05 srv4hai ping_SP[26300]: SHELLY (1) - ping 192.168.12.62 pCnt:'1'
May 27 06:43:14 srv4hai postfix/smtp[8116]: connect to cdptwcgw01.timewarnercable.com[165.237.59.32]:25: Connection timed out
May 27 06:43:27 srv4hai ping_SP[8008]: SHELLY (0) - ping 192.168.12.61 1 sucessfully @~1716785007 - 'ping_SP_0'
May 27 06:43:27 srv4hai ping_SP[8008]: SHELLY (0) - ping 192.168.12.61 pCnt:'1'
May 27 06:43:44 srv4hai postfix/smtpd[8189]: warning: database /etc/aliases.db is older than source file /etc/aliases
May 27 06:43:44 srv4hai postfix/smtpd[8189]: connect from unknown[194.169.175.212]
May 27 06:43:44 srv4hai postfix/smtp[8116]: connect to cdptwcgw02.timewarnercable.com[165.237.59.33]:25: Connection timed out
May 27 06:43:44 srv4hai postfix/smtpd[8189]: warning: unknown[194.169.175.212]: SASL LOGIN authentication failed: Invalid authentication mechanism
May 27 06:43:44 srv4hai postfix/smtpd[8189]: disconnect from unknown[194.169.175.212] ehlo=1 auth=0/1 quit=1 commands=2/3
May 27 06:43:52 srv4hai dhcpd[22856]: execute_statement argv[0] = /srv/www/viehai/shelly/dhcpcommit.sh
May 27 06:43:52 srv4hai dhcpd[22856]: execute_statement argv[1] = 192.168.12.28
May 27 06:43:52 srv4hai dhcpd[22856]: execute_statement argv[2] = harmonyhub
May 27 06:43:52 srv4hai dhcpd[22856]: DHCPREQUEST for 192.168.12.28 from c8:db:26:0c:f3:8e via enp2s0
May 27 06:43:52 srv4hai dhcpd[22856]: DHCPACK on 192.168.12.28 to c8:db:26:0c:f3:8e via enp2s0
May 27 06:43:52 srv4hai named[15509]: client @0x7f931c6a6030 192.168.12.252#52595/key rndc-key: updating zone 'viehai.at/IN': update unsuccessful: harmonyhub.viehai.at: 'name not in use' prerequisite not satisfied (YXDOMAIN)
May 27 06:43:52 srv4hai named[15509]: client @0x7f93040c2620 192.168.12.252#56259/key rndc-key: signer "rndc-key" approved
May 27 06:43:52 srv4hai named[15509]: client @0x7f93040c2620 192.168.12.252#56259/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'harmonyhub.viehai.at' TXT
May 27 06:43:52 srv4hai named[15509]: client @0x7f93040c2620 192.168.12.252#56259/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'harmonyhub.viehai.at' TXT "3122b5a8b4281156e6f217b32b7e260713"
May 27 06:43:52 srv4hai named[15509]: client @0x7f93040c2620 192.168.12.252#56259/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'harmonyhub.viehai.at' A
May 27 06:43:52 srv4hai named[15509]: client @0x7f93040c2620 192.168.12.252#56259/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'harmonyhub.viehai.at' A 192.168.12.28
May 27 06:43:52 srv4hai dhcpd[22856]: Added new forward map from harmonyhub.viehai.at to 192.168.12.28
May 27 06:43:52 srv4hai dhcpcommit.sh: SHELLY ip:'192.168.12.28'(28) device 'harmonyhub'
May 27 06:43:52 srv4hai named[15509]: client @0x7f931c6b5500 192.168.12.252#45681/key rndc-key: signer "rndc-key" approved
May 27 06:43:52 srv4hai named[15509]: client @0x7f931c6b5500 192.168.12.252#45681/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': deleting rrset at '28.12.168.192.in-addr.arpa' PTR
May 27 06:43:52 srv4hai named[15509]: client @0x7f931c6b5500 192.168.12.252#45681/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': adding an RR at '28.12.168.192.in-addr.arpa' PTR harmonyhub.viehai.at.
May 27 06:43:52 srv4hai dhcpd[22856]: Added reverse map from 28.12.168.192.in-addr.arpa. to harmonyhub.viehai.at
May 27 06:43:52 srv4hai dhcpcommit.sh: SHELLY device 'harmonyhub' known and accepted
May 27 06:44:01 srv4hai CRON[8209]: (root) CMD (/etc/linetest/linetest.sh)
May 27 06:44:02 srv4hai common[8214]: SHELLY common.sh inkludiert von ./bt_scan.sh
May 27 06:44:05 srv4hai named[15509]: resolver priming query complete
May 27 06:44:06 srv4hai named[15509]: resolver priming query complete
May 27 06:44:11 srv4hai named[15509]: resolver priming query complete
May 27 06:44:12 srv4hai bt_scan[8214]: SHELLY - who: 'Thomas' / phoneName: 'FP4_Thomas' / '0' / shellyIP: '192.168.12.61' - found: 'No'
May 27 06:44:12 srv4hai bt_scan[8214]: SHELLY - lost BT-connection to BTmac: '0' found: 'No' - check presence
May 27 06:44:12 srv4hai common[8256]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly//check_presence.sh
May 27 06:44:12 srv4hai common.sh: SHELLY: BTstatus[0]:'Off' dweetAge:'16'=1716785052-1716785036
May 27 06:44:12 srv4hai check_presence[8256]: SHELLY (0) found /srv/www/viehai/shelly//meter/ping_SP_0.LIVE and Off//srv/www/viehai/shelly//meter/BTscan_BTid_0.No
May 27 06:44:12 srv4hai check_presence[8256]: SHELLY (bt_scan)-(0) found '/srv/www/viehai/shelly//meter/ping_SP_0.LIVE' for what: 'presence'
May 27 06:44:12 srv4hai common.sh: SHELLY: BTstatus[1]:'On' dweetAge:'16'=1716785052-1716785036
May 27 06:44:12 srv4hai check_presence[8256]: SHELLY (1) found /srv/www/viehai/shelly//meter/ping_SP_1.LIVE and On//srv/www/viehai/shelly//meter/BTscan_BTid_1.Yes
May 27 06:44:12 srv4hai check_presence[8256]: SHELLY (bt_scan)-(0) found '/srv/www/viehai/shelly//meter/ping_SP_1.LIVE' for what: 'presence'
May 27 06:44:12 srv4hai common.sh: SHELLY: BTstatus[2]:'Off' dweetAge:'16'=1716785052-1716785036
May 27 06:44:12 srv4hai check_presence[8256]: SHELLY (2) found /srv/www/viehai/shelly//meter/ping_SP_2.DEAD and Off//srv/www/viehai/shelly//meter/BTscan_BTid_2.No
May 27 06:44:12 srv4hai check_presence[8256]: SHELLY (bt_scan)-(0) what: 'presence' - persPresent: '(__/LIVE) (BT/LIVE) (__/__)' - anyPresent: 'true' - otherPresent:'true'
May 27 06:44:12 srv4hai check_presence[8256]: SHELLY - check 'presence': anyPresent(true) - lScene(scene_offAll) - sceneOFF(offAll)
May 27 06:44:12 srv4hai check_presence[8256]: SHELLY (bt_scan)-(0)-presence: NOT activate_scenario.shtml: offAll
May 27 06:44:14 srv4hai postfix/smtp[8116]: connect to cdctwcgw01.timewarnercable.com[165.237.91.113]:25: Connection timed out
May 27 06:44:18 srv4hai ping_SP[26300]: SHELLY (1) - ping 192.168.12.62 1 sucessfully @~1716785058 - 'ping_SP_1'
May 27 06:44:18 srv4hai ping_SP[26300]: SHELLY (1) - ping 192.168.12.62 pCnt:'1'
May 27 06:44:40 srv4hai ping_SP[8008]: SHELLY (0) - ping 192.168.12.61 1 sucessfully @~1716785080 - 'ping_SP_0'
May 27 06:44:40 srv4hai ping_SP[8008]: SHELLY (0) - ping 192.168.12.61 pCnt:'1'
May 27 06:44:44 srv4hai postfix/smtp[8116]: connect to cdctwcgw02.timewarnercable.com[165.237.91.114]:25: Connection timed out
May 27 06:44:44 srv4hai postfix/smtp[8116]: 9535C631F3: to=, relay=none, delay=384958, delays=384838/0.01/120/0, dsn=4.4.1, status=deferred (connect to cdctwcgw02.timewarnercable.com[165.237.91.114]:25: Connection timed out)
May 27 06:45:01 srv4hai CRON[8458]: (root) CMD (/etc/linetest/linetest.sh)
May 27 06:45:04 srv4hai named[15509]: resolver priming query complete
May 27 06:45:31 srv4hai ping_SP[26300]: SHELLY (1) - ping 192.168.12.62 1 sucessfully @~1716785131 - 'ping_SP_1'
May 27 06:45:31 srv4hai ping_SP[26300]: SHELLY (1) - ping 192.168.12.62 pCnt:'1'
May 27 06:45:39 srv4hai named[15509]: resolver priming query complete
May 27 06:45:53 srv4hai ping_SP[8008]: SHELLY (0) - ping 192.168.12.61 1 sucessfully @~1716785153 - 'ping_SP_0'
May 27 06:45:53 srv4hai ping_SP[8008]: SHELLY (0) - ping 192.168.12.61 pCnt:'1'
May 27 06:46:01 srv4hai CRON[8529]: (root) CMD (/etc/linetest/linetest.sh)
May 27 06:46:03 srv4hai dovecot: imap-login: Login: user=, method=PLAIN, rip=::1, lip=::1, mpid=8536, secured, session=
May 27 06:46:03 srv4hai dovecot: imap(miglincit)<8536>: Logged out in=137 out=1088 deleted=0 expunged=0 trashed=0 hdr_count=0 hdr_bytes=0 body_count=0 body_bytes=0
May 27 06:46:05 srv4hai dhcpd[22856]: DHCPDISCOVER from e8:78:29:c0:c2:4e via enp2s0
May 27 06:46:05 srv4hai dhcpd[22856]: DHCPOFFER on 192.168.12.61 to e8:78:29:c0:c2:4e via enp2s0
May 27 06:46:05 srv4hai dhcpd[22856]: execute_statement argv[0] = /srv/www/viehai/shelly/smartphone.sh
May 27 06:46:05 srv4hai dhcpd[22856]: execute_statement argv[1] = 192.168.12.61
May 27 06:46:05 srv4hai dhcpd[22856]: execute_statement argv[2] = fpThomas
May 27 06:46:05 srv4hai common[8539]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly/smartphone.sh
May 27 06:46:15 srv4hai smartphone.sh: SHELLY - ping_SP.sh started for phoneIP: '192.168.12.61' / 'fpThomas' / '0'
May 27 06:46:15 srv4hai common[8555]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly//ping_SP.sh
May 27 06:46:15 srv4hai dhcpd[22856]: DHCPREQUEST for 192.168.12.61 (192.168.12.252) from e8:78:29:c0:c2:4e via enp2s0
May 27 06:46:15 srv4hai dhcpd[22856]: DHCPACK on 192.168.12.61 to e8:78:29:c0:c2:4e via enp2s0
May 27 06:46:15 srv4hai dhcpd[22856]: execute_statement argv[0] = /srv/www/viehai/shelly/smartphone.sh
May 27 06:46:15 srv4hai dhcpd[22856]: execute_statement argv[1] = 192.168.12.61
May 27 06:46:15 srv4hai dhcpd[22856]: execute_statement argv[2] = fpThomas
May 27 06:46:15 srv4hai common[8568]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly/smartphone.sh
May 27 06:46:15 srv4hai ping_SP[8555]: SHELLY ping_SP.sh started from smartphone, user:'root'
May 27 06:46:26 srv4hai smartphone.sh: SHELLY - ping_SP.sh started for phoneIP: '192.168.12.61' / 'fpThomas' / '0'
May 27 06:46:26 srv4hai common[8599]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly//ping_SP.sh
May 27 06:46:26 srv4hai common[8608]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly//check_presence.sh
May 27 06:46:26 srv4hai dhcpd[22856]: DHCPREQUEST for 192.168.12.61 (192.168.12.252) from e8:78:29:c0:c2:4e via enp2s0
May 27 06:46:26 srv4hai dhcpd[22856]: DHCPACK on 192.168.12.61 to e8:78:29:c0:c2:4e via enp2s0
May 27 06:46:26 srv4hai dhcpd[22856]: execute_statement argv[0] = /srv/www/viehai/shelly/smartphone.sh
May 27 06:46:26 srv4hai dhcpd[22856]: execute_statement argv[1] = 192.168.12.61
May 27 06:46:26 srv4hai dhcpd[22856]: execute_statement argv[2] = fpThomas
May 27 06:46:26 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone 'viehai.at/IN': update unsuccessful: fpThomas.viehai.at: 'name not in use' prerequisite not satisfied (YXDOMAIN)
May 27 06:46:26 srv4hai common[8620]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly/smartphone.sh
May 27 06:46:26 srv4hai ping_SP[8599]: SHELLY ping_SP.sh started from smartphone, user:'root'
May 27 06:46:26 srv4hai common.sh: SHELLY: BTstatus[0]:'Off' dweetAge:'10'=1716785186-1716785176
May 27 06:46:26 srv4hai check_presence[8608]: SHELLY (0) found /srv/www/viehai/shelly//meter/ping_SP_0.LIVE and Off//srv/www/viehai/shelly//meter/BTscan_BTid_0.No
May 27 06:46:26 srv4hai check_presence[8608]: SHELLY (ping_SP__smartphone)-(0) found '/srv/www/viehai/shelly//meter/ping_SP_0.LIVE' for what: 'coming'
May 27 06:46:26 srv4hai common.sh: SHELLY: BTstatus[1]:'On' dweetAge:'10'=1716785186-1716785176
May 27 06:46:26 srv4hai check_presence[8608]: SHELLY (1) found /srv/www/viehai/shelly//meter/ping_SP_1.LIVE and On//srv/www/viehai/shelly//meter/BTscan_BTid_1.Yes
May 27 06:46:26 srv4hai check_presence[8608]: SHELLY (ping_SP__smartphone)-(0) found '/srv/www/viehai/shelly//meter/ping_SP_1.LIVE' for what: 'coming'
May 27 06:46:26 srv4hai common.sh: SHELLY: BTstatus[2]:'Off' dweetAge:'10'=1716785186-1716785176
May 27 06:46:26 srv4hai check_presence[8608]: SHELLY (2) found /srv/www/viehai/shelly//meter/ping_SP_2.DEAD and Off//srv/www/viehai/shelly//meter/BTscan_BTid_2.No
May 27 06:46:26 srv4hai check_presence[8608]: SHELLY (ping_SP__smartphone)-(0) what: 'coming' - persPresent: '(__/LIVE) (BT/LIVE) (__/__)' - anyPresent: 'true' - otherPresent:'true'
May 27 06:46:26 srv4hai check_presence[8608]: SHELLY - check 'coming': anyPresent(true) - lScene(scene_offAll) - sceneONsmall(vorraumOn)
May 27 06:46:26 srv4hai check_presence[8608]: SHELLY (ping_SP__smartphone)-(0)-coming: activate_scenario.shtml: vorraumOn
May 27 06:46:26 srv4hai activate_scenario[8783]: SHELLY scenario: 'vorraumOn(vorraumon)' started
May 27 06:46:26 srv4hai activate_scenario[8783]: SHELLY dayState='day' <--> DayTime=checked NightTime=checked - phoneName:'0'
May 27 06:46:26 srv4hai activate_scenario[8783]: SHELLY scenario: 'vorraumOn(vorraumon)' TO BE EXECUTED, phoneName:'0'
May 27 06:46:26 srv4hai postfix/pickup[24818]: D574E631B9: uid=33 from=
May 27 06:46:26 srv4hai postfix/cleanup[8833]: D574E631B9: message-id=<20240527044626.D574E631B9@mail.viehai.at>
May 27 06:46:26 srv4hai postfix/qmgr[15291]: D574E631B9: from=, size=13396, nrcpt=1 (queue active)
May 27 06:46:26 srv4hai activate_scenario[8783]: SHELLY: scenario: 'vorraumOn(vorraumon)'-'shelly-03'-'Licht Vorzimmer' --> '0?turn=on'
May 27 06:46:26 srv4hai proc_url[8850]: SHELLY: OF:'/srv/www/viehai/shelly/log_scenarios/2024/05/27/_0.log' - shellyUsage:'Licht Vorzimmer' - scUrl:'http://192.168.12.103/relay/0?turn=on' - phName:'phoneName:'0''
May 27 06:46:26 srv4hai named[15509]: resolver priming query complete
May 27 06:46:26 srv4hai activate_scenario[8783]: SHELLY scenario: 'vorraumOn(vorraumon)' took 53 msec, phoneName:'0'
May 27 06:46:26 srv4hai ping_SP[8555]: SHELLY check_presence.sh coming 0 ping_SP__smartphone
May 27 06:46:27 srv4hai named[15509]: resolver priming query complete
May 27 06:46:27 srv4hai postfix/relay/smtp[8846]: D574E631B9: to=, relay=mx02.nic.name[209.131.158.56]:25, delay=1.1, delays=0.02/0.01/0.78/0.29, dsn=2.0.0, status=sent (250 2.0.0 Ok: queued as BB64E2000D)
May 27 06:46:27 srv4hai postfix/qmgr[15291]: D574E631B9: removed
May 27 06:46:29 srv4hai ping_SP[8555]: SHELLY - running process-id(8555): '8008 /bin/bash /srv/www/viehai/shelly//ping_SP.sh 192.168.12.61 bt_scan#0128555 /bin/bash /srv/www/viehai/shelly//ping_SP.sh 192.168.12.61 smartphone#0128599 /bin/bash /srv/www/viehai/shelly//ping_SP.sh 192.168.12.61 smartphone#0128620 /bin/bash /srv/www/viehai/shelly/smartphone.sh 192.168.12.61 fpThomas' - 'ping_SP_0' - exiting ==============
May 27 06:46:36 srv4hai smartphone.sh: SHELLY - ping_SP.sh started for phoneIP: '192.168.12.61' / 'fpThomas' / '0'
May 27 06:46:36 srv4hai common[8898]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly//ping_SP.sh
May 27 06:46:36 srv4hai dhcpd[22856]: DHCPREQUEST for 192.168.12.61 (192.168.12.252) from e8:78:29:c0:c2:4e via enp2s0
May 27 06:46:36 srv4hai dhcpd[22856]: DHCPACK on 192.168.12.61 to e8:78:29:c0:c2:4e via enp2s0
May 27 06:46:36 srv4hai dhcpd[22856]: execute_statement argv[0] = /srv/www/viehai/shelly/smartphone.sh
May 27 06:46:36 srv4hai dhcpd[22856]: execute_statement argv[1] = 192.168.12.61
May 27 06:46:36 srv4hai dhcpd[22856]: execute_statement argv[2] = fpThomas
May 27 06:46:36 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone 'viehai.at/IN': update unsuccessful: fpThomas.viehai.at: 'name not in use' prerequisite not satisfied (YXDOMAIN)
May 27 06:46:36 srv4hai named[15509]: client @0x7f93100ff750 192.168.12.252#50157/key rndc-key: updating zone 'viehai.at/IN': update unsuccessful: fpThomas.viehai.at: 'name not in use' prerequisite not satisfied (YXDOMAIN)
May 27 06:46:36 srv4hai common[8911]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly//check_presence.sh
May 27 06:46:36 srv4hai common[8919]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly/smartphone.sh
May 27 06:46:36 srv4hai ping_SP[8898]: SHELLY ping_SP.sh started from smartphone, user:'root'
May 27 06:46:36 srv4hai common.sh: SHELLY: BTstatus[0]:'Off' dweetAge:'2'=1716785196-1716785194
May 27 06:46:36 srv4hai check_presence[8911]: SHELLY (0) found /srv/www/viehai/shelly//meter/ping_SP_0.LIVE and Off//srv/www/viehai/shelly//meter/BTscan_BTid_0.No
May 27 06:46:36 srv4hai check_presence[8911]: SHELLY (ping_SP__smartphone)-(0) found '/srv/www/viehai/shelly//meter/ping_SP_0.LIVE' for what: 'coming'
May 27 06:46:36 srv4hai common.sh: SHELLY: BTstatus[1]:'On' dweetAge:'2'=1716785196-1716785194
May 27 06:46:36 srv4hai check_presence[8911]: SHELLY (1) found /srv/www/viehai/shelly//meter/ping_SP_1.LIVE and On//srv/www/viehai/shelly//meter/BTscan_BTid_1.Yes
May 27 06:46:36 srv4hai check_presence[8911]: SHELLY (ping_SP__smartphone)-(0) found '/srv/www/viehai/shelly//meter/ping_SP_1.LIVE' for what: 'coming'
May 27 06:46:36 srv4hai common.sh: SHELLY: BTstatus[2]:'Off' dweetAge:'2'=1716785196-1716785194
May 27 06:46:36 srv4hai check_presence[8911]: SHELLY (2) found /srv/www/viehai/shelly//meter/ping_SP_2.DEAD and Off//srv/www/viehai/shelly//meter/BTscan_BTid_2.No
May 27 06:46:36 srv4hai check_presence[8911]: SHELLY (ping_SP__smartphone)-(0) what: 'coming' - persPresent: '(__/LIVE) (BT/LIVE) (__/__)' - anyPresent: 'true' - otherPresent:'true'
May 27 06:46:36 srv4hai check_presence[8911]: SHELLY - check 'coming': anyPresent(true) - lScene(scene_vorraumOn) - sceneONsmall(vorraumOn)
May 27 06:46:36 srv4hai check_presence[8911]: SHELLY (ping_SP__smartphone)-(0)-coming: activate_scenario.shtml: vorraumOn
May 27 06:46:36 srv4hai activate_scenario[9084]: SHELLY scenario: 'vorraumOn(vorraumon)' started
May 27 06:46:36 srv4hai activate_scenario[9084]: SHELLY dayState='day' <--> DayTime=checked NightTime=checked - phoneName:'0'
May 27 06:46:36 srv4hai activate_scenario[9084]: SHELLY scenario: 'vorraumOn(vorraumon)' TO BE EXECUTED, phoneName:'0'
May 27 06:46:36 srv4hai postfix/pickup[24818]: BE89A631B9: uid=33 from=
May 27 06:46:36 srv4hai postfix/cleanup[8833]: BE89A631B9: message-id=<20240527044636.BE89A631B9@mail.viehai.at>
May 27 06:46:36 srv4hai postfix/qmgr[15291]: BE89A631B9: from=, size=18494, nrcpt=1 (queue active)
May 27 06:46:36 srv4hai activate_scenario[9084]: SHELLY: scenario: 'vorraumOn(vorraumon)'-'shelly-03'-'Licht Vorzimmer' --> '0?turn=on'
May 27 06:46:36 srv4hai proc_url[9148]: SHELLY: OF:'/srv/www/viehai/shelly/log_scenarios/2024/05/27/_0.log' - shellyUsage:'Licht Vorzimmer' - scUrl:'http://192.168.12.103/relay/0?turn=on' - phName:'phoneName:'0''
May 27 06:46:36 srv4hai activate_scenario[9084]: SHELLY scenario: 'vorraumOn(vorraumon)' took 65 msec, phoneName:'0'
May 27 06:46:36 srv4hai ping_SP[8599]: SHELLY check_presence.sh coming 0 ping_SP__smartphone
May 27 06:46:37 srv4hai postfix/relay/smtp[8846]: BE89A631B9: to=, relay=mx02.nic.name[209.131.158.56]:25, delay=0.83, delays=0.01/0/0.44/0.38, dsn=2.0.0, status=sent (250 2.0.0 Ok: queued as 4C9BD2000D)
May 27 06:46:37 srv4hai postfix/qmgr[15291]: BE89A631B9: removed
May 27 06:46:38 srv4hai ping_SP[8599]: SHELLY - running process-id(8599): '8008 /bin/bash /srv/www/viehai/shelly//ping_SP.sh 192.168.12.61 bt_scan#0128599 /bin/bash /srv/www/viehai/shelly//ping_SP.sh 192.168.12.61 smartphone#0128898 /bin/bash /srv/www/viehai/shelly//ping_SP.sh 192.168.12.61 smartphone#0128919 /bin/bash /srv/www/viehai/shelly/smartphone.sh 192.168.12.61 fpThomas' - 'ping_SP_0' - exiting ==============
May 27 06:46:44 srv4hai ping_SP[26300]: SHELLY (1) - ping 192.168.12.62 1 sucessfully @~1716785204 - 'ping_SP_1'
May 27 06:46:44 srv4hai ping_SP[26300]: SHELLY (1) - ping 192.168.12.62 pCnt:'1'
May 27 06:46:46 srv4hai smartphone.sh: SHELLY - ping_SP.sh started for phoneIP: '192.168.12.61' / 'fpThomas' / '0'
May 27 06:46:46 srv4hai common[9211]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly//ping_SP.sh
May 27 06:46:46 srv4hai dhcpd[22856]: DHCPREQUEST for 192.168.12.61 (192.168.12.252) from e8:78:29:c0:c2:4e via enp2s0
May 27 06:46:46 srv4hai dhcpd[22856]: DHCPACK on 192.168.12.61 to e8:78:29:c0:c2:4e via enp2s0
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone 'viehai.at/IN': update unsuccessful: fpThomas.viehai.at: 'name not in use' prerequisite not satisfied (YXDOMAIN)
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: signer "rndc-key" approved
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'fpThomas.viehai.at' TXT
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'fpThomas.viehai.at' TXT "310ebd0eafccd9c2e311facf8a4b0e4ad2"
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'fpThomas.viehai.at' A
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'fpThomas.viehai.at' A 192.168.12.61
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: signer "rndc-key" approved
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'fpThomas.viehai.at' TXT
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'fpThomas.viehai.at' TXT "310ebd0eafccd9c2e311facf8a4b0e4ad2"
May 27 06:46:46 srv4hai dhcpd[22856]: Added new forward map from fpThomas.viehai.at to 192.168.12.61
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'fpThomas.viehai.at' A
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'fpThomas.viehai.at' A 192.168.12.61
May 27 06:46:46 srv4hai dhcpd[22856]: Added new forward map from fpThomas.viehai.at to 192.168.12.61
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: signer "rndc-key" approved
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'fpThomas.viehai.at' TXT
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'fpThomas.viehai.at' TXT "310ebd0eafccd9c2e311facf8a4b0e4ad2"
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'fpThomas.viehai.at' A
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'fpThomas.viehai.at' A 192.168.12.61
May 27 06:46:46 srv4hai dhcpd[22856]: Added new forward map from fpThomas.viehai.at to 192.168.12.61
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: signer "rndc-key" approved
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'fpThomas.viehai.at' TXT
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'fpThomas.viehai.at' TXT "310ebd0eafccd9c2e311facf8a4b0e4ad2"
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'fpThomas.viehai.at' A
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'fpThomas.viehai.at' A 192.168.12.61
May 27 06:46:46 srv4hai dhcpd[22856]: Added new forward map from fpThomas.viehai.at to 192.168.12.61
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: signer "rndc-key" approved
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': deleting rrset at '61.12.168.192.in-addr.arpa' PTR
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': adding an RR at '61.12.168.192.in-addr.arpa' PTR fpThomas.viehai.at.
May 27 06:46:46 srv4hai dhcpd[22856]: Added reverse map from 61.12.168.192.in-addr.arpa. to fpThomas.viehai.at
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: signer "rndc-key" approved
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': deleting rrset at '61.12.168.192.in-addr.arpa' PTR
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': adding an RR at '61.12.168.192.in-addr.arpa' PTR fpThomas.viehai.at.
May 27 06:46:46 srv4hai dhcpd[22856]: Added reverse map from 61.12.168.192.in-addr.arpa. to fpThomas.viehai.at
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: signer "rndc-key" approved
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': deleting rrset at '61.12.168.192.in-addr.arpa' PTR
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': adding an RR at '61.12.168.192.in-addr.arpa' PTR fpThomas.viehai.at.
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: signer "rndc-key" approved
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': deleting rrset at '61.12.168.192.in-addr.arpa' PTR
May 27 06:46:46 srv4hai named[15509]: client @0x7f931810e280 192.168.12.252#42951/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': adding an RR at '61.12.168.192.in-addr.arpa' PTR fpThomas.viehai.at.
May 27 06:46:46 srv4hai ping_SP[9211]: SHELLY ping_SP.sh started from smartphone, user:'root'
May 27 06:46:46 srv4hai common[9231]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly//check_presence.sh
May 27 06:46:46 srv4hai dhcpd[22856]: Added reverse map from 61.12.168.192.in-addr.arpa. to fpThomas.viehai.at
May 27 06:46:46 srv4hai dhcpd[22856]: Added reverse map from 61.12.168.192.in-addr.arpa. to fpThomas.viehai.at
May 27 06:46:46 srv4hai common.sh: SHELLY: BTstatus[0]:'BTdweet_not_set' dweetAge:'1'=1716785206-1716785205
May 27 06:46:46 srv4hai check_presence[9231]: SHELLY (0) found /srv/www/viehai/shelly//meter/ping_SP_0.LIVE and BTdweet_not_set//srv/www/viehai/shelly//meter/BTscan_BTid_0.No
May 27 06:46:46 srv4hai check_presence[9231]: SHELLY (ping_SP__smartphone)-(0) found '/srv/www/viehai/shelly//meter/ping_SP_0.LIVE' for what: 'coming'
May 27 06:46:46 srv4hai common.sh: SHELLY: BTstatus[1]:'BTdweet_not_set' dweetAge:'1'=1716785206-1716785205
May 27 06:46:46 srv4hai check_presence[9231]: SHELLY (1) found /srv/www/viehai/shelly//meter/ping_SP_1.LIVE and BTdweet_not_set//srv/www/viehai/shelly//meter/BTscan_BTid_1.Yes
May 27 06:46:46 srv4hai check_presence[9231]: SHELLY (ping_SP__smartphone)-(0) found '/srv/www/viehai/shelly//meter/ping_SP_1.LIVE' for what: 'coming'
May 27 06:46:46 srv4hai common.sh: SHELLY: BTstatus[2]:'BTdweet_not_set' dweetAge:'1'=1716785206-1716785205
May 27 06:46:46 srv4hai check_presence[9231]: SHELLY (2) found /srv/www/viehai/shelly//meter/ping_SP_2.DEAD and BTdweet_not_set//srv/www/viehai/shelly//meter/BTscan_BTid_2.No
May 27 06:46:46 srv4hai check_presence[9231]: SHELLY (ping_SP__smartphone)-(0) what: 'coming' - persPresent: '(__/LIVE) (__/LIVE) (__/__)' - anyPresent: 'true' - otherPresent:'true'
May 27 06:46:46 srv4hai check_presence[9231]: SHELLY - check 'coming': anyPresent(true) - lScene(scene_vorraumOn) - sceneONsmall(vorraumOn)
May 27 06:46:46 srv4hai check_presence[9231]: SHELLY (ping_SP__smartphone)-(0)-coming: activate_scenario.shtml: vorraumOn
May 27 06:46:46 srv4hai activate_scenario[9367]: SHELLY scenario: 'vorraumOn(vorraumon)' started
May 27 06:46:46 srv4hai activate_scenario[9367]: SHELLY dayState='day' <--> DayTime=checked NightTime=checked - phoneName:'0'
May 27 06:46:46 srv4hai activate_scenario[9367]: SHELLY scenario: 'vorraumOn(vorraumon)' TO BE EXECUTED, phoneName:'0'
May 27 06:46:46 srv4hai postfix/pickup[24818]: DE158631B9: uid=33 from=
May 27 06:46:46 srv4hai postfix/cleanup[8833]: DE158631B9: message-id=<20240527044646.DE158631B9@mail.viehai.at>
May 27 06:46:46 srv4hai postfix/qmgr[15291]: DE158631B9: from=, size=29497, nrcpt=1 (queue active)
May 27 06:46:46 srv4hai activate_scenario[9367]: SHELLY: scenario: 'vorraumOn(vorraumon)'-'shelly-03'-'Licht Vorzimmer' --> '0?turn=on'
May 27 06:46:46 srv4hai proc_url[9431]: SHELLY: OF:'/srv/www/viehai/shelly/log_scenarios/2024/05/27/_0.log' - shellyUsage:'Licht Vorzimmer' - scUrl:'http://192.168.12.103/relay/0?turn=on' - phName:'phoneName:'0''
May 27 06:46:47 srv4hai activate_scenario[9367]: SHELLY scenario: 'vorraumOn(vorraumon)' took 86 msec, phoneName:'0'
May 27 06:46:47 srv4hai ping_SP[8898]: SHELLY check_presence.sh coming 0 ping_SP__smartphone
May 27 06:46:47 srv4hai postfix/relay/smtp[8846]: DE158631B9: to=, relay=mx01.nic.name[209.131.159.47]:25, delay=1.1, delays=0.01/0/0.57/0.47, dsn=2.0.0, status=sent (250 2.0.0 Ok: queued as 89D59201BC)
May 27 06:46:47 srv4hai postfix/qmgr[15291]: DE158631B9: removed
May 27 06:46:49 srv4hai ping_SP[8898]: SHELLY - running process-id(8898): '8008 /bin/bash /srv/www/viehai/shelly//ping_SP.sh 192.168.12.61 bt_scan#0128898 /bin/bash /srv/www/viehai/shelly//ping_SP.sh 192.168.12.61 smartphone#0129211 /bin/bash /srv/www/viehai/shelly//ping_SP.sh 192.168.12.61 smartphone' - 'ping_SP_0' - exiting ==============
May 27 06:46:56 srv4hai common[9479]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly//check_presence.sh
May 27 06:46:56 srv4hai common.sh: SHELLY: BTstatus[0]:'Off' dweetAge:'5'=1716785216-1716785211
May 27 06:46:56 srv4hai check_presence[9479]: SHELLY (0) found /srv/www/viehai/shelly//meter/ping_SP_0.LIVE and Off//srv/www/viehai/shelly//meter/BTscan_BTid_0.No
May 27 06:46:56 srv4hai check_presence[9479]: SHELLY (ping_SP__smartphone)-(0) found '/srv/www/viehai/shelly//meter/ping_SP_0.LIVE' for what: 'coming'
May 27 06:46:56 srv4hai common.sh: SHELLY: BTstatus[1]:'On' dweetAge:'5'=1716785216-1716785211
May 27 06:46:56 srv4hai check_presence[9479]: SHELLY (1) found /srv/www/viehai/shelly//meter/ping_SP_1.LIVE and On//srv/www/viehai/shelly//meter/BTscan_BTid_1.Yes
May 27 06:46:56 srv4hai check_presence[9479]: SHELLY (ping_SP__smartphone)-(0) found '/srv/www/viehai/shelly//meter/ping_SP_1.LIVE' for what: 'coming'
May 27 06:46:56 srv4hai common.sh: SHELLY: BTstatus[2]:'Off' dweetAge:'5'=1716785216-1716785211
May 27 06:46:56 srv4hai check_presence[9479]: SHELLY (2) found /srv/www/viehai/shelly//meter/ping_SP_2.DEAD and Off//srv/www/viehai/shelly//meter/BTscan_BTid_2.No
May 27 06:46:56 srv4hai check_presence[9479]: SHELLY (ping_SP__smartphone)-(0) what: 'coming' - persPresent: '(__/LIVE) (BT/LIVE) (__/__)' - anyPresent: 'true' - otherPresent:'true'
May 27 06:46:56 srv4hai check_presence[9479]: SHELLY - check 'coming': anyPresent(true) - lScene(scene_vorraumOn) - sceneONsmall(vorraumOn)
May 27 06:46:56 srv4hai check_presence[9479]: SHELLY (ping_SP__smartphone)-(0)-coming: activate_scenario.shtml: vorraumOn
May 27 06:46:56 srv4hai activate_scenario[9630]: SHELLY scenario: 'vorraumOn(vorraumon)' started
May 27 06:46:56 srv4hai activate_scenario[9630]: SHELLY dayState='day' <--> DayTime=checked NightTime=checked - phoneName:'0'
finished