activate_scenario.sh
Sat Jan 18 15:50:15 CET 2025
scenario: pcON
origin: dhcpcommit.sh-pchai7x

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

scenario: 'Schreibtisch Thomas EIN-schalten' - 'pcON' - 'pcon'

TB Schreibtischlampe (/srv/www/viehai/shelly/log_scenarios/2025/01/18/_0.log)

vorher: 15:50:15.837

http://192.168.12.120/relay/0?turn=on
  "ison": true,
  "has_timer": false,
  "timer_started": 0,
  "timer_duration": 0,
  "timer_remaining": 0,
  "source": "http"

nachher: 15:50:15.862
Dauer: 25 msec phName: 'origin:'dhcpcommit.sh-pchai7x''


scenario: 'Schreibtisch Thomas EIN-schalten' - 'pcON' - 'pcon'

urls : 1
vorher : 15:50:15.791
nachher: 15:50:15.868
Dauer : 79 msec
outfile: '/srv/www/viehai/shelly/log_scenarios/2025/01/18//scene_pcON_20250118_155015.txt'


syslog

Jan 18 15:47:00 srv4hai common[8040]: SHELLY common.sh inkludiert von ./bt_scan.sh
Jan 18 15:47:01 srv4hai CRON[8055]: (root) CMD (/etc/linetest/linetest.sh)
Jan 18 15:47:11 srv4hai bt_scan[8040]: SHELLY - who: 'Grete' / phoneName: 'S20_Grete' / '1' / shellyIP: '192.168.12.62' - found: 'Yes'
Jan 18 15:47:11 srv4hai bt_scan[8040]: SHELLY - ping_SP.sh already running for BTmac: '1' - IPv4: '192.168.12.62'
Jan 18 15:47:24 srv4hai ping_SP[26718]: SHELLY (1) - ping 192.168.12.62 1 sucessfully  @~1737211644 - 'ping_SP_1'
Jan 18 15:47:24 srv4hai ping_SP[26718]: SHELLY (1) - ping 192.168.12.62 pCnt:'1'
Jan 18 15:47:30 srv4hai dhcpd[4995]: uid lease 192.168.12.56 for client cc:8d:a2:60:52:b8 is duplicate on 192.168.12.0/24
Jan 18 15:47:30 srv4hai dhcpd[4995]: DHCPDISCOVER from cc:8d:a2:60:52:b8 via enp2s0
Jan 18 15:47:30 srv4hai dhcpd[4995]: DHCPOFFER on 192.168.12.101 to cc:8d:a2:60:52:b8 via enp2s0
Jan 18 15:47:30 srv4hai dhcpd[4995]: uid lease 192.168.12.56 for client cc:8d:a2:60:52:b8 is duplicate on 192.168.12.0/24
Jan 18 15:47:30 srv4hai dhcpd[4995]: execute_statement argv[0] = /srv/www/viehai/shelly/json.sh
Jan 18 15:47:30 srv4hai dhcpd[4995]: execute_statement argv[1] = 192.168.12.101
Jan 18 15:47:30 srv4hai dhcpd[4995]: execute_statement argv[2] = shelly-01
Jan 18 15:47:30 srv4hai dhcpd[4995]: DHCPREQUEST for 192.168.12.101 (192.168.12.252) from cc:8d:a2:60:52:b8 via enp2s0
Jan 18 15:47:30 srv4hai dhcpd[4995]: DHCPACK on 192.168.12.101 to cc:8d:a2:60:52:b8 via enp2s0
Jan 18 15:47:30 srv4hai named[30406]: client @0x7f93300b2620 192.168.12.252#43989/key rndc-key: updating zone 'viehai.at/IN': update unsuccessful: shelly-01.viehai.at: 'name not in use' prerequisite not satisfied (YXDOMAIN)
Jan 18 15:47:30 srv4hai named[30406]: client @0x7f931c03b370 192.168.12.252#35241/key rndc-key: signer "rndc-key" approved
Jan 18 15:47:30 srv4hai named[30406]: client @0x7f931c03b370 192.168.12.252#35241/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'shelly-01.viehai.at' TXT
Jan 18 15:47:30 srv4hai named[30406]: client @0x7f931c03b370 192.168.12.252#35241/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'shelly-01.viehai.at' TXT "31166740fe21d7ece7561d62986d2b8644"
Jan 18 15:47:30 srv4hai named[30406]: client @0x7f931c03b370 192.168.12.252#35241/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'shelly-01.viehai.at' A
Jan 18 15:47:30 srv4hai named[30406]: client @0x7f931c03b370 192.168.12.252#35241/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'shelly-01.viehai.at' A 192.168.12.101
Jan 18 15:47:30 srv4hai dhcpd[4995]: Added new forward map from shelly-01.viehai.at to 192.168.12.101
Jan 18 15:47:30 srv4hai named[30406]: client @0x7f934c09fdf0 192.168.12.252#45079/key rndc-key: signer "rndc-key" approved
Jan 18 15:47:30 srv4hai named[30406]: client @0x7f934c09fdf0 192.168.12.252#45079/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': deleting rrset at '101.12.168.192.in-addr.arpa' PTR
Jan 18 15:47:30 srv4hai named[30406]: client @0x7f934c09fdf0 192.168.12.252#45079/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': adding an RR at '101.12.168.192.in-addr.arpa' PTR shelly-01.viehai.at.
Jan 18 15:47:30 srv4hai dhcpd[4995]: Added reverse map from 101.12.168.192.in-addr.arpa. to shelly-01.viehai.at
Jan 18 15:47:30 srv4hai common[8105]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly/grab_shelly.sh
Jan 18 15:47:30 srv4hai grab_shelly.sh: SHELLY shellyName/1:'shelly-01' - shIP/2:'' perform:'conf'
Jan 18 15:47:31 srv4hai conf_shelly.sh: SHELLY: PARAMS  shName/1:'shelly-01' - shIP/2:'192.168.12.101'
Jan 18 15:47:31 srv4hai conf_shelly.sh: SHELLY: usage/name 'WZ Licht Esstisch' already set for '192.168.12.101'
Jan 18 15:47:31 srv4hai conf_shelly.sh: SHELLY:'shelly-01' 'conf(0)' - allready transmitted - skipping
Jan 18 15:47:31 srv4hai conf_shelly.sh: SHELLY:'shelly-01' 'conf(1)' - allready transmitted - skipping
Jan 18 15:47:31 srv4hai conf_shelly.sh: SHELLY:'shelly-01' 'conf(2)' - allready transmitted - skipping
Jan 18 15:47:38 srv4hai dovecot: imap-login: Login: user=, method=PLAIN, rip=::1, lip=::1, mpid=8192, secured, session=
Jan 18 15:47:38 srv4hai dovecot: imap(miglincit)<8192>: Logged out in=137 out=1088 deleted=0 expunged=0 trashed=0 hdr_count=0 hdr_bytes=0 body_count=0 body_bytes=0
Jan 18 15:47:59 srv4hai dovecot: imap-login: Login: user=, method=PLAIN, rip=::1, lip=::1, mpid=8201, secured, session=
Jan 18 15:47:59 srv4hai dovecot: imap(rozumm)<8201>: Logged out in=92 out=1061 deleted=0 expunged=0 trashed=0 hdr_count=0 hdr_bytes=0 body_count=0 body_bytes=0
Jan 18 15:48:01 srv4hai ping_SP[396]: SHELLY (0) - ping 192.168.12.61 1 sucessfully  @~1737211681 - 'ping_SP_0'
Jan 18 15:48:01 srv4hai ping_SP[396]: SHELLY (0) - ping 192.168.12.61 pCnt:'1'
Jan 18 15:48:01 srv4hai CRON[8217]: (root) CMD (/etc/linetest/linetest.sh)
Jan 18 15:48:05 srv4hai fetchmail[1651]: 7 messages (7 seen) for rozmig at mail.akis.at (1753652 octets).
Jan 18 15:48:06 srv4hai fetchmail[1651]: 61711 messages (61711 seen) for tmiglinci at mail.akis.at (761304900 octets).
Jan 18 15:48:06 srv4hai fetchmail[1651]: 11402 messages (11402 seen) for srozum at mail.akis.at (1359360606 octets).
Jan 18 15:48:07 srv4hai fetchmail[1651]: 28396 messages (28396 seen) for mrozum at mail.akis.at (575383563 octets).
Jan 18 15:48:08 srv4hai fetchmail[1651]: 1162 messages (1162 seen) for admin@bastelstube.wien at pop3.world4you.com (52206525 octets).
Jan 18 15:48:08 srv4hai common[8223]: SHELLY common.sh inkludiert von ./bt_scan.sh
Jan 18 15:48:12 srv4hai activate_scenario[8238]: SHELLY last scenario: 'vorraumOn' @ '150935' from 'scene_vorraumOn_20250118_150935.txt' - delta=23
Jan 18 15:48:12 srv4hai activate_scenario[8238]:        dateutils.ddiff -i '%Y%m%d%H%M%s' 20250118154812 20250118150935  -f '%S'
Jan 18 15:48:12 srv4hai activate_scenario[8238]: SHELLY  new scenario: 'buero_UM' different - GO ON
Jan 18 15:48:12 srv4hai activate_scenario[8238]: SHELLY scenario: 'buero_UM(buero_um)' started
Jan 18 15:48:12 srv4hai activate_scenario[8238]: SHELLY dayState='day' <--> DayTime=checked NightTime=checked - shelly-40:'TB Licht'
Jan 18 15:48:12 srv4hai activate_scenario[8238]: SHELLY scenario: 'buero_UM(buero_um)' TO BE EXECUTED, shelly-40:'TB Licht'
Jan 18 15:48:12 srv4hai postfix/pickup[32558]: 9F87263463: uid=33 from=
Jan 18 15:48:12 srv4hai postfix/cleanup[8303]: 9F87263463: message-id=<20250118144812.9F87263463@mail.viehai.at>
Jan 18 15:48:12 srv4hai postfix/qmgr[8566]: 9F87263463: from=, size=14244, nrcpt=1 (queue active)
Jan 18 15:48:12 srv4hai activate_scenario[8238]: SHELLY: scenario: 'buero_UM(buero_um)'-'shelly-08'-'TB Regallicht' --> '0?turn=toggle'
Jan 18 15:48:12 srv4hai postfix/local[8316]: 9F87263463: to=, orig_to=, relay=local, delay=0.06, delays=0.05/0.01/0/0.01, dsn=5.1.1, status=bounced (unknown user: "null")
Jan 18 15:48:12 srv4hai postfix/cleanup[8303]: AA57463464: message-id=<20250118144812.AA57463464@mail.viehai.at>
Jan 18 15:48:12 srv4hai proc_url[8321]: SHELLY: OF:'/srv/www/viehai/shelly/log_scenarios/2025/01/18/_0.log' - shellyUsage:'TB Regallicht' - scUrl:'http://192.168.12.108/relay/0?turn=toggle' - phName:'shelly-40:'TB Licht''
Jan 18 15:48:12 srv4hai postfix/bounce[8317]: 9F87263463: sender non-delivery notification: AA57463464
Jan 18 15:48:12 srv4hai postfix/qmgr[8566]: AA57463464: from=<>, size=16123, nrcpt=1 (queue active)
Jan 18 15:48:12 srv4hai postfix/qmgr[8566]: 9F87263463: removed
Jan 18 15:48:12 srv4hai postfix/local[8316]: AA57463464: to=, relay=local, delay=0.01, delays=0/0/0/0.01, dsn=2.0.0, status=sent (delivered to command: /bin/procmail)
Jan 18 15:48:12 srv4hai postfix/qmgr[8566]: AA57463464: removed
Jan 18 15:48:12 srv4hai activate_scenario[8238]: SHELLY: scenario: 'buero_UM(buero_um)'-'shelly-40'-'TB Licht' --> '0?turn=toggle'
Jan 18 15:48:12 srv4hai proc_url[8333]: SHELLY: OF:'/srv/www/viehai/shelly/log_scenarios/2025/01/18/_1.log' - shellyUsage:'TB Licht' - scUrl:'http://192.168.12.140/relay/0?turn=toggle' - phName:'shelly-40:'TB Licht''
Jan 18 15:48:12 srv4hai activate_scenario[8238]: SHELLY scenario: 'buero_UM(buero_um)' took 116 msec, shelly-40:'TB Licht'
Jan 18 15:48:18 srv4hai bt_scan[8223]: SHELLY - who: 'Grete' / phoneName: 'S20_Grete' / '1' / shellyIP: '192.168.12.62' - found: 'No'
Jan 18 15:48:18 srv4hai bt_scan[8223]: SHELLY - lost BT-connection to BTmac: '1' found: 'No' - check presence
Jan 18 15:48:19 srv4hai common[8394]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly//check_presence.sh
Jan 18 15:48:19 srv4hai common.sh: SHELLY: BTstatus[0]:'On' dweetAge:'10'=1737211699-1737211689
Jan 18 15:48:19 srv4hai check_presence[8394]: SHELLY (0) found /srv/www/viehai/shelly//meter/ping_SP_0.LIVE and On//srv/www/viehai/shelly//meter/BTscan_BTid_0.Yes
Jan 18 15:48:19 srv4hai check_presence[8394]: SHELLY (bt_scan)-(1) found '/srv/www/viehai/shelly//meter/ping_SP_0.LIVE' for what: 'presence'
Jan 18 15:48:19 srv4hai common.sh: SHELLY: BTstatus[1]:'Off' dweetAge:'10'=1737211699-1737211689
Jan 18 15:48:19 srv4hai check_presence[8394]: SHELLY (1) found /srv/www/viehai/shelly//meter/ping_SP_1.LIVE and Off//srv/www/viehai/shelly//meter/BTscan_BTid_1.No
Jan 18 15:48:19 srv4hai check_presence[8394]: SHELLY (bt_scan)-(1) found '/srv/www/viehai/shelly//meter/ping_SP_1.LIVE' for what: 'presence'
Jan 18 15:48:19 srv4hai check_presence[8394]: SHELLY (bt_scan)-(1) what: 'presence' - persPresent: '(BT/LIVE) (__/LIVE)' - anyPresent: 'true' - otherPresent:'true'
Jan 18 15:48:19 srv4hai check_presence[8394]: SHELLY - check 'presence': anyPresent(true) - lScene(scene_buero_UM) - sceneOFF(offAll)
Jan 18 15:48:19 srv4hai check_presence[8394]: SHELLY (bt_scan)-(1)-presence: NOT activate_scenario.shtml: offAll
Jan 18 15:48:21 srv4hai dhcpd[4995]: uid lease 192.168.12.56 for client cc:8d:a2:60:52:b8 is duplicate on 192.168.12.0/24
Jan 18 15:48:21 srv4hai dhcpd[4995]: DHCPDISCOVER from cc:8d:a2:60:52:b8 via enp2s0
Jan 18 15:48:21 srv4hai dhcpd[4995]: DHCPOFFER on 192.168.12.101 to cc:8d:a2:60:52:b8 via enp2s0
Jan 18 15:48:21 srv4hai dhcpd[4995]: uid lease 192.168.12.56 for client cc:8d:a2:60:52:b8 is duplicate on 192.168.12.0/24
Jan 18 15:48:21 srv4hai dhcpd[4995]: execute_statement argv[0] = /srv/www/viehai/shelly/json.sh
Jan 18 15:48:21 srv4hai dhcpd[4995]: execute_statement argv[1] = 192.168.12.101
Jan 18 15:48:21 srv4hai dhcpd[4995]: execute_statement argv[2] = shelly-01
Jan 18 15:48:21 srv4hai dhcpd[4995]: DHCPREQUEST for 192.168.12.101 (192.168.12.252) from cc:8d:a2:60:52:b8 via enp2s0
Jan 18 15:48:21 srv4hai dhcpd[4995]: DHCPACK on 192.168.12.101 to cc:8d:a2:60:52:b8 via enp2s0
Jan 18 15:48:21 srv4hai named[30406]: client @0x7f9330095370 192.168.12.252#43291/key rndc-key: updating zone 'viehai.at/IN': update unsuccessful: shelly-01.viehai.at: 'name not in use' prerequisite not satisfied (YXDOMAIN)
Jan 18 15:48:21 srv4hai named[30406]: client @0x7f934c046b60 192.168.12.252#45859/key rndc-key: signer "rndc-key" approved
Jan 18 15:48:21 srv4hai named[30406]: client @0x7f934c046b60 192.168.12.252#45859/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'shelly-01.viehai.at' TXT
Jan 18 15:48:21 srv4hai named[30406]: client @0x7f934c046b60 192.168.12.252#45859/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'shelly-01.viehai.at' TXT "31166740fe21d7ece7561d62986d2b8644"
Jan 18 15:48:21 srv4hai named[30406]: client @0x7f934c046b60 192.168.12.252#45859/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'shelly-01.viehai.at' A
Jan 18 15:48:21 srv4hai named[30406]: client @0x7f934c046b60 192.168.12.252#45859/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'shelly-01.viehai.at' A 192.168.12.101
Jan 18 15:48:21 srv4hai dhcpd[4995]: Added new forward map from shelly-01.viehai.at to 192.168.12.101
Jan 18 15:48:21 srv4hai named[30406]: client @0x7f9348081920 192.168.12.252#43741/key rndc-key: signer "rndc-key" approved
Jan 18 15:48:21 srv4hai named[30406]: client @0x7f9348081920 192.168.12.252#43741/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': deleting rrset at '101.12.168.192.in-addr.arpa' PTR
Jan 18 15:48:21 srv4hai named[30406]: client @0x7f9348081920 192.168.12.252#43741/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': adding an RR at '101.12.168.192.in-addr.arpa' PTR shelly-01.viehai.at.
Jan 18 15:48:21 srv4hai dhcpd[4995]: Added reverse map from 101.12.168.192.in-addr.arpa. to shelly-01.viehai.at
Jan 18 15:48:21 srv4hai common[8510]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly/grab_shelly.sh
Jan 18 15:48:22 srv4hai grab_shelly.sh: SHELLY shellyName/1:'shelly-01' - shIP/2:'' perform:'conf'
Jan 18 15:48:23 srv4hai conf_shelly.sh: SHELLY: PARAMS  shName/1:'shelly-01' - shIP/2:'192.168.12.101'
Jan 18 15:48:23 srv4hai conf_shelly.sh: SHELLY: usage/name 'WZ Licht Esstisch' already set for '192.168.12.101'
Jan 18 15:48:23 srv4hai conf_shelly.sh: SHELLY:'shelly-01' 'conf(0)' - allready transmitted - skipping
Jan 18 15:48:23 srv4hai conf_shelly.sh: SHELLY:'shelly-01' 'conf(1)' - allready transmitted - skipping
Jan 18 15:48:23 srv4hai conf_shelly.sh: SHELLY:'shelly-01' 'conf(2)' - allready transmitted - skipping
Jan 18 15:48:37 srv4hai ping_SP[26718]: SHELLY (1) - ping 192.168.12.62 1 sucessfully  @~1737211717 - 'ping_SP_1'
Jan 18 15:48:37 srv4hai ping_SP[26718]: SHELLY (1) - ping 192.168.12.62 pCnt:'1'
Jan 18 15:48:59 srv4hai dovecot: imap-login: Login: user=, method=PLAIN, rip=::1, lip=::1, mpid=8623, secured, session=
Jan 18 15:48:59 srv4hai dovecot: imap(rozumm)<8623>: Logged out in=92 out=1061 deleted=0 expunged=0 trashed=0 hdr_count=0 hdr_bytes=0 body_count=0 body_bytes=0
Jan 18 15:49:01 srv4hai CRON[8627]: (root) CMD (/etc/linetest/linetest.sh)
Jan 18 15:49:14 srv4hai ping_SP[396]: SHELLY (0) - ping 192.168.12.61 1 sucessfully  @~1737211754 - 'ping_SP_0'
Jan 18 15:49:14 srv4hai ping_SP[396]: SHELLY (0) - ping 192.168.12.61 pCnt:'1'
Jan 18 15:49:28 srv4hai common[8659]: SHELLY common.sh inkludiert von ./bt_scan.sh
Jan 18 15:49:38 srv4hai bt_scan[8659]: SHELLY - who: 'Thomas' / phoneName: 'FP4_Thomas' / '0' / shellyIP: '192.168.12.61' - found: 'No'
Jan 18 15:49:38 srv4hai bt_scan[8659]: SHELLY - lost BT-connection to BTmac: '0' found: 'No' - check presence
Jan 18 15:49:38 srv4hai common[8695]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly//check_presence.sh
Jan 18 15:49:39 srv4hai common.sh: SHELLY: BTstatus[0]:'Off' dweetAge:'10'=1737211779-1737211769
Jan 18 15:49:39 srv4hai check_presence[8695]: SHELLY (0) found /srv/www/viehai/shelly//meter/ping_SP_0.LIVE and Off//srv/www/viehai/shelly//meter/BTscan_BTid_0.No
Jan 18 15:49:39 srv4hai check_presence[8695]: SHELLY (bt_scan)-(0) found '/srv/www/viehai/shelly//meter/ping_SP_0.LIVE' for what: 'presence'
Jan 18 15:49:39 srv4hai common.sh: SHELLY: BTstatus[1]:'Off' dweetAge:'10'=1737211779-1737211769
Jan 18 15:49:39 srv4hai check_presence[8695]: SHELLY (1) found /srv/www/viehai/shelly//meter/ping_SP_1.LIVE and Off//srv/www/viehai/shelly//meter/BTscan_BTid_1.No
Jan 18 15:49:39 srv4hai check_presence[8695]: SHELLY (bt_scan)-(0) found '/srv/www/viehai/shelly//meter/ping_SP_1.LIVE' for what: 'presence'
Jan 18 15:49:39 srv4hai check_presence[8695]: SHELLY (bt_scan)-(0) what: 'presence' - persPresent: '(__/LIVE) (__/LIVE)' - anyPresent: 'true' - otherPresent:'true'
Jan 18 15:49:39 srv4hai check_presence[8695]: SHELLY - check 'presence': anyPresent(true) - lScene(scene_buero_UM) - sceneOFF(offAll)
Jan 18 15:49:39 srv4hai check_presence[8695]: SHELLY (bt_scan)-(0)-presence: NOT activate_scenario.shtml: offAll
Jan 18 15:49:43 srv4hai dhcpd[4995]: uid lease 192.168.12.51 for client cc:8d:a2:5b:90:00 is duplicate on 192.168.12.0/24
Jan 18 15:49:43 srv4hai dhcpd[4995]: DHCPDISCOVER from cc:8d:a2:5b:90:00 via enp2s0
Jan 18 15:49:43 srv4hai dhcpd[4995]: DHCPOFFER on 192.168.12.152 to cc:8d:a2:5b:90:00 via enp2s0
Jan 18 15:49:45 srv4hai dhcpd[4995]: uid lease 192.168.12.51 for client cc:8d:a2:5b:90:00 is duplicate on 192.168.12.0/24
Jan 18 15:49:45 srv4hai dhcpd[4995]: DHCPDISCOVER from cc:8d:a2:5b:90:00 via enp2s0
Jan 18 15:49:45 srv4hai dhcpd[4995]: DHCPOFFER on 192.168.12.152 to cc:8d:a2:5b:90:00 via enp2s0
Jan 18 15:49:45 srv4hai dhcpd[4995]: uid lease 192.168.12.51 for client cc:8d:a2:5b:90:00 is duplicate on 192.168.12.0/24
Jan 18 15:49:45 srv4hai dhcpd[4995]: execute_statement argv[0] = /srv/www/viehai/shelly/json.sh
Jan 18 15:49:45 srv4hai dhcpd[4995]: execute_statement argv[1] = 192.168.12.152
Jan 18 15:49:45 srv4hai dhcpd[4995]: execute_statement argv[2] = shelly-52
Jan 18 15:49:45 srv4hai dhcpd[4995]: DHCPREQUEST for 192.168.12.152 (192.168.12.252) from cc:8d:a2:5b:90:00 via enp2s0
Jan 18 15:49:45 srv4hai dhcpd[4995]: DHCPACK on 192.168.12.152 to cc:8d:a2:5b:90:00 via enp2s0
Jan 18 15:49:45 srv4hai named[30406]: client @0x7f931c09c730 192.168.12.252#42865/key rndc-key: updating zone 'viehai.at/IN': update unsuccessful: shelly-52.viehai.at: 'name not in use' prerequisite not satisfied (YXDOMAIN)
Jan 18 15:49:45 srv4hai named[30406]: client @0x7f9348022510 192.168.12.252#42259/key rndc-key: signer "rndc-key" approved
Jan 18 15:49:45 srv4hai named[30406]: client @0x7f9348022510 192.168.12.252#42259/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'shelly-52.viehai.at' TXT
Jan 18 15:49:45 srv4hai named[30406]: client @0x7f9348022510 192.168.12.252#42259/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'shelly-52.viehai.at' TXT "31578df257b0aa989faa996200c0f6c957"
Jan 18 15:49:45 srv4hai named[30406]: client @0x7f9348022510 192.168.12.252#42259/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'shelly-52.viehai.at' A
Jan 18 15:49:45 srv4hai named[30406]: client @0x7f9348022510 192.168.12.252#42259/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'shelly-52.viehai.at' A 192.168.12.152
Jan 18 15:49:45 srv4hai dhcpd[4995]: Added new forward map from shelly-52.viehai.at to 192.168.12.152
Jan 18 15:49:45 srv4hai named[30406]: client @0x7f9310088a50 192.168.12.252#46391/key rndc-key: signer "rndc-key" approved
Jan 18 15:49:45 srv4hai named[30406]: client @0x7f9310088a50 192.168.12.252#46391/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': deleting rrset at '152.12.168.192.in-addr.arpa' PTR
Jan 18 15:49:45 srv4hai named[30406]: client @0x7f9310088a50 192.168.12.252#46391/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': adding an RR at '152.12.168.192.in-addr.arpa' PTR shelly-52.viehai.at.
Jan 18 15:49:45 srv4hai dhcpd[4995]: Added reverse map from 152.12.168.192.in-addr.arpa. to shelly-52.viehai.at
Jan 18 15:49:45 srv4hai common[8813]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly/grab_shelly.sh
Jan 18 15:49:45 srv4hai grab_shelly.sh: SHELLY shellyName/1:'shelly-52' - shIP/2:'' perform:'conf'
Jan 18 15:49:46 srv4hai mosquitto[29419]: New connection from 192.168.12.152 on port 1883.
Jan 18 15:49:46 srv4hai mosquitto[29419]: Client shelly1minig3-cc8da25b9000 already connected, closing old connection.
Jan 18 15:49:46 srv4hai mosquitto[29419]: Socket error on client shelly1minig3-cc8da25b9000, disconnecting.
Jan 18 15:49:46 srv4hai mosquitto[29419]: New client connected from 192.168.12.152 as shelly1minig3-cc8da25b9000 (c1, k60, u'shmqtt').
Jan 18 15:49:46 srv4hai conf_shelly.sh: SHELLY: PARAMS  shName/1:'shelly-52' - shIP/2:'192.168.12.152'
Jan 18 15:49:46 srv4hai conf_shelly.sh: SHELLY: usage/name 'WZ ovale Lampe' already set for '192.168.12.152'
Jan 18 15:49:46 srv4hai conf_shelly.sh: SHELLY:'shelly-52' 'conf(0)' - allready transmitted - skipping
Jan 18 15:49:46 srv4hai conf_shelly.sh: SHELLY:'shelly-52' 'conf(1)' - allready transmitted - skipping
Jan 18 15:49:46 srv4hai conf_shelly.sh: SHELLY:'shelly-52' 'conf(2)' - allready transmitted - skipping
Jan 18 15:49:51 srv4hai ping_SP[26718]: SHELLY (1) - ping 192.168.12.62 1 sucessfully  @~1737211791 - 'ping_SP_1'
Jan 18 15:49:51 srv4hai ping_SP[26718]: SHELLY (1) - ping 192.168.12.62 pCnt:'1'
Jan 18 15:49:57 srv4hai mosquitto[29419]: Saving in-memory database to /var/lib/mosquitto/mosquitto.db.
Jan 18 15:49:59 srv4hai dovecot: imap-login: Login: user=, method=PLAIN, rip=::1, lip=::1, mpid=8911, secured, session=
Jan 18 15:49:59 srv4hai dovecot: imap(rozumm)<8911>: Logged out in=92 out=1061 deleted=0 expunged=0 trashed=0 hdr_count=0 hdr_bytes=0 body_count=0 body_bytes=0
Jan 18 15:50:01 srv4hai CRON[8915]: (root) CMD (/etc/linetest/linetest.sh)
Jan 18 15:50:01 srv4hai CRON[8914]: (www-data) CMD (/srv/www/viehai/shelly/meter.sh)
Jan 18 15:50:01 srv4hai common[8917]: SHELLY common.sh inkludiert von /srv/www/viehai/shelly/meter.sh
Jan 18 15:50:01 srv4hai meter.sh: SHELLY meter.sh started
Jan 18 15:50:02 srv4hai meter.sh: SHELLY 'shelly-29/KÜ Schalter Herdzeile' - type: 'shelly-i3' ignoring
Jan 18 15:50:02 srv4hai meter.sh: SHELLY 'shelly-28/KÜ Schalter Nasszeile' - type: 'shelly-i3' ignoring
Jan 18 15:50:07 srv4hai meter.sh: SHELLY 'shelly-07/SZ Nachtkästchen Thomas':  OFFLINE, resp. not answering within connect-timeout 2.500000s
Jan 18 15:50:09 srv4hai meter.sh: SHELLY 'shelly-13/Thomas Taster' - type: 'shelly-BTN' ignoring
Jan 18 15:50:09 srv4hai meter.sh: SHELLY 'shelly-14/AUS-Schalter' - type: 'shelly-BTN' ignoring
Jan 18 15:50:09 srv4hai meter.sh: SHELLY 'shelly-37/TB Klima' - type: 'shelly-ht' ignoring
Jan 18 15:50:09 srv4hai meter.sh: SHELLY 'shelly-38/Wetterwerte Innen' - status: 'OOS' ignoring
Jan 18 15:50:09 srv4hai meter.sh: SHELLY 'shelly-39/Wetterwerte Balkon' - type: 'shelly-ht-plus' ignoring
Jan 18 15:50:12 srv4hai meter.sh: SHELLY 'shelly-18/18-Test Farbige LED':  OFFLINE, resp. not answering within connect-timeout 2.500000s
Jan 18 15:50:14 srv4hai meter.sh: SHELLY 'shelly-15/15-Test Weiss':  OFFLINE, resp. not answering within connect-timeout 2.500000s
Jan 18 15:50:14 srv4hai meter.sh: SHELLY 'shelly-30/30-TBD' - status: 'OOS' ignoring
Jan 18 15:50:14 srv4hai meter.sh: SHELLY 'shelly-31/31-Test i3' - status: 'OOS' ignoring
Jan 18 15:50:14 srv4hai meter.sh: SHELLY 'shelly-32/32-TBD' - status: 'OOS' ignoring
Jan 18 15:50:14 srv4hai meter.sh: SHELLY 'shelly-33/33-TBD' - status: 'OOS' ignoring
Jan 18 15:50:14 srv4hai meter.sh: SHELLY 'shelly-36/36-TBD' - status: 'OOS' ignoring
Jan 18 15:50:14 srv4hai postfix/anvil[8031]: statistics: max connection rate 1/60s for (smtp:195.178.110.218) at Jan 18 15:46:49
Jan 18 15:50:14 srv4hai postfix/anvil[8031]: statistics: max connection count 1 for (smtp:195.178.110.218) at Jan 18 15:46:49
Jan 18 15:50:14 srv4hai postfix/anvil[8031]: statistics: max cache size 1 at Jan 18 15:46:49
Jan 18 15:50:14 srv4hai meter.sh: SHELLY 'shelly-09a/Inbetriebnahme - 20210720 - Defekt' - status: 'defect' ignoring
Jan 18 15:50:14 srv4hai meter.sh: SHELLY 'shelly-09b/Sophie Licht - 20230404 - Defekt' - status: 'defect' ignoring
Jan 18 15:50:14 srv4hai meter.sh: SHELLY 'shelly-26/20230404 - kein WLAN' - status: 'defect' ignoring
Jan 18 15:50:14 srv4hai meter.sh: SHELLY 'shelly-27/Schalter Herdzeile - Defekt WLAN 20230417' - status: 'defect' ignoring
Jan 18 15:50:14 srv4hai meter.sh: SHELLY 'shelly-21/Badezimmer - 20230720 - WLAN Problem' - status: 'defect' ignoring
Jan 18 15:50:14 srv4hai meter.sh: SHELLY 'shelly-11/Ausgangstransistor defekt 20230722' - status: 'defect' ignoring
Jan 18 15:50:14 srv4hai meter.sh: SHELLY 'shelly-01a/WZ Licht Esstisch - 20241208 kein WLAN' - status: 'DFC' ignoring
Jan 18 15:50:14 srv4hai meter.sh: SHELLY 'shelly-43/43-tbd' - status: 'OOS' ignoring
Jan 18 15:50:15 srv4hai meter.sh: SHELLY 'shelly-44/44-TBD' - status: 'OOS' ignoring
Jan 18 15:50:15 srv4hai meter.sh: SHELLY 'shelly-46/46-TBD' - status: 'OOS' ignoring
Jan 18 15:50:15 srv4hai dhcpd[4995]: execute_statement argv[0] = /srv/www/viehai/shelly/dhcpcommit.sh
Jan 18 15:50:15 srv4hai dhcpd[4995]: execute_statement argv[1] = 192.168.12.10
Jan 18 15:50:15 srv4hai dhcpd[4995]: execute_statement argv[2] = pchai7x
Jan 18 15:50:15 srv4hai dhcpd[4995]: DHCPREQUEST for 192.168.12.10 from 70:54:d2:7b:fe:a7 via enp2s0
Jan 18 15:50:15 srv4hai dhcpd[4995]: DHCPACK on 192.168.12.10 to 70:54:d2:7b:fe:a7 via enp2s0
Jan 18 15:50:15 srv4hai named[30406]: client @0x7f9348090720 192.168.12.252#53905/key rndc-key: updating zone 'viehai.at/IN': update unsuccessful: pchai7x.viehai.at: 'name not in use' prerequisite not satisfied (YXDOMAIN)
Jan 18 15:50:15 srv4hai named[30406]: client @0x7f932c0a6290 192.168.12.252#46791/key rndc-key: signer "rndc-key" approved
Jan 18 15:50:15 srv4hai named[30406]: client @0x7f932c0a6290 192.168.12.252#46791/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'pchai7x.viehai.at' TXT
Jan 18 15:50:15 srv4hai named[30406]: client @0x7f932c0a6290 192.168.12.252#46791/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'pchai7x.viehai.at' TXT "001e3ad86ca86e10b8e2aaf2e2ade54f52"
Jan 18 15:50:15 srv4hai named[30406]: client @0x7f932c0a6290 192.168.12.252#46791/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'pchai7x.viehai.at' A
Jan 18 15:50:15 srv4hai named[30406]: client @0x7f932c0a6290 192.168.12.252#46791/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'pchai7x.viehai.at' A 192.168.12.10
Jan 18 15:50:15 srv4hai dhcpd[4995]: Added new forward map from pchai7x.viehai.at to 192.168.12.10
Jan 18 15:50:15 srv4hai dhcpcommit.sh: SHELLY ip:'192.168.12.10'(10) device 'pchai7x'
Jan 18 15:50:15 srv4hai named[30406]: client @0x7f93380d2cb0 192.168.12.252#56755/key rndc-key: signer "rndc-key" approved
Jan 18 15:50:15 srv4hai named[30406]: client @0x7f93380d2cb0 192.168.12.252#56755/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': deleting rrset at '10.12.168.192.in-addr.arpa' PTR
Jan 18 15:50:15 srv4hai named[30406]: client @0x7f93380d2cb0 192.168.12.252#56755/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 18 15:50:15 srv4hai dhcpd[4995]: Added reverse map from 10.12.168.192.in-addr.arpa. to pchai7x.viehai.at
Jan 18 15:50:15 srv4hai activate_scenario[9888]: SHELLY last scenario: 'buero_UM' @ '154812' from 'scene_buero_UM_20250118_154812.txt' - delta=-3
Jan 18 15:50:15 srv4hai activate_scenario[9888]:        dateutils.ddiff -i '%Y%m%d%H%M%s' 20250118155015 20250118154812  -f '%S'
Jan 18 15:50:15 srv4hai activate_scenario[9888]: SHELLY  new scenario: 'pcON' different - GO ON
Jan 18 15:50:15 srv4hai activate_scenario[9888]: SHELLY scenario: 'pcON(pcon)' started
Jan 18 15:50:15 srv4hai activate_scenario[9888]: SHELLY dayState='day' <--> DayTime=checked NightTime=checked - origin:'dhcpcommit.sh-pchai7x'

finished