activate_scenario.sh
Sun Jan 14 11:21:13 CET 2024
scenario: pcOFF
'day' <--> DayTime=checked , NightTime=checked
-> execution of scenario
-> sending email(s) to 'null'
scenario: 'Schreibtisch Thomas AUS-schalten' - 'pcOFF' - 'pcoff'
Thomas Schreibtischlampe (/srv/www/viehai/shelly/log_scenarios/2024/01/14/_0.log)
vorher: 11:21:13.355
http://192.168.12.120/relay/0?turn=off |
|---|
"ison": false,
"has_timer": false,
"timer_started": 0,
"timer_duration": 0,
"timer_remaining": 0,
"source": "http"
|
nachher: 11:21:13.389
Dauer: 35 msec
scenario: 'Schreibtisch Thomas AUS-schalten' - 'pcOFF' - 'pcoff'
urls : 1
vorher : 11:21:13.336
nachher: 11:21:13.396
Dauer : 61 msec
outfile: '/srv/www/viehai/shelly/log_scenarios/2024/01/14//scene_pcOFF_20240114_112113.txt'
syslog
Jan 14 11:19:01 srv4hai CRON[8678]: (root) CMD (/etc/linetest/linetest.sh)
Jan 14 11:19:14 srv4hai dhcpd[1107]: DHCPDISCOVER from 00:22:61:a1:fb:40 via enp2s0
Jan 14 11:19:14 srv4hai dhcpd[1107]: DHCPOFFER on 192.168.12.17 to 00:22:61:a1:fb:40 via enp2s0
Jan 14 11:19:22 srv4hai ping_SP.sh: SHELLY (1) - ping 192.168.12.62 0 sucessfully @~1705227562 - 'ping_SP_1'
Jan 14 11:19:24 srv4hai ping_SP.sh: SHELLY (0) - ping 192.168.12.61 0 sucessfully @~1705227564 - 'ping_SP_0'
Jan 14 11:19:30 srv4hai dhcpd[1107]: execute_statement argv[0] = /srv/www/viehai/shelly/dhcpcommit.sh
Jan 14 11:19:30 srv4hai dhcpd[1107]: execute_statement argv[1] = 192.168.12.10
Jan 14 11:19:30 srv4hai dhcpd[1107]: execute_statement argv[2] = pchai7x
Jan 14 11:19:30 srv4hai dhcpd[1107]: DHCPREQUEST for 192.168.12.10 from 70:54:d2:7b:fe:a7 via enp2s0
Jan 14 11:19:30 srv4hai dhcpd[1107]: DHCPACK on 192.168.12.10 to 70:54:d2:7b:fe:a7 via enp2s0
Jan 14 11:19:30 srv4hai named[14530]: client @0x7fc310083bf0 192.168.12.252#34973/key rndc-key: updating zone 'viehai.at/IN': update unsuccessful: pchai7x.viehai.at: 'name not in use' prerequisite not satisfied (YXDOMAIN)
Jan 14 11:19:30 srv4hai named[14530]: client @0x7fc31001d550 192.168.12.252#51385/key rndc-key: signer "rndc-key" approved
Jan 14 11:19:30 srv4hai named[14530]: client @0x7fc31001d550 192.168.12.252#51385/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'pchai7x.viehai.at' TXT
Jan 14 11:19:30 srv4hai named[14530]: client @0x7fc31001d550 192.168.12.252#51385/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'pchai7x.viehai.at' TXT "001e3ad86ca86e10b8e2aaf2e2ade54f52"
Jan 14 11:19:30 srv4hai named[14530]: client @0x7fc31001d550 192.168.12.252#51385/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'pchai7x.viehai.at' A
Jan 14 11:19:30 srv4hai named[14530]: client @0x7fc31001d550 192.168.12.252#51385/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'pchai7x.viehai.at' A 192.168.12.10
Jan 14 11:19:30 srv4hai dhcpd[1107]: Added new forward map from pchai7x.viehai.at to 192.168.12.10
Jan 14 11:19:30 srv4hai named[14530]: client @0x7fc31400b700 192.168.12.252#39473/key rndc-key: signer "rndc-key" approved
Jan 14 11:19:30 srv4hai named[14530]: client @0x7fc31400b700 192.168.12.252#39473/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': deleting rrset at '10.12.168.192.in-addr.arpa' PTR
Jan 14 11:19:30 srv4hai dhcpcommit.sh: SHELLY ip:'192.168.12.10'(10) device 'pchai7x'
Jan 14 11:19:30 srv4hai named[14530]: client @0x7fc31400b700 192.168.12.252#39473/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': adding an RR at '10.12.168.192.in-addr.arpa' PTR pchai7x.viehai.at.
Jan 14 11:19:30 srv4hai dhcpd[1107]: Added reverse map from 10.12.168.192.in-addr.arpa. to pchai7x.viehai.at
Jan 14 11:19:30 srv4hai activate_scenario.sh: SHELLY scenario: 'pcON(pcon)' TO BE EXECUTED
Jan 14 11:19:30 srv4hai postfix/pickup[28376]: B0DB260244: uid=33 from=
Jan 14 11:19:30 srv4hai named[14530]: resolver priming query complete
Jan 14 11:19:30 srv4hai postfix/cleanup[8761]: B0DB260244: message-id=<20240114101930.B0DB260244@mail.viehai.at>
Jan 14 11:19:30 srv4hai postfix/qmgr[28610]: B0DB260244: from=, size=6220, nrcpt=1 (queue active)
Jan 14 11:19:30 srv4hai activate_scenario.sh: SHELLY: 'shelly-20'-'Thomas Schreibtischlampe' --> '0?turn=on'
Jan 14 11:19:30 srv4hai proc_url.sh: SHELLY: OF:'/srv/www/viehai/shelly/log_scenarios/2024/01/14/_0.log' - shellyUsage:'Thomas Schreibtischlampe' - scUrl:'http://192.168.12.120/relay/0?turn=on' - phName:'noHandy'
Jan 14 11:19:30 srv4hai postfix/local[8775]: B0DB260244: to=, orig_to=, relay=local, delay=0.03, delays=0.02/0/0/0.01, dsn=5.1.1, status=bounced (unknown user: "null")
Jan 14 11:19:30 srv4hai postfix/cleanup[8761]: B602360245: message-id=<20240114101930.B602360245@mail.viehai.at>
Jan 14 11:19:30 srv4hai postfix/bounce[8776]: B0DB260244: sender non-delivery notification: B602360245
Jan 14 11:19:30 srv4hai postfix/qmgr[28610]: B602360245: from=<>, size=8099, nrcpt=1 (queue active)
Jan 14 11:19:30 srv4hai postfix/qmgr[28610]: B0DB260244: removed
Jan 14 11:19:30 srv4hai postfix/local[8775]: B602360245: to=, relay=local, delay=0.01, delays=0/0/0/0.01, dsn=2.0.0, status=sent (delivered to command: /bin/procmail)
Jan 14 11:19:30 srv4hai postfix/qmgr[28610]: B602360245: removed
Jan 14 11:19:30 srv4hai activate_scenario.sh: SHELLY scenario: 'pcON(pcon)' took 67 msec
Jan 14 11:19:30 srv4hai proc_url.sh: SHELLY: grab status via - 'http://192.168.12.120/status'
Jan 14 11:19:30 srv4hai proc_url.sh: SHELLY: status: '{"wifi_sta":{"connected":true,"ssid":"viehai","ip":"192.168.12.120","rssi":-60},"cloud":{"enabled":false,"connected":false},"mqtt":{"connected":false},"time":"11:19","unixtime":1705227570,"serial":1,"has_update":false,"mac":"98CDAC2DC5CD","cfg_changed_cnt":0,"actions_stats":{"skipped":0},"relays":[{"ison":true,"has_timer":false,"timer_started":0,"timer_duration":0,"timer_remaining":0,"source":"http"}],"meters":[{"power":0.00,"is_valid":true}],"inputs":[{"input":0,"event":"","event_cnt":36}],"ext_sensors":{},"ext_temperature":{},"ext_humidity":{},"update":{"status":"idle","has_update":false,"new_version":"20230913-112003/v1.14.0-gcb84623","old_version":"20230913-112003/v1.14.0-gcb84623","beta_version":"20231107-162940/v1.14.1-rc1-g0617c15"},"ram_total":51688,"ram_free":39984,"fs_size":233681,"fs_free":150098,"uptime":6295759}'
Jan 14 11:19:31 srv4hai named[14530]: resolver priming query complete
Jan 14 11:19:32 srv4hai named[14530]: resolver priming query complete
Jan 14 11:19:37 srv4hai named[14530]: resolver priming query complete
Jan 14 11:19:40 srv4hai named[14530]: resolver priming query complete
Jan 14 11:19:47 srv4hai named[14530]: resolver priming query complete
Jan 14 11:19:52 srv4hai ping_SP.sh: SHELLY (1) - ping 192.168.12.62 0 sucessfully @~1705227592 - 'ping_SP_1'
Jan 14 11:19:53 srv4hai named[14530]: resolver priming query complete
Jan 14 11:19:55 srv4hai named[14530]: resolver priming query complete
Jan 14 11:20:01 srv4hai CRON[8839]: (root) CMD (/etc/linetest/linetest.sh)
Jan 14 11:20:01 srv4hai CRON[8840]: (www-data) CMD (/srv/www/viehai/shelly/meter.sh)
Jan 14 11:20:01 srv4hai meter.sh: SHELLY meter.sh started
Jan 14 11:20:02 srv4hai named[14530]: resolver priming query complete
Jan 14 11:20:04 srv4hai ping_SP.sh: SHELLY (0)- ping 192.168.12.61 0 not answered (1) @~1705227604 - 'ping_SP_0'
Jan 14 11:20:10 srv4hai named[14530]: resolver priming query complete
Jan 14 11:20:17 srv4hai dovecot: imap-login: Login: user=, method=PLAIN, rip=::1, lip=::1, mpid=9059, secured, session=<6+1hPuUORLMAAAAAAAAAAAAAAAAAAAAB>
Jan 14 11:20:17 srv4hai ping_SP.sh: SHELLY (0)- ping 192.168.12.61 1 not answered (1) @~1705227617 - 'ping_SP_0'
Jan 14 11:20:17 srv4hai dovecot: imap(miglincit)<9059><6+1hPuUORLMAAAAAAAAAAAAAAAAAAAAB>: Logged out in=198 out=1233 deleted=0 expunged=0 trashed=0 hdr_count=0 hdr_bytes=0 body_count=0 body_bytes=0
Jan 14 11:20:18 srv4hai dhcpd[1107]: DHCPDISCOVER from 00:22:61:a1:fb:40 via enp2s0
Jan 14 11:20:18 srv4hai dhcpd[1107]: DHCPOFFER on 192.168.12.17 to 00:22:61:a1:fb:40 via enp2s0
Jan 14 11:20:23 srv4hai ping_SP.sh: SHELLY (1) - ping 192.168.12.62 0 sucessfully @~1705227623 - 'ping_SP_1'
Jan 14 11:20:30 srv4hai ping_SP.sh: SHELLY (0)- ping 192.168.12.61 2 not answered (1) @~1705227630 - 'ping_SP_0'
Jan 14 11:20:30 srv4hai ping_SP.sh: SHELLY (0)- ping 192.168.12.61 3 not answered - abort (8873) @~1705227630 - rm 'ping_SP_0'
Jan 14 11:20:30 srv4hai check_presence.sh: SHELLY (0) found './meter/ping_SP_1' more than one (1) line for what: 'presence'
Jan 14 11:20:30 srv4hai check_presence.sh: SHELLY (0) what: 'presence' - persPresent: 'false/no IP, scanBT/ping, false/no IP,' - anyPresent: 'true'
Jan 14 11:20:30 srv4hai check_presence.sh: SHELLY (0)-presence: NOT activate_scenario.shtml: test_41_OFF
Jan 14 11:20:53 srv4hai named[14530]: resolver priming query complete
Jan 14 11:20:53 srv4hai ping_SP.sh: SHELLY (1) - ping 192.168.12.62 0 sucessfully @~1705227653 - 'ping_SP_1'
Jan 14 11:20:54 srv4hai named[14530]: resolver priming query complete
Jan 14 11:21:01 srv4hai CRON[9265]: (root) CMD (/etc/linetest/linetest.sh)
Jan 14 11:21:06 srv4hai named[14530]: resolver priming query complete
Jan 14 11:21:07 srv4hai meter.sh: SHELLY meter.sh ended
finished