activate_scenario.sh
Sat Feb 17 20:14:54 CET 2024
scenario: pcON
origin: dhcpcommit.sh-pchai7x

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

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

Thomas Schreibtischlampe (/srv/www/viehai/shelly/log_scenarios/2024/02/17/_0.log)

vorher: 20:14:54.482

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: 20:14:54.509
Dauer: 27 msec phName: 'origin:'dhcpcommit.sh-pchai7x''


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

urls : 1
vorher : 20:14:54.461
nachher: 20:14:54.515
Dauer : 54 msec
outfile: '/srv/www/viehai/shelly/log_scenarios/2024/02/17//scene_pcON_20240217_201454.txt'


syslog

Feb 17 20:11:00 srv4hai meter.sh: SHELLY 'shelly-45/45-TBD':  OFFLINE, resp. not answering within connect-timeout 2.500000s
Feb 17 20:11:00 srv4hai meter.sh: SHELLY meter.sh ended
Feb 17 20:11:00 srv4hai CRON[8334]: (root) CMD (/etc/linetest/linetest.sh)
Feb 17 20:11:00 srv4hai postfix/pickup[905]: D7CEE60245: uid=33 from=
Feb 17 20:11:00 srv4hai postfix/cleanup[8332]: D7CEE60245: message-id=<20240217191100.D7CEE60245@mail.viehai.at>
Feb 17 20:11:00 srv4hai postfix/qmgr[28610]: D7CEE60245: from=, size=654, nrcpt=1 (queue active)
Feb 17 20:11:00 srv4hai postfix/local[8339]: D7CEE60245: to=, orig_to=, relay=local, delay=0.05, delays=0.02/0.01/0/0.01, dsn=2.0.0, status=sent (delivered to command: /bin/procmail)
Feb 17 20:11:00 srv4hai postfix/qmgr[28610]: D7CEE60245: removed
Feb 17 20:11:05 srv4hai ping_SP[29343]: SHELLY (0) - ping 192.168.12.61 1 sucessfully  @~1708197065 - 'ping_SP_0'
Feb 17 20:11:05 srv4hai ping_SP[29343]: SHELLY (0) - ping 192.168.12.61 pCnt:'1'
Feb 17 20:11:29 srv4hai dhcpd[5037]: DHCPDISCOVER from 48:55:19:00:b3:58 via enp2s0
Feb 17 20:11:29 srv4hai dhcpd[5037]: DHCPOFFER on 192.168.12.137 to 48:55:19:00:b3:58 via enp2s0
Feb 17 20:11:29 srv4hai dhcpd[5037]: execute_statement argv[0] = /srv/www/viehai/shelly/json.sh
Feb 17 20:11:29 srv4hai dhcpd[5037]: execute_statement argv[1] = 192.168.12.137
Feb 17 20:11:29 srv4hai dhcpd[5037]: execute_statement argv[2] = shelly-37
Feb 17 20:11:29 srv4hai dhcpd[5037]: DHCPREQUEST for 192.168.12.137 (192.168.12.252) from 48:55:19:00:b3:58 via enp2s0
Feb 17 20:11:29 srv4hai dhcpd[5037]: DHCPACK on 192.168.12.137 to 48:55:19:00:b3:58 via enp2s0
Feb 17 20:11:29 srv4hai named[14530]: client @0x7fc3240092c0 192.168.12.252#49727/key rndc-key: updating zone 'viehai.at/IN': update unsuccessful: shelly-37.viehai.at: 'name not in use' prerequisite not satisfied (YXDOMAIN)
Feb 17 20:11:29 srv4hai named[14530]: client @0x7fc32407a810 192.168.12.252#47835/key rndc-key: signer "rndc-key" approved
Feb 17 20:11:29 srv4hai named[14530]: client @0x7fc32407a810 192.168.12.252#47835/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'shelly-37.viehai.at' TXT
Feb 17 20:11:29 srv4hai named[14530]: client @0x7fc32407a810 192.168.12.252#47835/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'shelly-37.viehai.at' TXT "001bc21ebc20088cb6a311248591ab7101"
Feb 17 20:11:29 srv4hai named[14530]: client @0x7fc32407a810 192.168.12.252#47835/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'shelly-37.viehai.at' A
Feb 17 20:11:29 srv4hai named[14530]: client @0x7fc32407a810 192.168.12.252#47835/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'shelly-37.viehai.at' A 192.168.12.137
Feb 17 20:11:29 srv4hai dhcpd[5037]: Added new forward map from shelly-37.viehai.at to 192.168.12.137
Feb 17 20:11:29 srv4hai named[14530]: client @0x7fc3286d9600 192.168.12.252#44121/key rndc-key: signer "rndc-key" approved
Feb 17 20:11:29 srv4hai named[14530]: client @0x7fc3286d9600 192.168.12.252#44121/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': deleting rrset at '137.12.168.192.in-addr.arpa' PTR
Feb 17 20:11:29 srv4hai named[14530]: client @0x7fc3286d9600 192.168.12.252#44121/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': adding an RR at '137.12.168.192.in-addr.arpa' PTR shelly-37.viehai.at.
Feb 17 20:11:29 srv4hai dhcpd[5037]: Added reverse map from 137.12.168.192.in-addr.arpa. to shelly-37.viehai.at
Feb 17 20:11:29 srv4hai grab_shelly.sh: SHELLY shellyName/1:'shelly-37' - shIP/2:'' workdir:'/srv/www/viehai/shelly' perform:'conf'
Feb 17 20:11:30 srv4hai conf_shelly.sh: SHELLY: PARAMS  shName/1:'shelly-37' - shIP/2:'192.168.12.137'
Feb 17 20:11:30 srv4hai ht_shelly.sh: SHELLY - QUERY_STRING: hum=43&temp=22.38&id=shellyht-00B358
Feb 17 20:11:30 srv4hai ht_shelly.sh: SHELLY - storing into '/srv/www/viehai/shelly/wetter/2024/02/shelly-37_20240217.csv'
Feb 17 20:11:30 srv4hai conf_shelly.sh: SHELLY: PARAMS  shName/1:'shelly-37' - shIP/2:'192.168.12.137'
Feb 17 20:11:30 srv4hai conf_shelly.sh: SHELLY: usage/name 'Wetter 1' already set for '192.168.12.137'
Feb 17 20:11:30 srv4hai conf_shelly.sh: SHELLY: usage/name 'Wetter 1' already set for '192.168.12.137'
Feb 17 20:11:30 srv4hai conf_shelly.sh: SHELLY:'shelly-37' 'conf(0)' - allready transmitted - skipping
Feb 17 20:11:30 srv4hai conf_shelly.sh: SHELLY:'shelly-37' 'conf(0)' - allready transmitted - skipping
Feb 17 20:11:30 srv4hai conf_shelly.sh: SHELLY:'shelly-37' 'conf(1)' - allready transmitted - skipping
Feb 17 20:11:30 srv4hai conf_shelly.sh: SHELLY:'shelly-37' 'conf(1)' - allready transmitted - skipping
Feb 17 20:11:30 srv4hai conf_shelly.sh: SHELLY:'shelly-37' 'conf(2)' - allready transmitted - skipping
Feb 17 20:11:30 srv4hai conf_shelly.sh: SHELLY:'shelly-37' 'conf(2)' - allready transmitted - skipping
Feb 17 20:11:30 srv4hai conf_shelly.sh: SHELLY:'shelly-37' 'conf(3)' - ''
Feb 17 20:11:30 srv4hai conf_shelly.sh: SHELLY:'shelly-37' 'conf(3)' - ''
Feb 17 20:11:30 srv4hai conf_shelly.sh: SHELLY:'shelly-37' conf(3)-cmd: 'curl --connect-timeout 3 --silent 'http://192.168.12.137/' | jq -r '.''
Feb 17 20:11:30 srv4hai conf_shelly.sh: SHELLY:'shelly-37' conf(3)-ret: ''
Feb 17 20:11:30 srv4hai conf_shelly.sh: SHELLY:'shelly-37' conf(3)-cmd: 'curl --connect-timeout 3 --silent 'http://192.168.12.137/' | jq -r '.''
Feb 17 20:11:30 srv4hai conf_shelly.sh: SHELLY:'shelly-37' conf(3)-ret: ''
Feb 17 20:11:30 srv4hai ht_shelly.sh: SHELLY shellyht-00B358 / shelly-37 / Wetter 1: 22.38° - 43%
Feb 17 20:11:30 srv4hai ht_shelly.sh: SHELLY shellyht-00B358 / shelly-37 / Wetter 1: 22.38°/22.38° - 43%/43% - SAVED
Feb 17 20:11:30 srv4hai ht_shelly.sh: SHELLY shellyht-00B358 / shelly-37 / Wetter 1: batt='91'°
Feb 17 20:11:31 srv4hai ht_shelly.sh: SHELLY shellyht-00B358 / shelly-37 / Wetter 1: dweetIO='{#012  "this": "succeeded",#012  "by": "dweeting",#012  "the": "dweet",#012  "with": {#012    "thing": "viehai-37",#012    "created": "2024-02-17T19:11:31.392Z",#012    "content": {#012      "temp": 22.38,#012      "hum": 43,#012      "batt": 91#012    },#012    "transaction": "5fa5dce6-679e-4f76-81a5-f81a87923401"#012  }#012}'°
Feb 17 20:11:35 srv4hai ht_shelly.sh: SHELLY - QUERY_STRING: hum=43&temp=22.38&id=shellyht-00B358
Feb 17 20:11:35 srv4hai ht_shelly.sh: SHELLY - storing into '/srv/www/viehai/shelly/wetter/2024/02/shelly-37_20240217.csv'
Feb 17 20:11:35 srv4hai ht_shelly.sh: SHELLY - '/srv/www/viehai/shelly/wetter/2024/02/shelly-37_20240217.csv' modifed 5s ago - EXIT
Feb 17 20:11:40 srv4hai ht_shelly.sh: SHELLY - QUERY_STRING: hum=43&temp=22.38&id=shellyht-00B358
Feb 17 20:11:40 srv4hai ht_shelly.sh: SHELLY - storing into '/srv/www/viehai/shelly/wetter/2024/02/shelly-37_20240217.csv'
Feb 17 20:11:40 srv4hai ht_shelly.sh: SHELLY - '/srv/www/viehai/shelly/wetter/2024/02/shelly-37_20240217.csv' modifed 10s ago - EXIT
Feb 17 20:11:45 srv4hai ht_shelly.sh: SHELLY - QUERY_STRING: hum=43&temp=22.38&id=shellyht-00B358
Feb 17 20:11:45 srv4hai ht_shelly.sh: SHELLY - storing into '/srv/www/viehai/shelly/wetter/2024/02/shelly-37_20240217.csv'
Feb 17 20:11:45 srv4hai ht_shelly.sh: SHELLY - '/srv/www/viehai/shelly/wetter/2024/02/shelly-37_20240217.csv' modifed 15s ago - EXIT
Feb 17 20:11:51 srv4hai ht_shelly.sh: SHELLY - QUERY_STRING: hum=43&temp=22.38&id=shellyht-00B358
Feb 17 20:11:51 srv4hai ht_shelly.sh: SHELLY - storing into '/srv/www/viehai/shelly/wetter/2024/02/shelly-37_20240217.csv'
Feb 17 20:11:51 srv4hai ht_shelly.sh: SHELLY - '/srv/www/viehai/shelly/wetter/2024/02/shelly-37_20240217.csv' modifed 21s ago - EXIT
Feb 17 20:11:56 srv4hai ht_shelly.sh: SHELLY - QUERY_STRING: hum=43&temp=22.38&id=shellyht-00B358
Feb 17 20:11:56 srv4hai ht_shelly.sh: SHELLY - storing into '/srv/www/viehai/shelly/wetter/2024/02/shelly-37_20240217.csv'
Feb 17 20:11:56 srv4hai ht_shelly.sh: SHELLY - '/srv/www/viehai/shelly/wetter/2024/02/shelly-37_20240217.csv' modifed 26s ago - EXIT
Feb 17 20:12:01 srv4hai CRON[8693]: (root) CMD (/etc/linetest/linetest.sh)
Feb 17 20:12:18 srv4hai ping_SP[29343]: SHELLY (0) - ping 192.168.12.61 1 sucessfully  @~1708197138 - 'ping_SP_0'
Feb 17 20:12:18 srv4hai ping_SP[29343]: SHELLY (0) - ping 192.168.12.61 pCnt:'1'
Feb 17 20:13:01 srv4hai CRON[8727]: (root) CMD (/etc/linetest/linetest.sh)
Feb 17 20:13:19 srv4hai dovecot: imap-login: Login: user=, method=PLAIN, rip=::1, lip=::1, mpid=8736, secured, session=
Feb 17 20:13:19 srv4hai dovecot: imap(miglincit)<8736>: Logged out in=137 out=1088 deleted=0 expunged=0 trashed=0 hdr_count=0 hdr_bytes=0 body_count=0 body_bytes=0
Feb 17 20:13:31 srv4hai ping_SP[29343]: SHELLY (0) - ping 192.168.12.61 1 sucessfully  @~1708197211 - 'ping_SP_0'
Feb 17 20:13:31 srv4hai ping_SP[29343]: SHELLY (0) - ping 192.168.12.61 pCnt:'1'
Feb 17 20:13:46 srv4hai nmbd[30864]: [2024/02/17 20:13:46.302785,  0] ../source3/nmbd/nmbd_browsesync.c:354(find_domain_master_name_query_fail)
Feb 17 20:13:46 srv4hai nmbd[30864]:   find_domain_master_name_query_fail:
Feb 17 20:13:46 srv4hai nmbd[30864]:   Unable to find the Domain Master Browser name WORKGROUP<1b> for the workgroup WORKGROUP.
Feb 17 20:13:46 srv4hai nmbd[30864]:   Unable to sync browse lists in this workgroup.
Feb 17 20:14:01 srv4hai CRON[8771]: (root) CMD (/etc/linetest/linetest.sh)
Feb 17 20:14:40 srv4hai fetchmail[1651]: 7 messages (7 seen) for rozmig at mail.akis.at (1753652 octets).
Feb 17 20:14:40 srv4hai fetchmail[1651]: 38299 messages (38299 seen) for tmiglinci at mail.akis.at (-1138041556 octets).
Feb 17 20:14:41 srv4hai fetchmail[1651]: 9909 messages (9909 seen) for srozum at mail.akis.at (1195577538 octets).
Feb 17 20:14:41 srv4hai fetchmail[1651]: 21709 messages (21709 seen) for mrozum at mail.akis.at (-576186959 octets).
Feb 17 20:14:42 srv4hai fetchmail[1651]: 46 messages (46 seen) for admin@bastelstube.wien at pop3.world4you.com (12059834 octets).
Feb 17 20:14:42 srv4hai activate_scenario[8791]: SHELLY scenario: 'buero_UM(buero_um)' started
Feb 17 20:14:42 srv4hai activate_scenario[8791]: SHELLY dayState='night' <--> DayTime=checked NightTime=checked - shelly-40:'Thomas Büro Licht'
Feb 17 20:14:42 srv4hai activate_scenario[8791]: SHELLY scenario: 'buero_UM(buero_um)' TO BE EXECUTED, shelly-40:'Thomas Büro Licht'
Feb 17 20:14:42 srv4hai postfix/pickup[905]: 86BBA60245: uid=33 from=
Feb 17 20:14:42 srv4hai postfix/cleanup[8844]: 86BBA60245: message-id=<20240217191442.86BBA60245@mail.viehai.at>
Feb 17 20:14:42 srv4hai postfix/qmgr[28610]: 86BBA60245: from=, size=11072, nrcpt=1 (queue active)
Feb 17 20:14:42 srv4hai activate_scenario[8791]: SHELLY: scenario: 'buero_UM(buero_um)'-'shelly-08'-'Thomas Büro Regallicht' --> '0?turn=toggle'
Feb 17 20:14:42 srv4hai postfix/local[8855]: 86BBA60245: to=, orig_to=, relay=local, delay=0.1, delays=0.07/0.01/0/0.02, dsn=5.1.1, status=bounced (unknown user: "null")
Feb 17 20:14:42 srv4hai postfix/cleanup[8844]: 93EDC60248: message-id=<20240217191442.93EDC60248@mail.viehai.at>
Feb 17 20:14:42 srv4hai proc_url[8862]: SHELLY: OF:'/srv/www/viehai/shelly/log_scenarios/2024/02/17/_0.log' - shellyUsage:'Thomas Büro Regallicht' - scUrl:'http://192.168.12.108/relay/0?turn=toggle' - phName:'shelly-40:'Thomas Büro Licht''
Feb 17 20:14:42 srv4hai postfix/bounce[8858]: 86BBA60245: sender non-delivery notification: 93EDC60248
Feb 17 20:14:42 srv4hai postfix/qmgr[28610]: 93EDC60248: from=<>, size=12991, nrcpt=1 (queue active)
Feb 17 20:14:42 srv4hai postfix/qmgr[28610]: 86BBA60245: removed
Feb 17 20:14:42 srv4hai postfix/local[8855]: 93EDC60248: to=, relay=local, delay=0.01, delays=0/0/0/0.01, dsn=2.0.0, status=sent (delivered to command: /bin/procmail)
Feb 17 20:14:42 srv4hai postfix/qmgr[28610]: 93EDC60248: removed
Feb 17 20:14:42 srv4hai activate_scenario[8791]: SHELLY: scenario: 'buero_UM(buero_um)'-'shelly-40'-'Thomas Büro Licht' --> '0?turn=toggle'
Feb 17 20:14:42 srv4hai proc_url[8874]: SHELLY: OF:'/srv/www/viehai/shelly/log_scenarios/2024/02/17/_1.log' - shellyUsage:'Thomas Büro Licht' - scUrl:'http://192.168.12.140/relay/0?turn=toggle' - phName:'shelly-40:'Thomas Büro Licht''
Feb 17 20:14:42 srv4hai activate_scenario[8791]: SHELLY scenario: 'buero_UM(buero_um)' took 272 msec, shelly-40:'Thomas Büro Licht'
Feb 17 20:14:44 srv4hai ping_SP[29343]: SHELLY (0) - ping 192.168.12.61 1 sucessfully  @~1708197284 - 'ping_SP_0'
Feb 17 20:14:44 srv4hai ping_SP[29343]: SHELLY (0) - ping 192.168.12.61 pCnt:'1'
Feb 17 20:14:54 srv4hai dhcpd[5037]: execute_statement argv[0] = /srv/www/viehai/shelly/dhcpcommit.sh
Feb 17 20:14:54 srv4hai dhcpd[5037]: execute_statement argv[1] = 192.168.12.10
Feb 17 20:14:54 srv4hai dhcpd[5037]: execute_statement argv[2] = pchai7x
Feb 17 20:14:54 srv4hai dhcpd[5037]: DHCPREQUEST for 192.168.12.10 from 70:54:d2:7b:fe:a7 via enp2s0
Feb 17 20:14:54 srv4hai dhcpd[5037]: DHCPACK on 192.168.12.10 to 70:54:d2:7b:fe:a7 via enp2s0
Feb 17 20:14:54 srv4hai named[14530]: client @0x7fc32810f2a0 192.168.12.252#36001/key rndc-key: updating zone 'viehai.at/IN': update unsuccessful: pchai7x.viehai.at: 'name not in use' prerequisite not satisfied (YXDOMAIN)
Feb 17 20:14:54 srv4hai named[14530]: client @0x7fc32865edd0 192.168.12.252#47385/key rndc-key: signer "rndc-key" approved
Feb 17 20:14:54 srv4hai named[14530]: client @0x7fc32865edd0 192.168.12.252#47385/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'pchai7x.viehai.at' TXT
Feb 17 20:14:54 srv4hai named[14530]: client @0x7fc32865edd0 192.168.12.252#47385/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'pchai7x.viehai.at' TXT "001e3ad86ca86e10b8e2aaf2e2ade54f52"
Feb 17 20:14:54 srv4hai named[14530]: client @0x7fc32865edd0 192.168.12.252#47385/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'pchai7x.viehai.at' A
Feb 17 20:14:54 srv4hai named[14530]: client @0x7fc32865edd0 192.168.12.252#47385/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'pchai7x.viehai.at' A 192.168.12.10
Feb 17 20:14:54 srv4hai dhcpd[5037]: Added new forward map from pchai7x.viehai.at to 192.168.12.10
Feb 17 20:14:54 srv4hai dhcpcommit.sh: SHELLY ip:'192.168.12.10'(10) device 'pchai7x'
Feb 17 20:14:54 srv4hai named[14530]: client @0x7fc31803cbb0 192.168.12.252#33329/key rndc-key: signer "rndc-key" approved
Feb 17 20:14:54 srv4hai named[14530]: client @0x7fc31803cbb0 192.168.12.252#33329/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': deleting rrset at '10.12.168.192.in-addr.arpa' PTR
Feb 17 20:14:54 srv4hai named[14530]: client @0x7fc31803cbb0 192.168.12.252#33329/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.
Feb 17 20:14:54 srv4hai dhcpd[5037]: Added reverse map from 10.12.168.192.in-addr.arpa. to pchai7x.viehai.at
Feb 17 20:14:54 srv4hai activate_scenario[8938]: SHELLY scenario: 'pcON(pcon)' started
Feb 17 20:14:54 srv4hai activate_scenario[8938]: SHELLY dayState='night' <--> DayTime=checked NightTime=checked - origin:'dhcpcommit.sh-pchai7x'

finished