activate_scenario.sh
Sat Sep 7 08:39:51 CEST 2024
scenario: sekr_UM
source: 192.168.12.101
'day' <--> DayTime=checked , NightTime=checked
-> execution of scenario
-> sending email(s) to 'null'
scenario: 'Sekretär Licht UM-schalten' - 'sekr_UM' - 'sekr_um'
Licht Sekretär (/srv/www/viehai/shelly/log_scenarios/2024/09/07/_0.log)
vorher: 08:39:51.126
http://192.168.12.123/relay/0?turn=toggle |
|---|
"ison": true,
"has_timer": false,
"timer_started": 0,
"timer_duration": 0,
"timer_remaining": 0,
"source": "http"
|
nachher: 08:39:51.205
Dauer: 79 msec
phName: 'shelly-01:'Wandlicht beim Esstisch''
scenario: 'Sekretär Licht UM-schalten' - 'sekr_UM' - 'sekr_um'
urls : 1
vorher : 08:39:51.092
nachher: 08:39:51.211
Dauer : 120 msec
outfile: '/srv/www/viehai/shelly/log_scenarios/2024/09/07//scene_sekr_UM_20240907_083951.txt'
syslog
Sep 7 08:36:01 srv4hai CRON[17211]: (root) CMD (/etc/linetest/linetest.sh)
Sep 7 08:36:52 srv4hai dovecot: imap-login: Login: user=, method=PLAIN, rip=::1, lip=::1, mpid=17227, secured, session=<6uLQv4EhLIYAAAAAAAAAAAAAAAAAAAAB>
Sep 7 08:36:52 srv4hai dovecot: imap(miglincit)<17227><6uLQv4EhLIYAAAAAAAAAAAAAAAAAAAAB>: Logged out in=137 out=1088 deleted=0 expunged=0 trashed=0 hdr_count=0 hdr_bytes=0 body_count=0 body_bytes=0
Sep 7 08:37:01 srv4hai CRON[17229]: (root) CMD (/etc/linetest/linetest.sh)
Sep 7 08:37:20 srv4hai fetchmail[1651]: 7 messages (7 seen) for rozmig at mail.akis.at (1753652 octets).
Sep 7 08:37:20 srv4hai fetchmail[1651]: 51772 messages (51772 seen) for tmiglinci at mail.akis.at (-29875273 octets).
Sep 7 08:37:21 srv4hai fetchmail[1651]: 10688 messages (10688 seen) for srozum at mail.akis.at (1290220297 octets).
Sep 7 08:37:21 srv4hai fetchmail[1651]: 25762 messages (25762 seen) for mrozum at mail.akis.at (188766658 octets).
Sep 7 08:37:22 srv4hai fetchmail[1651]: 1142 messages (1142 seen) for admin@bastelstube.wien at pop3.world4you.com (51614275 octets).
Sep 7 08:37:55 srv4hai postfix/anvil[17050]: statistics: max connection rate 1/60s for (smtp:94.141.120.187) at Sep 7 08:31:09
Sep 7 08:37:55 srv4hai postfix/anvil[17050]: statistics: max connection count 1 for (smtp:94.141.120.187) at Sep 7 08:31:09
Sep 7 08:37:55 srv4hai postfix/anvil[17050]: statistics: max cache size 1 at Sep 7 08:31:09
Sep 7 08:38:01 srv4hai CRON[17243]: (root) CMD (/etc/linetest/linetest.sh)
Sep 7 08:38:03 srv4hai common[17251]: SHELLY common.sh inkludiert von ./bt_scan.sh
Sep 7 08:38:04 srv4hai bt_scan[17251]: SHELLY - who: 'Thomas' / phoneName: 'FP4_Thomas' / '0' / shellyIP: '192.168.12.61' - found: 'Yes'
Sep 7 08:38:04 srv4hai bt_scan[17251]: SHELLY - ping_SP.sh started for BTmac: '0' - IPv4: '192.168.12.61'
Sep 7 08:38:04 srv4hai common[17282]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly//ping_SP.sh
Sep 7 08:38:04 srv4hai ping_SP[17282]: SHELLY ping_SP.sh started from bt_scan, user:'www-data'
Sep 7 08:38:04 srv4hai common[17303]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly//check_presence.sh
Sep 7 08:38:04 srv4hai common.sh: SHELLY: BTstatus[0]:'BTdweet_not_set' dweetAge:'0'=1725691084-1725691084
Sep 7 08:38:04 srv4hai check_presence[17303]: SHELLY (0) found /srv/www/viehai/shelly//meter/ping_SP_0.TRY} and BTdweet_not_set//srv/www/viehai/shelly//meter/BTscan_BTid_0.Yes
Sep 7 08:38:04 srv4hai common.sh: SHELLY: BTstatus[1]:'BTdweet_not_set' dweetAge:'0'=1725691084-1725691084
Sep 7 08:38:04 srv4hai check_presence[17303]: SHELLY (1) found /srv/www/viehai/shelly//meter/ping_SP_1.DEAD and BTdweet_not_set//srv/www/viehai/shelly//meter/BTscan_BTid_1.No
Sep 7 08:38:04 srv4hai common.sh: SHELLY: BTstatus[2]:'BTdweet_not_set' dweetAge:'0'=1725691084-1725691084
Sep 7 08:38:04 srv4hai check_presence[17303]: 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
Sep 7 08:38:04 srv4hai check_presence[17303]: SHELLY (ping_SP__bt_scan)-(0) what: 'coming' - persPresent: '(__/__) (__/__) (__/__)' - anyPresent: 'false' - otherPresent:'false'
Sep 7 08:38:04 srv4hai postfix/pickup[5566]: 99BAA6345B: uid=33 from=
Sep 7 08:38:04 srv4hai postfix/cleanup[17407]: 99BAA6345B: message-id=<20240907063804.99BAA6345B@mail.viehai.at>
Sep 7 08:38:04 srv4hai postfix/qmgr[8566]: 99BAA6345B: from=, size=3877, nrcpt=1 (queue active)
Sep 7 08:38:04 srv4hai check_presence[17303]: SHELLY - check 'coming': anyPresent(false) - lScene(scene_offAll) - sceneONsmall(vorraumOn)
Sep 7 08:38:04 srv4hai check_presence[17303]: SHELLY (ping_SP__bt_scan)-(0)-coming: NOT activate_scenario.shtml: vorraumOn
Sep 7 08:38:04 srv4hai ping_SP[17282]: SHELLY check_presence.sh coming 0 ping_SP__bt_scan
Sep 7 08:38:04 srv4hai ping_SP[17282]: SHELLY - new process for '192.168.12.61' - '/srv/www/viehai/shelly//meter/ping_SP_0' @~1725691084
Sep 7 08:38:05 srv4hai postfix/smtpd[17446]: connect from unknown[94.141.120.187]
Sep 7 08:38:05 srv4hai postfix/smtpd[17446]: warning: unknown[94.141.120.187]: SASL LOGIN authentication failed: Invalid authentication mechanism
Sep 7 08:38:05 srv4hai postfix/smtpd[17446]: lost connection after AUTH from unknown[94.141.120.187]
Sep 7 08:38:05 srv4hai postfix/smtpd[17446]: disconnect from unknown[94.141.120.187] ehlo=1 auth=0/1 commands=1/2
Sep 7 08:38:05 srv4hai postfix/relay/smtp[17414]: 99BAA6345B: to=, relay=mx04.nic.name[209.131.160.34]:25, delay=1.1, delays=0.02/0.01/0.84/0.24, dsn=2.0.0, status=sent (250 2.0.0 Ok: queued as 8758B800EB)
Sep 7 08:38:05 srv4hai postfix/qmgr[8566]: 99BAA6345B: removed
Sep 7 08:38:15 srv4hai dhcpd[30731]: DHCPDISCOVER from e8:78:29:c0:c2:4e via enp2s0
Sep 7 08:38:15 srv4hai dhcpd[30731]: DHCPOFFER on 192.168.12.61 to e8:78:29:c0:c2:4e via enp2s0
Sep 7 08:38:15 srv4hai dhcpd[30731]: execute_statement argv[0] = /srv/www/viehai/shelly/smartphone.sh
Sep 7 08:38:15 srv4hai dhcpd[30731]: execute_statement argv[1] = 192.168.12.61
Sep 7 08:38:15 srv4hai dhcpd[30731]: execute_statement argv[2] = fpThomas
Sep 7 08:38:15 srv4hai common[17453]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly/smartphone.sh
Sep 7 08:38:20 srv4hai ping_SP[17282]: SHELLY (0)- ping 192.168.12.61 0 not answered (1) @~1725691100 - 'ping_SP_0'
Sep 7 08:38:25 srv4hai smartphone.sh: SHELLY - ping_SP.sh already started for phoneIP: '192.168.12.61' / 'fpThomas' / '0'
Sep 7 08:38:26 srv4hai dhcpd[30731]: DHCPREQUEST for 192.168.12.61 (192.168.12.252) from e8:78:29:c0:c2:4e via enp2s0
Sep 7 08:38:26 srv4hai dhcpd[30731]: DHCPACK on 192.168.12.61 to e8:78:29:c0:c2:4e via enp2s0
Sep 7 08:38:26 srv4hai dhcpd[30731]: execute_statement argv[0] = /srv/www/viehai/shelly/smartphone.sh
Sep 7 08:38:26 srv4hai dhcpd[30731]: execute_statement argv[1] = 192.168.12.61
Sep 7 08:38:26 srv4hai dhcpd[30731]: execute_statement argv[2] = fpThomas
Sep 7 08:38:26 srv4hai common[17487]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly/smartphone.sh
Sep 7 08:38:36 srv4hai smartphone.sh: SHELLY - ping_SP.sh already started for phoneIP: '192.168.12.61' / 'fpThomas' / '0'
Sep 7 08:38:36 srv4hai dhcpd[30731]: DHCPREQUEST for 192.168.12.61 (192.168.12.252) from e8:78:29:c0:c2:4e via enp2s0
Sep 7 08:38:36 srv4hai dhcpd[30731]: DHCPACK on 192.168.12.61 to e8:78:29:c0:c2:4e via enp2s0
Sep 7 08:38:36 srv4hai dhcpd[30731]: execute_statement argv[0] = /srv/www/viehai/shelly/smartphone.sh
Sep 7 08:38:36 srv4hai dhcpd[30731]: execute_statement argv[1] = 192.168.12.61
Sep 7 08:38:36 srv4hai dhcpd[30731]: execute_statement argv[2] = fpThomas
Sep 7 08:38:36 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: updating zone 'viehai.at/IN': update unsuccessful: fpThomas.viehai.at: 'name not in use' prerequisite not satisfied (YXDOMAIN)
Sep 7 08:38:36 srv4hai common[17515]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly/smartphone.sh
Sep 7 08:38:44 srv4hai ping_SP[17282]: SHELLY (0) - ping 192.168.12.61 1 sucessfully @~1725691124 - 'ping_SP_0'
Sep 7 08:38:44 srv4hai ping_SP[17282]: SHELLY (0) - ping 192.168.12.61 pCnt:'1'
Sep 7 08:38:46 srv4hai smartphone.sh: SHELLY - ping_SP.sh already started for phoneIP: '192.168.12.61' / 'fpThomas' / '0'
Sep 7 08:38:46 srv4hai dhcpd[30731]: DHCPREQUEST for 192.168.12.61 (192.168.12.252) from e8:78:29:c0:c2:4e via enp2s0
Sep 7 08:38:46 srv4hai dhcpd[30731]: DHCPACK on 192.168.12.61 to e8:78:29:c0:c2:4e via enp2s0
Sep 7 08:38:46 srv4hai dhcpd[30731]: execute_statement argv[0] = /srv/www/viehai/shelly/smartphone.sh
Sep 7 08:38:46 srv4hai dhcpd[30731]: execute_statement argv[1] = 192.168.12.61
Sep 7 08:38:46 srv4hai dhcpd[30731]: execute_statement argv[2] = fpThomas
Sep 7 08:38:46 srv4hai named[30406]: client @0x7f934c037ed0 192.168.12.252#33001/key rndc-key: updating zone 'viehai.at/IN': update unsuccessful: fpThomas.viehai.at: 'name not in use' prerequisite not satisfied (YXDOMAIN)
Sep 7 08:38:46 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: updating zone 'viehai.at/IN': update unsuccessful: fpThomas.viehai.at: 'name not in use' prerequisite not satisfied (YXDOMAIN)
Sep 7 08:38:46 srv4hai common[17549]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly/smartphone.sh
Sep 7 08:38:56 srv4hai smartphone.sh: SHELLY - ping_SP.sh already started for phoneIP: '192.168.12.61' / 'fpThomas' / '0'
Sep 7 08:38:56 srv4hai dhcpd[30731]: DHCPREQUEST for 192.168.12.61 (192.168.12.252) from e8:78:29:c0:c2:4e via enp2s0
Sep 7 08:38:56 srv4hai dhcpd[30731]: DHCPACK on 192.168.12.61 to e8:78:29:c0:c2:4e via enp2s0
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: updating zone 'viehai.at/IN': update unsuccessful: fpThomas.viehai.at: 'name not in use' prerequisite not satisfied (YXDOMAIN)
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: signer "rndc-key" approved
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'fpThomas.viehai.at' TXT
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'fpThomas.viehai.at' TXT "310ebd0eafccd9c2e311facf8a4b0e4ad2"
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'fpThomas.viehai.at' A
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'fpThomas.viehai.at' A 192.168.12.61
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: signer "rndc-key" approved
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'fpThomas.viehai.at' TXT
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'fpThomas.viehai.at' TXT "310ebd0eafccd9c2e311facf8a4b0e4ad2"
Sep 7 08:38:56 srv4hai dhcpd[30731]: Added new forward map from fpThomas.viehai.at to 192.168.12.61
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'fpThomas.viehai.at' A
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'fpThomas.viehai.at' A 192.168.12.61
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: signer "rndc-key" approved
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'fpThomas.viehai.at' TXT
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'fpThomas.viehai.at' TXT "310ebd0eafccd9c2e311facf8a4b0e4ad2"
Sep 7 08:38:56 srv4hai dhcpd[30731]: Added new forward map from fpThomas.viehai.at to 192.168.12.61
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'fpThomas.viehai.at' A
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'fpThomas.viehai.at' A 192.168.12.61
Sep 7 08:38:56 srv4hai dhcpd[30731]: Added new forward map from fpThomas.viehai.at to 192.168.12.61
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: signer "rndc-key" approved
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'fpThomas.viehai.at' TXT
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'fpThomas.viehai.at' TXT "310ebd0eafccd9c2e311facf8a4b0e4ad2"
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'fpThomas.viehai.at' A
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'fpThomas.viehai.at' A 192.168.12.61
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: signer "rndc-key" approved
Sep 7 08:38:56 srv4hai dhcpd[30731]: Added new forward map from fpThomas.viehai.at to 192.168.12.61
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': deleting rrset at '61.12.168.192.in-addr.arpa' PTR
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/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.
Sep 7 08:38:56 srv4hai dhcpd[30731]: Added reverse map from 61.12.168.192.in-addr.arpa. to fpThomas.viehai.at
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: signer "rndc-key" approved
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': deleting rrset at '61.12.168.192.in-addr.arpa' PTR
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/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.
Sep 7 08:38:56 srv4hai dhcpd[30731]: Added reverse map from 61.12.168.192.in-addr.arpa. to fpThomas.viehai.at
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: signer "rndc-key" approved
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': deleting rrset at '61.12.168.192.in-addr.arpa' PTR
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/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.
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: signer "rndc-key" approved
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': deleting rrset at '61.12.168.192.in-addr.arpa' PTR
Sep 7 08:38:56 srv4hai named[30406]: client @0x7f931c0a07f0 192.168.12.252#57421/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.
Sep 7 08:38:56 srv4hai dhcpd[30731]: Added reverse map from 61.12.168.192.in-addr.arpa. to fpThomas.viehai.at
Sep 7 08:38:56 srv4hai dhcpd[30731]: Added reverse map from 61.12.168.192.in-addr.arpa. to fpThomas.viehai.at
Sep 7 08:39:00 srv4hai systemd[1]: Starting Clean php session files...
Sep 7 08:39:00 srv4hai systemd[1]: phpsessionclean.service: Succeeded.
Sep 7 08:39:00 srv4hai systemd[1]: Started Clean php session files.
Sep 7 08:39:01 srv4hai CRON[17668]: (root) CMD (/etc/linetest/linetest.sh)
Sep 7 08:39:01 srv4hai CRON[17669]: (root) CMD ( [ -x /usr/lib/php/sessionclean ] && if [ ! -d /run/systemd/system ]; then /usr/lib/php/sessionclean; fi)
Sep 7 08:39:51 srv4hai activate_scenario[17684]: SHELLY scenario: 'sekr_UM(sekr_um)' started
Sep 7 08:39:51 srv4hai activate_scenario[17684]: SHELLY dayState='day' <--> DayTime=checked NightTime=checked - shelly-01:'Wandlicht beim Esstisch'
finished