activate_scenario.sh
Tue Jan 2 20:03:32 CET 2024
scenario: test_41_OFF
phoneName: NONE

'night' <--> DayTime=checked , NightTime=checked
-> execution of scenario
-> sending email(s) to 'null'

scenario: 'test 41 AUS' - 'test_41_OFF' - 'test_41_off'

41-TBD-Dimmer (/srv/www/viehai/shelly/log_scenarios/2024/01/02/scene_test_41_OFF_20240102_200332_0.log)

vorher: 20:03:32.711

http://192.168.12.141/light/0?turn=off&brightness=50
  "ison": false,
  "source": "http",
  "has_timer": false,
  "timer_started": 0,
  "timer_duration": 0,
  "timer_remaining": 0,
  "mode": "white",
  "brightness": 50,
  "transition": 0

nachher: 20:03:32.745
Dauer: 34 msec phName: 'NONE'


scenario: 'test 41 AUS' - 'test_41_OFF' - 'test_41_off'

urls : 1
vorher : 20:03:32.665
nachher: 20:03:32.752
Dauer : 88 msec
outfile: '/srv/www/viehai/shelly/log_scenarios/2024/01/02/scene_test_41_OFF_20240102_200332.txt'


syslog

Jan  2 20:00:01 srv4hai CRON[32279]: (root) CMD (/etc/linetest/linetest.sh)
Jan  2 20:00:01 srv4hai CRON[32280]: (www-data) CMD (/srv/www/viehai/shelly/meter.sh)
Jan  2 20:00:01 srv4hai meter.sh: SHELLY meter.sh started
Jan  2 20:00:01 srv4hai ping_SP.sh: SHELLY  (1) - pinging 192.168.12.62 0 sucessfully  @~1704222001 - '/srv/www/viehai/shelly//meter/ping_SP_1'
Jan  2 20:00:04 srv4hai dovecot: imap-login: Login: user=, method=PLAIN, rip=::1, lip=::1, mpid=32474, secured, session=
Jan  2 20:00:04 srv4hai dovecot: imap(miglincit)<32474>: Logged out in=137 out=1087 deleted=0 expunged=0 trashed=0 hdr_count=0 hdr_bytes=0 body_count=0 body_bytes=0
Jan  2 20:00:32 srv4hai ping_SP.sh: SHELLY  (1) - pinging 192.168.12.62 0 sucessfully  @~1704222032 - '/srv/www/viehai/shelly//meter/ping_SP_1'
Jan  2 20:00:40 srv4hai dhcpd[24585]: DHCPDISCOVER from 00:22:61:a1:fb:40 via enp2s0
Jan  2 20:00:40 srv4hai dhcpd[24585]: DHCPOFFER on 192.168.12.17 to 00:22:61:a1:fb:40 via enp2s0
Jan  2 20:01:01 srv4hai CRON[32659]: (root) CMD (/etc/linetest/linetest.sh)
Jan  2 20:01:01 srv4hai CRON[32660]: (root) CMD (   test -x /etc/cron.daily/popularity-contest && /etc/cron.daily/popularity-contest --crond)
Jan  2 20:01:02 srv4hai ping_SP.sh: SHELLY  (1) - pinging 192.168.12.62 0 sucessfully  @~1704222062 - '/srv/www/viehai/shelly//meter/ping_SP_1'
Jan  2 20:01:07 srv4hai meter.sh: SHELLY meter.sh ended
Jan  2 20:01:33 srv4hai ping_SP.sh: SHELLY  (1) - pinging 192.168.12.62 0 sucessfully  @~1704222093 - '/srv/www/viehai/shelly//meter/ping_SP_1'
Jan  2 20:01:34 srv4hai dhcpd[24585]: DHCPDISCOVER from e8:78:29:c0:c2:4e via enp2s0
Jan  2 20:01:34 srv4hai dhcpd[24585]: DHCPOFFER on 192.168.12.61 to e8:78:29:c0:c2:4e via enp2s0
Jan  2 20:01:34 srv4hai dhcpd[24585]: execute_statement argv[0] = /usr/bin/curl
Jan  2 20:01:34 srv4hai dhcpd[24585]: execute_statement argv[1] = http://viehai.at/shelly/smartphone.shtml?phoneIP=192.168.12.61&phoneName=fpTom
Jan  2 20:01:34 srv4hai smartphone.sh: SHELLY - ping_SP.sh started for phoneIP: '192.168.12.61' / 'fpTom'
Jan  2 20:01:34 srv4hai ping_SP.sh: SHELLY ping_SP.sh started
Jan  2 20:01:34 srv4hai ping_SP.sh: SHELLY - new process: '' - '/srv/www/viehai/shelly//meter/ping_SP_0' @~1704222094
Jan  2 20:01:34 srv4hai check_presence.sh: SHELLY (0) what: 'coming' - persPresent: 'false' - anyPresent: 'false'
Jan  2 20:01:34 srv4hai check_presence.sh: SHELLY (0)-coming: NOT activate_scenario.shtml: test_41_ON
Jan  2 20:01:37 srv4hai ping_SP.sh: SHELLY  (0)- pinging 192.168.12.61 0 not answered (1) @~1704222097 - '/srv/www/viehai/shelly//meter/ping_SP_0'
Jan  2 20:01:50 srv4hai ping_SP.sh: SHELLY  (0)- pinging 192.168.12.61 1 not answered (1) @~1704222110 - '/srv/www/viehai/shelly//meter/ping_SP_0'
Jan  2 20:02:01 srv4hai CRON[327]: (root) CMD (/etc/linetest/linetest.sh)
Jan  2 20:02:03 srv4hai ping_SP.sh: SHELLY  (1) - pinging 192.168.12.62 0 sucessfully  @~1704222123 - '/srv/www/viehai/shelly//meter/ping_SP_1'
Jan  2 20:02:03 srv4hai ping_SP.sh: SHELLY  (0)- pinging 192.168.12.61 2 not answered (1) @~1704222123 - '/srv/www/viehai/shelly//meter/ping_SP_0'
Jan  2 20:02:03 srv4hai ping_SP.sh: SHELLY  (0)- pinging 192.168.12.61 3 not answered - aborting (32755) @~1704222123 - rm '/srv/www/viehai/shelly//meter/ping_SP_0'
Jan  2 20:02:03 srv4hai check_presence.sh: SHELLY (0) what: 'presence' - persPresent: 'false' - anyPresent: 'false'
Jan  2 20:02:03 srv4hai check_presence.sh: SHELLY (0)-presence: activate_scenario.shtml: test_41_OFF
Jan  2 20:02:03 srv4hai activate_scenario.sh: SHELLY scenario: 'test_41_OFF(test_41_off)' TO BE EXECUTED
Jan  2 20:02:03 srv4hai postfix/pickup[318]: EE6526011E: uid=33 from=
Jan  2 20:02:03 srv4hai postfix/cleanup[399]: EE6526011E: message-id=<20240102190203.EE6526011E@mail.viehai.at>
Jan  2 20:02:04 srv4hai postfix/qmgr[28610]: EE6526011E: from=, size=5449, nrcpt=1 (queue active)
Jan  2 20:02:04 srv4hai activate_scenario.sh: SHELLY: 'shelly-41'-'41-TBD-Dimmer' --> '0?turn=off&brightness=50'
Jan  2 20:02:04 srv4hai /srv/www/viehai/shelly/proc_url.sh: SHELLY: OF:'/srv/www/viehai/shelly/log_scenarios/2024/01/02/scene_test_41_OFF_20240102_200203_0.log' - shellyUsage:'41-TBD-Dimmer' - scUrl:'http://192.168.12.141/light/0?turn=off&brightness=50' - phName:'NONE'
Jan  2 20:02:04 srv4hai postfix/local[413]: EE6526011E: to=, orig_to=, relay=local, delay=0.07, delays=0.05/0.01/0/0.02, dsn=5.1.1, status=bounced (unknown user: "null")
Jan  2 20:02:04 srv4hai postfix/cleanup[399]: 05FBE60244: message-id=<20240102190204.05FBE60244@mail.viehai.at>
Jan  2 20:02:04 srv4hai postfix/bounce[414]: EE6526011E: sender non-delivery notification: 05FBE60244
Jan  2 20:02:04 srv4hai postfix/qmgr[28610]: 05FBE60244: from=<>, size=7328, nrcpt=1 (queue active)
Jan  2 20:02:04 srv4hai postfix/qmgr[28610]: EE6526011E: removed
Jan  2 20:02:04 srv4hai postfix/local[413]: 05FBE60244: to=, relay=local, delay=0.01, delays=0/0/0/0.01, dsn=2.0.0, status=sent (delivered to command: /bin/procmail)
Jan  2 20:02:04 srv4hai postfix/qmgr[28610]: 05FBE60244: removed
Jan  2 20:02:04 srv4hai activate_scenario.sh: SHELLY scenario: 'test_41_OFF(test_41_off)' took 72 msec
Jan  2 20:02:04 srv4hai /srv/www/viehai/shelly/proc_url.sh: SHELLY: grab status via - 'http://192.168.12.141/status'
Jan  2 20:02:04 srv4hai /srv/www/viehai/shelly/proc_url.sh: SHELLY: status: '{"wifi_sta":{"connected":true,"ssid":"viehai","ip":"192.168.12.141","rssi":-53},"cloud":{"enabled":false,"connected":false},"mqtt":{"connected":true},"time":"20:02","unixtime":1704222124,"serial":1,"has_update":false,"mac":"349454723B21","cfg_changed_cnt":0,"actions_stats":{"skipped":0},"lights":[{"ison":false,"source":"http","has_timer":false,"timer_started":0,"timer_duration":0,"timer_remaining":0,"mode":"white","brightness":50,"transition":0}],"meters":[{"power":0.00,"overpower":0.00,"is_valid":true, "timestamp":1704225724,"counters":[0.000, 0.000, 0.000],"total":42}],"inputs":[{"input":0,"event":"","event_cnt":0},{"input":0,"event":"","event_cnt":0}],"tmp":{"tC":43.82,"tF":110.88, "is_valid":true},"calibrated":true,"calib_progress":0,"calib_status":0,"calib_running":0,"wire_mode":1,"forced_neutral":false,"overtemperature":false,"loaderror":0,"overpower":false,"debug":0,"update":{"status":"idle","has_update":false,"new_version":"20230913-114008/v1.14.0-gcb84623","old_version":"20230913-114
Jan  2 20:02:04 srv4hai dhcpd[24585]: DHCPREQUEST for 192.168.12.61 (192.168.12.252) from e8:78:29:c0:c2:4e via enp2s0
Jan  2 20:02:04 srv4hai dhcpd[24585]: DHCPACK on 192.168.12.61 to e8:78:29:c0:c2:4e via enp2s0
Jan  2 20:02:04 srv4hai dhcpd[24585]: execute_statement argv[0] = /usr/bin/curl
Jan  2 20:02:04 srv4hai dhcpd[24585]: execute_statement argv[1] = http://viehai.at/shelly/smartphone.shtml?phoneIP=192.168.12.61&phoneName=fpTom
Jan  2 20:02:04 srv4hai smartphone.sh: SHELLY - ping_SP.sh started for phoneIP: '192.168.12.61' / 'fpTom'
Jan  2 20:02:04 srv4hai ping_SP.sh: SHELLY ping_SP.sh started
Jan  2 20:02:04 srv4hai ping_SP.sh: SHELLY - new process: '' - '/srv/www/viehai/shelly//meter/ping_SP_0' @~1704222124
Jan  2 20:02:04 srv4hai check_presence.sh: SHELLY (0) what: 'coming' - persPresent: 'false' - anyPresent: 'false'
Jan  2 20:02:04 srv4hai check_presence.sh: SHELLY (0)-coming: NOT activate_scenario.shtml: test_41_ON
Jan  2 20:02:07 srv4hai ping_SP.sh: SHELLY  (0)- pinging 192.168.12.61 0 not answered (1) @~1704222127 - '/srv/www/viehai/shelly//meter/ping_SP_0'
Jan  2 20:02:20 srv4hai ping_SP.sh: SHELLY  (0)- pinging 192.168.12.61 1 not answered (1) @~1704222140 - '/srv/www/viehai/shelly//meter/ping_SP_0'
Jan  2 20:02:33 srv4hai ping_SP.sh: SHELLY  (0)- pinging 192.168.12.61 2 not answered (1) @~1704222153 - '/srv/www/viehai/shelly//meter/ping_SP_0'
Jan  2 20:02:33 srv4hai ping_SP.sh: SHELLY  (0)- pinging 192.168.12.61 3 not answered - aborting (466) @~1704222153 - rm '/srv/www/viehai/shelly//meter/ping_SP_0'
Jan  2 20:02:33 srv4hai check_presence.sh: SHELLY (0) what: 'presence' - persPresent: 'false' - anyPresent: 'false'
Jan  2 20:02:33 srv4hai check_presence.sh: SHELLY (0)-presence: activate_scenario.shtml: test_41_OFF
Jan  2 20:02:33 srv4hai activate_scenario.sh: SHELLY scenario: 'test_41_OFF(test_41_off)' TO BE EXECUTED
Jan  2 20:02:33 srv4hai postfix/pickup[318]: 80CF96011E: uid=33 from=
Jan  2 20:02:33 srv4hai postfix/cleanup[399]: 80CF96011E: message-id=<20240102190233.80CF96011E@mail.viehai.at>
Jan  2 20:02:33 srv4hai postfix/qmgr[28610]: 80CF96011E: from=, size=10191, nrcpt=1 (queue active)
Jan  2 20:02:33 srv4hai postfix/local[413]: 80CF96011E: to=, orig_to=, relay=local, delay=0.01, delays=0.01/0/0/0.01, dsn=5.1.1, status=bounced (unknown user: "null")
Jan  2 20:02:33 srv4hai postfix/cleanup[399]: 8304960244: message-id=<20240102190233.8304960244@mail.viehai.at>
Jan  2 20:02:33 srv4hai postfix/bounce[414]: 80CF96011E: sender non-delivery notification: 8304960244
Jan  2 20:02:33 srv4hai postfix/qmgr[28610]: 8304960244: from=<>, size=12070, nrcpt=1 (queue active)
Jan  2 20:02:33 srv4hai postfix/qmgr[28610]: 80CF96011E: removed
Jan  2 20:02:33 srv4hai postfix/local[413]: 8304960244: to=, relay=local, delay=0.02, delays=0/0/0/0.01, dsn=2.0.0, status=sent (delivered to command: /bin/procmail)
Jan  2 20:02:33 srv4hai postfix/qmgr[28610]: 8304960244: removed
Jan  2 20:02:33 srv4hai activate_scenario.sh: SHELLY: 'shelly-41'-'41-TBD-Dimmer' --> '0?turn=off&brightness=50'
Jan  2 20:02:33 srv4hai /srv/www/viehai/shelly/proc_url.sh: SHELLY: OF:'/srv/www/viehai/shelly/log_scenarios/2024/01/02/scene_test_41_OFF_20240102_200233_0.log' - shellyUsage:'41-TBD-Dimmer' - scUrl:'http://192.168.12.141/light/0?turn=off&brightness=50' - phName:'NONE'
Jan  2 20:02:33 srv4hai activate_scenario.sh: SHELLY scenario: 'test_41_OFF(test_41_off)' took 78 msec
Jan  2 20:02:33 srv4hai /srv/www/viehai/shelly/proc_url.sh: SHELLY: grab status via - 'http://192.168.12.141/status'
Jan  2 20:02:33 srv4hai /srv/www/viehai/shelly/proc_url.sh: SHELLY: status: '{"wifi_sta":{"connected":true,"ssid":"viehai","ip":"192.168.12.141","rssi":-59},"cloud":{"enabled":false,"connected":false},"mqtt":{"connected":true},"time":"20:02","unixtime":1704222154,"serial":1,"has_update":false,"mac":"349454723B21","cfg_changed_cnt":0,"actions_stats":{"skipped":0},"lights":[{"ison":false,"source":"http","has_timer":false,"timer_started":0,"timer_duration":0,"timer_remaining":0,"mode":"white","brightness":50,"transition":0}],"meters":[{"power":0.00,"overpower":0.00,"is_valid":true, "timestamp":1704225754,"counters":[0.000, 0.000, 0.000],"total":42}],"inputs":[{"input":0,"event":"","event_cnt":0},{"input":0,"event":"","event_cnt":0}],"tmp":{"tC":43.82,"tF":110.88, "is_valid":true},"calibrated":true,"calib_progress":0,"calib_status":0,"calib_running":0,"wire_mode":1,"forced_neutral":false,"overtemperature":false,"loaderror":0,"overpower":false,"debug":0,"update":{"status":"idle","has_update":false,"new_version":"20230913-114008/v1.14.0-gcb84623","old_version":"20230913-114
Jan  2 20:02:33 srv4hai dhcpd[24585]: DHCPREQUEST for 192.168.12.61 (192.168.12.252) from e8:78:29:c0:c2:4e via enp2s0
Jan  2 20:02:33 srv4hai dhcpd[24585]: DHCPACK on 192.168.12.61 to e8:78:29:c0:c2:4e via enp2s0
Jan  2 20:02:33 srv4hai dhcpd[24585]: execute_statement argv[0] = /usr/bin/curl
Jan  2 20:02:33 srv4hai dhcpd[24585]: execute_statement argv[1] = http://viehai.at/shelly/smartphone.shtml?phoneIP=192.168.12.61&phoneName=fpTom
Jan  2 20:02:33 srv4hai named[14530]: client @0x7fc328650140 192.168.12.252#59943/key rndc-key: updating zone 'viehai.at/IN': update unsuccessful: fpTom.viehai.at: 'name not in use' prerequisite not satisfied (YXDOMAIN)
Jan  2 20:02:33 srv4hai smartphone.sh: SHELLY - ping_SP.sh started for phoneIP: '192.168.12.61' / 'fpTom'
Jan  2 20:02:33 srv4hai ping_SP.sh: SHELLY ping_SP.sh started
Jan  2 20:02:33 srv4hai ping_SP.sh: SHELLY - new process: '' - '/srv/www/viehai/shelly//meter/ping_SP_0' @~1704222153
Jan  2 20:02:33 srv4hai check_presence.sh: SHELLY (0) what: 'coming' - persPresent: 'false' - anyPresent: 'false'
Jan  2 20:02:33 srv4hai check_presence.sh: SHELLY (0)-coming: NOT activate_scenario.shtml: test_41_ON
Jan  2 20:02:33 srv4hai ping_SP.sh: SHELLY  (1) - pinging 192.168.12.62 0 sucessfully  @~1704222153 - '/srv/www/viehai/shelly//meter/ping_SP_1'
Jan  2 20:02:36 srv4hai ping_SP.sh: SHELLY  (0)- pinging 192.168.12.61 0 not answered (1) @~1704222156 - '/srv/www/viehai/shelly//meter/ping_SP_0'
Jan  2 20:02:49 srv4hai ping_SP.sh: SHELLY  (0)- pinging 192.168.12.61 1 not answered (1) @~1704222169 - '/srv/www/viehai/shelly//meter/ping_SP_0'
Jan  2 20:02:55 srv4hai bt_scan.sh: SHELLY - phoneName: 'S20_Grete' / '1'
Jan  2 20:02:55 srv4hai bt_scan.sh: SHELLY - ping_SP.sh started for BTmac: '1'
Jan  2 20:02:55 srv4hai ping_SP.sh: SHELLY ping_SP.sh started
Jan  2 20:02:55 srv4hai check_presence.sh: SHELLY (1) what: 'coming' - persPresent: 'false' - anyPresent: 'false'
Jan  2 20:02:55 srv4hai check_presence.sh: SHELLY (1)-coming: NOT activate_scenario.shtml: test_41_ON
Jan  2 20:02:55 srv4hai ping_SP.sh: SHELLY - running process: '1558' - '/srv/www/viehai/shelly//meter/ping_SP_1' - exiting
Jan  2 20:03:01 srv4hai CRON[698]: (root) CMD (/etc/linetest/linetest.sh)
Jan  2 20:03:02 srv4hai ping_SP.sh: SHELLY  (0)- pinging 192.168.12.61 2 not answered (1) @~1704222182 - '/srv/www/viehai/shelly//meter/ping_SP_0'
Jan  2 20:03:02 srv4hai ping_SP.sh: SHELLY  (0)- pinging 192.168.12.61 3 not answered - aborting (621) @~1704222182 - rm '/srv/www/viehai/shelly//meter/ping_SP_0'
Jan  2 20:03:02 srv4hai check_presence.sh: SHELLY (0) what: 'presence' - persPresent: 'false' - anyPresent: 'false'
Jan  2 20:03:02 srv4hai check_presence.sh: SHELLY (0)-presence: activate_scenario.shtml: test_41_OFF
Jan  2 20:03:03 srv4hai activate_scenario.sh: SHELLY scenario: 'test_41_OFF(test_41_off)' TO BE EXECUTED
Jan  2 20:03:03 srv4hai postfix/pickup[318]: 057746011E: uid=33 from=
Jan  2 20:03:03 srv4hai postfix/cleanup[399]: 057746011E: message-id=<20240102190303.057746011E@mail.viehai.at>
Jan  2 20:03:03 srv4hai postfix/qmgr[28610]: 057746011E: from=, size=14786, nrcpt=1 (queue active)
Jan  2 20:03:03 srv4hai postfix/local[413]: 057746011E: to=, orig_to=, relay=local, delay=0.01, delays=0.01/0/0/0, dsn=5.1.1, status=bounced (unknown user: "null")
Jan  2 20:03:03 srv4hai postfix/cleanup[399]: 074CB60244: message-id=<20240102190303.074CB60244@mail.viehai.at>
Jan  2 20:03:03 srv4hai postfix/bounce[414]: 057746011E: sender non-delivery notification: 074CB60244
Jan  2 20:03:03 srv4hai postfix/qmgr[28610]: 074CB60244: from=<>, size=16665, nrcpt=1 (queue active)
Jan  2 20:03:03 srv4hai postfix/qmgr[28610]: 057746011E: removed
Jan  2 20:03:03 srv4hai activate_scenario.sh: SHELLY: 'shelly-41'-'41-TBD-Dimmer' --> '0?turn=off&brightness=50'
Jan  2 20:03:03 srv4hai /srv/www/viehai/shelly/proc_url.sh: SHELLY: OF:'/srv/www/viehai/shelly/log_scenarios/2024/01/02/scene_test_41_OFF_20240102_200302_0.log' - shellyUsage:'41-TBD-Dimmer' - scUrl:'http://192.168.12.141/light/0?turn=off&brightness=50' - phName:'NONE'
Jan  2 20:03:03 srv4hai postfix/local[413]: 074CB60244: to=, relay=local, delay=0.02, delays=0.01/0/0/0.01, dsn=2.0.0, status=sent (delivered to command: /bin/procmail)
Jan  2 20:03:03 srv4hai postfix/qmgr[28610]: 074CB60244: removed
Jan  2 20:03:03 srv4hai activate_scenario.sh: SHELLY scenario: 'test_41_OFF(test_41_off)' took 54 msec
Jan  2 20:03:03 srv4hai /srv/www/viehai/shelly/proc_url.sh: SHELLY: grab status via - 'http://192.168.12.141/status'
Jan  2 20:03:03 srv4hai /srv/www/viehai/shelly/proc_url.sh: SHELLY: status: '{"wifi_sta":{"connected":true,"ssid":"viehai","ip":"192.168.12.141","rssi":-57},"cloud":{"enabled":false,"connected":false},"mqtt":{"connected":true},"time":"20:03","unixtime":1704222183,"serial":1,"has_update":false,"mac":"349454723B21","cfg_changed_cnt":0,"actions_stats":{"skipped":0},"lights":[{"ison":false,"source":"http","has_timer":false,"timer_started":0,"timer_duration":0,"timer_remaining":0,"mode":"white","brightness":50,"transition":0}],"meters":[{"power":0.00,"overpower":0.00,"is_valid":true, "timestamp":1704225783,"counters":[0.000, 0.000, 0.000],"total":42}],"inputs":[{"input":0,"event":"","event_cnt":0},{"input":0,"event":"","event_cnt":0}],"tmp":{"tC":43.82,"tF":110.88, "is_valid":true},"calibrated":true,"calib_progress":0,"calib_status":0,"calib_running":0,"wire_mode":1,"forced_neutral":false,"overtemperature":false,"loaderror":0,"overpower":false,"debug":0,"update":{"status":"idle","has_update":false,"new_version":"20230913-114008/v1.14.0-gcb84623","old_version":"20230913-114
Jan  2 20:03:03 srv4hai dhcpd[24585]: DHCPREQUEST for 192.168.12.61 (192.168.12.252) from e8:78:29:c0:c2:4e via enp2s0
Jan  2 20:03:03 srv4hai dhcpd[24585]: DHCPACK on 192.168.12.61 to e8:78:29:c0:c2:4e via enp2s0
Jan  2 20:03:03 srv4hai dhcpd[24585]: execute_statement argv[0] = /usr/bin/curl
Jan  2 20:03:03 srv4hai dhcpd[24585]: execute_statement argv[1] = http://viehai.at/shelly/smartphone.shtml?phoneIP=192.168.12.61&phoneName=fpTom
Jan  2 20:03:03 srv4hai named[14530]: client @0x7fc32811da30 192.168.12.252#39261/key rndc-key: updating zone 'viehai.at/IN': update unsuccessful: fpTom.viehai.at: 'name not in use' prerequisite not satisfied (YXDOMAIN)
Jan  2 20:03:03 srv4hai named[14530]: client @0x7fc328650140 192.168.12.252#59943/key rndc-key: updating zone 'viehai.at/IN': update unsuccessful: fpTom.viehai.at: 'name not in use' prerequisite not satisfied (YXDOMAIN)
Jan  2 20:03:03 srv4hai smartphone.sh: SHELLY - ping_SP.sh started for phoneIP: '192.168.12.61' / 'fpTom'
Jan  2 20:03:03 srv4hai ping_SP.sh: SHELLY ping_SP.sh started
Jan  2 20:03:03 srv4hai ping_SP.sh: SHELLY - new process: '' - '/srv/www/viehai/shelly//meter/ping_SP_0' @~1704222183
Jan  2 20:03:03 srv4hai check_presence.sh: SHELLY (0) what: 'coming' - persPresent: 'false' - anyPresent: 'false'
Jan  2 20:03:03 srv4hai check_presence.sh: SHELLY (0)-coming: NOT activate_scenario.shtml: test_41_ON
Jan  2 20:03:03 srv4hai activate_scenario.sh: SHELLY scenario: 'LOG_gehen(log_gehen)' TO BE EXECUTED
Jan  2 20:03:03 srv4hai postfix/pickup[318]: AB69B6011E: uid=33 from=
Jan  2 20:03:03 srv4hai postfix/cleanup[399]: AB69B6011E: message-id=<20240102190303.AB69B6011E@mail.viehai.at>
Jan  2 20:03:03 srv4hai postfix/qmgr[28610]: AB69B6011E: from=, size=19117, nrcpt=1 (queue active)
Jan  2 20:03:03 srv4hai activate_scenario.sh: SHELLY scenario: 'LOG_gehen(log_gehen)' took 22 msec
Jan  2 20:03:04 srv4hai dovecot: imap-login: Login: user=, method=PLAIN, rip=::1, lip=::1, mpid=915, secured, session=
Jan  2 20:03:04 srv4hai dovecot: imap(miglincit)<915>: Logged out in=137 out=1087 deleted=0 expunged=0 trashed=0 hdr_count=0 hdr_bytes=0 body_count=0 body_bytes=0
Jan  2 20:03:04 srv4hai ping_SP.sh: SHELLY  (1) - pinging 192.168.12.62 0 sucessfully  @~1704222184 - '/srv/www/viehai/shelly//meter/ping_SP_1'
Jan  2 20:03:05 srv4hai postfix/relay/smtp[897]: AB69B6011E: to=, relay=mx02.nic.name[209.131.158.56]:25, delay=1.4, delays=0.02/0.02/1/0.36, dsn=2.0.0, status=sent (250 2.0.0 Ok: queued as C12892019A)
Jan  2 20:03:05 srv4hai postfix/qmgr[28610]: AB69B6011E: removed
Jan  2 20:03:06 srv4hai ping_SP.sh: SHELLY  (0)- pinging 192.168.12.61 0 not answered (1) @~1704222186 - '/srv/www/viehai/shelly//meter/ping_SP_0'
Jan  2 20:03:13 srv4hai activate_scenario.sh: SHELLY scenario: 'herdzeile_UM(herdzeile_um)' TO BE EXECUTED
Jan  2 20:03:13 srv4hai postfix/pickup[318]: 728656011E: uid=33 from=
Jan  2 20:03:13 srv4hai postfix/cleanup[399]: 728656011E: message-id=<20240102190313.728656011E@mail.viehai.at>
Jan  2 20:03:13 srv4hai postfix/qmgr[28610]: 728656011E: from=, size=20601, nrcpt=1 (queue active)
Jan  2 20:03:13 srv4hai postfix/local[413]: 728656011E: 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  2 20:03:13 srv4hai postfix/cleanup[399]: 7717D60244: message-id=<20240102190313.7717D60244@mail.viehai.at>
Jan  2 20:03:13 srv4hai postfix/bounce[414]: 728656011E: sender non-delivery notification: 7717D60244
Jan  2 20:03:13 srv4hai postfix/qmgr[28610]: 7717D60244: from=<>, size=22480, nrcpt=1 (queue active)
Jan  2 20:03:13 srv4hai postfix/qmgr[28610]: 728656011E: removed
Jan  2 20:03:13 srv4hai postfix/local[413]: 7717D60244: to=, relay=local, delay=0.02, delays=0/0/0/0.02, dsn=2.0.0, status=sent (delivered to command: /bin/procmail)
Jan  2 20:03:13 srv4hai postfix/qmgr[28610]: 7717D60244: removed
Jan  2 20:03:13 srv4hai activate_scenario.sh: SHELLY: 'shelly-17'-'Küche Licht Herdzeile' --> '0?turn=toggle&brightness=50'
Jan  2 20:03:13 srv4hai /srv/www/viehai/shelly/proc_url.sh: SHELLY: OF:'/srv/www/viehai/shelly/log_scenarios/2024/01/02/scene_herdzeile_UM_20240102_200313_0.log' - shellyUsage:'Küche Licht Herdzeile' - scUrl:'http://192.168.12.117/white/0?turn=toggle&brightness=50' - phName:'noHandy'
Jan  2 20:03:13 srv4hai activate_scenario.sh: SHELLY: 'shelly-17'-'Küche Licht Herdzeile' --> '1?turn=toggle&brightness=50'
Jan  2 20:03:13 srv4hai /srv/www/viehai/shelly/proc_url.sh: SHELLY: OF:'/srv/www/viehai/shelly/log_scenarios/2024/01/02/scene_herdzeile_UM_20240102_200313_1.log' - shellyUsage:'Küche Licht Herdzeile' - scUrl:'http://192.168.12.117/white/1?turn=toggle&brightness=50' - phName:'noHandy'
Jan  2 20:03:13 srv4hai activate_scenario.sh: SHELLY scenario: 'herdzeile_UM(herdzeile_um)' took 99 msec
Jan  2 20:03:13 srv4hai /srv/www/viehai/shelly/proc_url.sh: SHELLY: grab status via - 'http://192.168.12.117/status'
Jan  2 20:03:13 srv4hai /srv/www/viehai/shelly/proc_url.sh: SHELLY: status: '{"wifi_sta":{"connected":true,"ssid":"viehai","ip":"192.168.12.117","rssi":-79},"cloud":{"enabled":false,"connected":false},"mqtt":{"connected":false},"time":"20:03","unixtime":1704222193,"serial":1,"has_update":false,"mac":"E8DB84A891C9","cfg_changed_cnt":0,"actions_stats":{"skipped":0},"mode":"white","input":0,"total_power":26.42,"lights":[{"ison":false,"source":"http","has_timer":false,"timer_started":0,"timer_duration":0,"timer_remaining":0,"mode":"white","brightness":50,"transition":0,"power":13.21,"overpower":false},{"ison":false,"source":"http","has_timer":false,"timer_started":0,"timer_duration":0,"timer_remaining":0,"mode":"white","brightness":50,"transition":0,"power":13.21,"overpower":false},{"ison":false,"source":"http","has_timer":false,"timer_started":0,"timer_duration":0,"timer_remaining":0,"mode":"white","brightness":50,"transition":0,"power":0.00,"overpower":false},{"ison":false,"source":"http","has_timer":false,"timer_started":0,"timer_duration":0,"timer_remaining":0,"mode":
Jan  2 20:03:13 srv4hai /srv/www/viehai/shelly/proc_url.sh: SHELLY: grab status via - 'http://192.168.12.117/status'
Jan  2 20:03:13 srv4hai /srv/www/viehai/shelly/proc_url.sh: SHELLY: status: '{"wifi_sta":{"connected":true,"ssid":"viehai","ip":"192.168.12.117","rssi":-79},"cloud":{"enabled":false,"connected":false},"mqtt":{"connected":false},"time":"20:03","unixtime":1704222193,"serial":1,"has_update":false,"mac":"E8DB84A891C9","cfg_changed_cnt":0,"actions_stats":{"skipped":0},"mode":"white","input":0,"total_power":26.42,"lights":[{"ison":false,"source":"http","has_timer":false,"timer_started":0,"timer_duration":0,"timer_remaining":0,"mode":"white","brightness":50,"transition":0,"power":13.21,"overpower":false},{"ison":false,"source":"http","has_timer":false,"timer_started":0,"timer_duration":0,"timer_remaining":0,"mode":"white","brightness":50,"transition":0,"power":13.21,"overpower":false},{"ison":false,"source":"http","has_timer":false,"timer_started":0,"timer_duration":0,"timer_remaining":0,"mode":"white","brightness":50,"transition":0,"power":0.00,"overpower":false},{"ison":false,"source":"http","has_timer":false,"timer_started":0,"timer_duration":0,"timer_remaining":0,"mode":
Jan  2 20:03:19 srv4hai ping_SP.sh: SHELLY  (0)- pinging 192.168.12.61 1 not answered (1) @~1704222199 - '/srv/www/viehai/shelly//meter/ping_SP_0'
Jan  2 20:03:31 srv4hai systemd[1]: Stopping LSB: DHCP server...
Jan  2 20:03:31 srv4hai isc-dhcp-server[1081]: Stopping ISC DHCPv4 server: dhcpd.
Jan  2 20:03:31 srv4hai systemd[1]: isc-dhcp-server.service: Succeeded.
Jan  2 20:03:31 srv4hai systemd[1]: Stopped LSB: DHCP server.
Jan  2 20:03:31 srv4hai systemd[1]: isc-dhcp-server.service: Found left-over process 24585 (dhcpd) in control group while starting unit. Ignoring.
Jan  2 20:03:31 srv4hai systemd[1]: This usually indicates unclean termination of a previous run, or service implementation deficiencies.
Jan  2 20:03:31 srv4hai systemd[1]: isc-dhcp-server.service: Found left-over process 809 (curl) in control group while starting unit. Ignoring.
Jan  2 20:03:31 srv4hai systemd[1]: This usually indicates unclean termination of a previous run, or service implementation deficiencies.
Jan  2 20:03:31 srv4hai systemd[1]: Starting LSB: DHCP server...
Jan  2 20:03:31 srv4hai isc-dhcp-server[1094]: Launching IPv4 server only.
Jan  2 20:03:31 srv4hai dhcpd[1107]: Wrote 0 deleted host decls to leases file.
Jan  2 20:03:31 srv4hai dhcpd[1107]: Wrote 0 new dynamic host decls to leases file.
Jan  2 20:03:31 srv4hai dhcpd[1107]: Wrote 1 leases to leases file.
Jan  2 20:03:31 srv4hai dhcpd[1107]: Server starting service.
Jan  2 20:03:32 srv4hai dhcpd[1107]: DHCPDISCOVER from c8:db:26:0c:f3:8e via enp2s0
Jan  2 20:03:32 srv4hai dhcpd[1107]: DHCPOFFER on 192.168.12.28 to c8:db:26:0c:f3:8e via enp2s0
Jan  2 20:03:32 srv4hai dhcpd[1107]: execute_statement argv[0] = /srv/www/viehai/shelly/dhcpcommit.sh
Jan  2 20:03:32 srv4hai dhcpd[1107]: execute_statement argv[1] = 192.168.12.28
Jan  2 20:03:32 srv4hai dhcpd[1107]: execute_statement argv[2] = harmonyhub
Jan  2 20:03:32 srv4hai dhcpd[1107]: DHCPREQUEST for 192.168.12.28 (192.168.12.252) from c8:db:26:0c:f3:8e via enp2s0
Jan  2 20:03:32 srv4hai dhcpd[1107]: DHCPACK on 192.168.12.28 to c8:db:26:0c:f3:8e via enp2s0
Jan  2 20:03:32 srv4hai named[14530]: client @0x7fc308060380 192.168.12.252#37389/key rndc-key: updating zone 'viehai.at/IN': update unsuccessful: harmonyhub.viehai.at: 'name not in use' prerequisite not satisfied (YXDOMAIN)
Jan  2 20:03:32 srv4hai named[14530]: client @0x7fc32409b3f0 192.168.12.252#56657/key rndc-key: signer "rndc-key" approved
Jan  2 20:03:32 srv4hai named[14530]: client @0x7fc32409b3f0 192.168.12.252#56657/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'harmonyhub.viehai.at' TXT
Jan  2 20:03:32 srv4hai named[14530]: client @0x7fc32409b3f0 192.168.12.252#56657/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'harmonyhub.viehai.at' TXT "3122b5a8b4281156e6f217b32b7e260713"
Jan  2 20:03:32 srv4hai named[14530]: client @0x7fc32409b3f0 192.168.12.252#56657/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'harmonyhub.viehai.at' A
Jan  2 20:03:32 srv4hai named[14530]: client @0x7fc32409b3f0 192.168.12.252#56657/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'harmonyhub.viehai.at' A 192.168.12.28
Jan  2 20:03:32 srv4hai dhcpd[1107]: Added new forward map from harmonyhub.viehai.at to 192.168.12.28
Jan  2 20:03:32 srv4hai dhcpcommit.sh: SHELLY ip:'192.168.12.28'(28) device 'harmonyhub'
Jan  2 20:03:32 srv4hai named[14530]: client @0x7fc31400b700 192.168.12.252#35089/key rndc-key: signer "rndc-key" approved
Jan  2 20:03:32 srv4hai named[14530]: client @0x7fc31400b700 192.168.12.252#35089/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': deleting rrset at '28.12.168.192.in-addr.arpa' PTR
Jan  2 20:03:32 srv4hai named[14530]: client @0x7fc31400b700 192.168.12.252#35089/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.
Jan  2 20:03:32 srv4hai dhcpd[1107]: Added reverse map from 28.12.168.192.in-addr.arpa. to harmonyhub.viehai.at
Jan  2 20:03:32 srv4hai dhcpcommit.sh: SHELLY device 'harmonyhub' known and accepted
Jan  2 20:03:32 srv4hai ping_SP.sh: SHELLY  (0)- pinging 192.168.12.61 2 not answered (1) @~1704222212 - '/srv/www/viehai/shelly//meter/ping_SP_0'
Jan  2 20:03:32 srv4hai ping_SP.sh: SHELLY  (0)- pinging 192.168.12.61 3 not answered - aborting (828) @~1704222212 - rm '/srv/www/viehai/shelly//meter/ping_SP_0'
Jan  2 20:03:32 srv4hai check_presence.sh: SHELLY (0) what: 'presence' - persPresent: 'false' - anyPresent: 'false'
Jan  2 20:03:32 srv4hai check_presence.sh: SHELLY (0)-presence: activate_scenario.shtml: test_41_OFF

finished