activate_scenario.sh
Sat Feb 3 06:31:37 CET 2024
scenario: welcomeLight
phoneName: 0

'night' <--> DayTime=checked , NightTime=checked
-> execution of scenario
-> sending email(s) to 'thomas@miglinci.name'

scenario: 'Willkommen-Licht EIN-schalten' - 'welcomeLight' - 'welcomelight'

Licht Vorzimmer (/srv/www/viehai/shelly/log_scenarios/2024/02/03/_0.log)

vorher: 06:31:37.749

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

nachher: 06:31:37.783
Dauer: 34 msec phName: 'phoneName:'0''


Küche Licht Naßzeile (/srv/www/viehai/shelly/log_scenarios/2024/02/03/_1.log)

vorher: 06:31:37.766

http://192.168.12.116/white/0?turn=on&brightness=25
  "ison": true,
  "source": "http",
  "has_timer": false,
  "timer_started": 0,
  "timer_duration": 0,
  "timer_remaining": 0,
  "mode": "white",
  "brightness": 25,
  "transition": 0,
  "power": 9.83,
  "overpower": false

nachher: 06:31:37.793
Dauer: 26 msec phName: 'phoneName:'0''


Küche Licht Naßzeile (/srv/www/viehai/shelly/log_scenarios/2024/02/03/_2.log)

vorher: 06:31:37.781

http://192.168.12.116/white/1?turn=on&brightness=25
  "ison": true,
  "source": "http",
  "has_timer": false,
  "timer_started": 0,
  "timer_duration": 0,
  "timer_remaining": 0,
  "mode": "white",
  "brightness": 25,
  "transition": 0,
  "power": 9.83,
  "overpower": false

nachher: 06:31:37.813
Dauer: 32 msec phName: 'phoneName:'0''


Küche Licht Herdzeile (/srv/www/viehai/shelly/log_scenarios/2024/02/03/_3.log)

vorher: 06:31:37.794

http://192.168.12.117/white/0?turn=on&brightness=25
  "ison": true,
  "source": "http",
  "has_timer": false,
  "timer_started": 0,
  "timer_duration": 0,
  "timer_remaining": 0,
  "mode": "white",
  "brightness": 25,
  "transition": 0,
  "power": 7.13,
  "overpower": false

nachher: 06:31:37.821
Dauer: 27 msec phName: 'phoneName:'0''


Küche Licht Herdzeile (/srv/www/viehai/shelly/log_scenarios/2024/02/03/_4.log)

vorher: 06:31:37.808

http://192.168.12.117/white/1?turn=on&brightness=25
  "ison": true,
  "source": "http",
  "has_timer": false,
  "timer_started": 0,
  "timer_duration": 0,
  "timer_remaining": 0,
  "mode": "white",
  "brightness": 25,
  "transition": 0,
  "power": 7.13,
  "overpower": false

nachher: 06:31:37.848
Dauer: 39 msec phName: 'phoneName:'0''


scenario: 'Willkommen-Licht EIN-schalten' - 'welcomeLight' - 'welcomelight'

urls : 5
vorher : 06:31:37.707
nachher: 06:31:37.854
Dauer : 148 msec
outfile: '/srv/www/viehai/shelly/log_scenarios/2024/02/03//scene_welcomeLight_20240203_063137.txt'


syslog

Feb  3 06:28:01 srv4hai CRON[17703]: (root) CMD (/etc/linetest/linetest.sh)
Feb  3 06:28:09 srv4hai ping_SP[14497]: SHELLY (0) - ping 192.168.12.61 1 sucessfully  @~1706938089 - 'ping_SP_0'
Feb  3 06:28:09 srv4hai ping_SP[14497]: SHELLY (0) - ping 192.168.12.61 pCnt:'1'
Feb  3 06:28:10 srv4hai fetchmail[1651]: 7 messages (7 seen) for rozmig at mail.akis.at (1753652 octets).
Feb  3 06:28:11 srv4hai fetchmail[1651]: 37222 messages (37220 seen) for tmiglinci at mail.akis.at (-1214347710 octets).
Feb  3 06:28:11 srv4hai postfix/smtpd[17727]: connect from localhost[127.0.0.1]
Feb  3 06:28:11 srv4hai postfix/smtpd[17727]: 49BEB6011A: client=localhost[127.0.0.1]
Feb  3 06:28:11 srv4hai postfix/cleanup[17730]: 49BEB6011A: message-id=<8hxr14qtioz.1l4khhoy782lp@kanzlei.st>
Feb  3 06:28:11 srv4hai fetchmail[1651]: reading message tmiglinci@mail.akis.at:37221 of 37222 (56814 octets) not flushed
Feb  3 06:28:11 srv4hai postfix/qmgr[28610]: 49BEB6011A: from=, size=57091, nrcpt=1 (queue active)
Feb  3 06:28:11 srv4hai postfix/local[17731]: 49BEB6011A: to=, relay=local, delay=0.09, delays=0.07/0.01/0/0.01, dsn=2.0.0, status=sent (delivered to command: /bin/procmail)
Feb  3 06:28:11 srv4hai postfix/qmgr[28610]: 49BEB6011A: removed
Feb  3 06:28:11 srv4hai postfix/smtpd[17727]: 63B5A6011A: client=localhost[127.0.0.1]
Feb  3 06:28:11 srv4hai postfix/cleanup[17730]: 63B5A6011A: message-id=<20240203052519.24F3C60244@mail.viehai.at>
Feb  3 06:28:11 srv4hai fetchmail[1651]: reading message tmiglinci@mail.akis.at:37222 of 37222 (48562 octets) not flushed
Feb  3 06:28:11 srv4hai postfix/qmgr[28610]: 63B5A6011A: from=, size=48859, nrcpt=1 (queue active)
Feb  3 06:28:11 srv4hai postfix/local[17731]: 63B5A6011A: to=, relay=local, delay=0.07, delays=0.06/0/0/0.01, dsn=2.0.0, status=sent (delivered to command: /bin/procmail)
Feb  3 06:28:11 srv4hai postfix/qmgr[28610]: 63B5A6011A: removed
Feb  3 06:28:11 srv4hai postfix/smtpd[17727]: disconnect from localhost[127.0.0.1] ehlo=1 mail=2 rcpt=2 data=2 quit=1 commands=8
Feb  3 06:28:11 srv4hai fetchmail[1651]: 9851 messages (9851 seen) for srozum at mail.akis.at (1189777371 octets).
Feb  3 06:28:12 srv4hai fetchmail[1651]: 21463 messages (21463 seen) for mrozum at mail.akis.at (-633804081 octets).
Feb  3 06:28:12 srv4hai fetchmail[1651]: 45 messages (45 seen) for admin@bastelstube.wien at pop3.world4you.com (12035480 octets).
Feb  3 06:28:20 srv4hai ping_SP[10492]: SHELLY (0) - ping 192.168.12.61 1 sucessfully  @~1706938100 - 'ping_SP_0'
Feb  3 06:28:20 srv4hai ping_SP[10492]: SHELLY (0) - ping 192.168.12.61 pCnt:'1'
Feb  3 06:28:24 srv4hai postfix/anvil[15948]: statistics: max connection rate 1/60s for (smtp:194.48.251.112) at Feb  3 06:21:25
Feb  3 06:28:24 srv4hai postfix/anvil[15948]: statistics: max connection count 1 for (smtp:194.48.251.112) at Feb  3 06:21:25
Feb  3 06:28:24 srv4hai postfix/anvil[15948]: statistics: max cache size 2 at Feb  3 06:24:54
Feb  3 06:28:35 srv4hai nmbd[30864]: [2024/02/03 06:28:35.929783,  0] ../source3/nmbd/nmbd_browsesync.c:354(find_domain_master_name_query_fail)
Feb  3 06:28:35 srv4hai nmbd[30864]:   find_domain_master_name_query_fail:
Feb  3 06:28:35 srv4hai nmbd[30864]:   Unable to find the Domain Master Browser name WORKGROUP<1b> for the workgroup WORKGROUP.
Feb  3 06:28:35 srv4hai nmbd[30864]:   Unable to sync browse lists in this workgroup.
Feb  3 06:28:39 srv4hai ping_SP[14497]: SHELLY (0) - ping 192.168.12.61 1 sucessfully  @~1706938119 - 'ping_SP_0'
Feb  3 06:28:39 srv4hai ping_SP[14497]: SHELLY (0) - ping 192.168.12.61 pCnt:'1'
Feb  3 06:28:50 srv4hai ping_SP[10492]: SHELLY (0) - ping 192.168.12.61 1 sucessfully  @~1706938130 - 'ping_SP_0'
Feb  3 06:28:50 srv4hai ping_SP[10492]: SHELLY (0) - ping 192.168.12.61 pCnt:'1'
Feb  3 06:29:01 srv4hai CRON[17794]: (root) CMD (/etc/linetest/linetest.sh)
Feb  3 06:29:09 srv4hai ping_SP[14497]: SHELLY (0) - ping 192.168.12.61 1 sucessfully  @~1706938149 - 'ping_SP_0'
Feb  3 06:29:09 srv4hai ping_SP[14497]: SHELLY (0) - ping 192.168.12.61 pCnt:'1'
Feb  3 06:29:20 srv4hai ping_SP[10492]: SHELLY (0) - ping 192.168.12.61 1 sucessfully  @~1706938160 - 'ping_SP_0'
Feb  3 06:29:20 srv4hai ping_SP[10492]: SHELLY (0) - ping 192.168.12.61 pCnt:'1'
Feb  3 06:29:22 srv4hai dovecot: imap-login: Login: user=, method=PLAIN, rip=::1, lip=::1, mpid=17841, secured, session=
Feb  3 06:29:22 srv4hai dovecot: imap(miglincit)<17841>: Logged out in=434 out=36082 deleted=0 expunged=0 trashed=0 hdr_count=50 hdr_bytes=12226 body_count=0 body_bytes=0
Feb  3 06:29:39 srv4hai dhcpd[5037]: DHCPDISCOVER from c0:49:ef:8a:c9:d8 via enp2s0
Feb  3 06:29:39 srv4hai dhcpd[5037]: DHCPOFFER on 192.168.12.139 to c0:49:ef:8a:c9:d8 via enp2s0
Feb  3 06:29:39 srv4hai dhcpd[5037]: execute_statement argv[0] = /srv/www/viehai/shelly/json.sh
Feb  3 06:29:39 srv4hai dhcpd[5037]: execute_statement argv[1] = 192.168.12.139
Feb  3 06:29:39 srv4hai dhcpd[5037]: execute_statement argv[2] = shelly-39
Feb  3 06:29:39 srv4hai dhcpd[5037]: DHCPREQUEST for 192.168.12.139 (192.168.12.252) from c0:49:ef:8a:c9:d8 via enp2s0
Feb  3 06:29:39 srv4hai dhcpd[5037]: DHCPACK on 192.168.12.139 to c0:49:ef:8a:c9:d8 via enp2s0
Feb  3 06:29:39 srv4hai named[14530]: client @0x7fc3180354e0 192.168.12.252#48639/key rndc-key: updating zone 'viehai.at/IN': update unsuccessful: shelly-39.viehai.at: 'name not in use' prerequisite not satisfied (YXDOMAIN)
Feb  3 06:29:39 srv4hai named[14530]: client @0x7fc32406bb80 192.168.12.252#36001/key rndc-key: signer "rndc-key" approved
Feb  3 06:29:39 srv4hai named[14530]: client @0x7fc32406bb80 192.168.12.252#36001/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'shelly-39.viehai.at' TXT
Feb  3 06:29:39 srv4hai named[14530]: client @0x7fc32406bb80 192.168.12.252#36001/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'shelly-39.viehai.at' TXT "314be662bb43914e78b269d3f3bc9f38c7"
Feb  3 06:29:39 srv4hai named[14530]: client @0x7fc32406bb80 192.168.12.252#36001/key rndc-key: updating zone 'viehai.at/IN': deleting rrset at 'shelly-39.viehai.at' A
Feb  3 06:29:39 srv4hai named[14530]: client @0x7fc32406bb80 192.168.12.252#36001/key rndc-key: updating zone 'viehai.at/IN': adding an RR at 'shelly-39.viehai.at' A 192.168.12.139
Feb  3 06:29:39 srv4hai dhcpd[5037]: Added new forward map from shelly-39.viehai.at to 192.168.12.139
Feb  3 06:29:39 srv4hai named[14530]: client @0x7fc320075e30 192.168.12.252#55453/key rndc-key: signer "rndc-key" approved
Feb  3 06:29:39 srv4hai named[14530]: client @0x7fc320075e30 192.168.12.252#55453/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': deleting rrset at '139.12.168.192.in-addr.arpa' PTR
Feb  3 06:29:39 srv4hai named[14530]: client @0x7fc320075e30 192.168.12.252#55453/key rndc-key: updating zone '12.168.192.in-addr.arpa/IN': adding an RR at '139.12.168.192.in-addr.arpa' PTR shelly-39.viehai.at.
Feb  3 06:29:39 srv4hai dhcpd[5037]: Added reverse map from 139.12.168.192.in-addr.arpa. to shelly-39.viehai.at
Feb  3 06:29:39 srv4hai grab_shelly.sh: SHELLY shellyName/1:'shelly-39' - shIP/2:'' workdir:'/srv/www/viehai/shelly' perform:'conf'
Feb  3 06:29:39 srv4hai conf_shelly.sh: SHELLY: PARAMS  shName/1:'shelly-39' - shIP/2:'192.168.12.139'
Feb  3 06:29:39 srv4hai ht_shelly.sh: SHELLY - working dir '/srv/www/viehai/shelly/wetter/2024/02'
Feb  3 06:29:39 srv4hai ht_shelly.sh: SHELLY - QUERY_STRING: gen=2&temp=8.500000&hum=59.800000&id=C049EF8AC9D8&batt=100&volt=6.740000
Feb  3 06:29:39 srv4hai ht_shelly.sh: SHELLY id  => macID: '8A:C9:D8'
Feb  3 06:29:39 srv4hai conf_shelly.sh: SHELLY: usage/name 'Wetterwerte Balkon' already set for '192.168.12.139'
Feb  3 06:29:39 srv4hai conf_shelly.sh: SHELLY: PARAMS  shName/1:'shelly-39' - shIP/2:'192.168.12.139'
Feb  3 06:29:39 srv4hai conf_shelly.sh: SHELLY:'shelly-39' 'conf(0)' - 'settings/actions?index=0&name=report_url&enabled=true&urls[]=http://www.viehai.at/shelly/ht_shelly.shtml?gen=2&temp=${ev.tC}&hum=${status["humidity:0"].rH}&id=${config.sys.device.mac}'
Feb  3 06:29:39 srv4hai conf_shelly.sh: SHELLY: usage/name 'Wetterwerte Balkon' already set for '192.168.12.139'
Feb  3 06:29:39 srv4hai conf_shelly.sh: SHELLY:'shelly-39' 'conf(0)' - 'settings/actions?index=0&name=report_url&enabled=true&urls[]=http://www.viehai.at/shelly/ht_shelly.shtml?gen=2&temp=${ev.tC}&hum=${status["humidity:0"].rH}&id=${config.sys.device.mac}'
Feb  3 06:29:39 srv4hai conf_shelly.sh: SHELLY:'shelly-39' conf(0)-cmd: 'curl --connect-timeout 3 --silent -X -POST -d 'settings/actions?index=0&name=report_url&enabled=true&urls[]=http://www.viehai.at/shelly/ht_shelly.shtml?gen=2&temp=${ev.tC}&hum=${status["humidity:0"].rH}&id=${config.sys.device.mac}' http://192.168.12.139/rpc | jq -r '.''
Feb  3 06:29:39 srv4hai conf_shelly.sh: SHELLY:'shelly-39' conf(0)-ret: ''
Feb  3 06:29:39 srv4hai conf_shelly.sh: SHELLY:'shelly-39' no WebHook
Feb  3 06:29:39 srv4hai conf_shelly.sh: SHELLY:'shelly-39' conf(0)-cmd: 'curl --connect-timeout 3 --silent -X -POST -d 'settings/actions?index=0&name=report_url&enabled=true&urls[]=http://www.viehai.at/shelly/ht_shelly.shtml?gen=2&temp=${ev.tC}&hum=${status["humidity:0"].rH}&id=${config.sys.device.mac}' http://192.168.12.139/rpc | jq -r '.''
Feb  3 06:29:39 srv4hai conf_shelly.sh: SHELLY:'shelly-39' conf(0)-ret: ''
Feb  3 06:29:39 srv4hai conf_shelly.sh: SHELLY:'shelly-39' no WebHook
Feb  3 06:29:39 srv4hai ht_shelly.sh: SHELLY C049EF8AC9D8 / shelly-39 / Wetterwerte Balkon: 8.5° - 59.8%
Feb  3 06:29:39 srv4hai ht_shelly.sh: SHELLY - storing into '/srv/www/viehai/shelly/wetter/2024/02/shelly-39_20240203.csv'
Feb  3 06:29:39 srv4hai ht_shelly.sh: SHELLY C049EF8AC9D8 / shelly-39 / Wetterwerte Balkon: 8.5°/9° - 59.8%/58% - SAVED
Feb  3 06:29:39 srv4hai ht_shelly.sh: SHELLY C049EF8AC9D8 / shelly-39 / Wetterwerte Balkon: batt='100'°
Feb  3 06:29:39 srv4hai ping_SP[14497]: SHELLY (0) - ping 192.168.12.61 1 sucessfully  @~1706938179 - 'ping_SP_0'
Feb  3 06:29:39 srv4hai ping_SP[14497]: SHELLY (0) - ping 192.168.12.61 pCnt:'1'
Feb  3 06:29:40 srv4hai ht_shelly.sh: SHELLY C049EF8AC9D8 / shelly-39 / Wetterwerte Balkon: dweetIO='{#012  "this": "succeeded",#012  "by": "dweeting",#012  "the": "dweet",#012  "with": {#012    "thing": "viehai-39",#012    "created": "2024-02-03T05:29:40.047Z",#012    "content": {#012      "temp": 8.5,#012      "hum": 59.8,#012      "batt": 100#012    },#012    "transaction": "23152146-e76b-4362-8a0d-969db571fd71"#012  }#012}'°
Feb  3 06:29:50 srv4hai ping_SP[10492]: SHELLY (0) - ping 192.168.12.61 1 sucessfully  @~1706938190 - 'ping_SP_0'
Feb  3 06:29:50 srv4hai ping_SP[10492]: SHELLY (0) - ping 192.168.12.61 pCnt:'1'
Feb  3 06:30:01 srv4hai CRON[18033]: (root) CMD (/etc/linetest/linetest.sh)
Feb  3 06:30:01 srv4hai CRON[18034]: (www-data) CMD (/srv/www/viehai/shelly/meter.sh)
Feb  3 06:30:01 srv4hai meter.sh: SHELLY meter.sh started
Feb  3 06:30:10 srv4hai ping_SP[14497]: SHELLY (0) - ping 192.168.12.61 1 sucessfully  @~1706938210 - 'ping_SP_0'
Feb  3 06:30:10 srv4hai ping_SP[14497]: SHELLY (0) - ping 192.168.12.61 pCnt:'1'
Feb  3 06:30:20 srv4hai ping_SP[10492]: SHELLY (0) - ping 192.168.12.61 1 sucessfully  @~1706938220 - 'ping_SP_0'
Feb  3 06:30:20 srv4hai ping_SP[10492]: SHELLY (0) - ping 192.168.12.61 pCnt:'1'
Feb  3 06:30:40 srv4hai ping_SP[14497]: SHELLY (0) - ping 192.168.12.61 1 sucessfully  @~1706938240 - 'ping_SP_0'
Feb  3 06:30:40 srv4hai ping_SP[14497]: SHELLY (0) - ping 192.168.12.61 pCnt:'1'
Feb  3 06:30:50 srv4hai ping_SP[10492]: SHELLY (0) - ping 192.168.12.61 1 sucessfully  @~1706938250 - 'ping_SP_0'
Feb  3 06:30:50 srv4hai ping_SP[10492]: SHELLY (0) - ping 192.168.12.61 pCnt:'1'
Feb  3 06:31:01 srv4hai CRON[18446]: (root) CMD (/etc/linetest/linetest.sh)
Feb  3 06:31:08 srv4hai meter.sh: SHELLY meter.sh ended
Feb  3 06:31:10 srv4hai ping_SP[14497]: SHELLY (0) - ping 192.168.12.61 1 sucessfully  @~1706938270 - 'ping_SP_0'
Feb  3 06:31:10 srv4hai ping_SP[14497]: SHELLY (0) - ping 192.168.12.61 pCnt:'1'
Feb  3 06:31:17 srv4hai postfix/smtpd[18487]: connect from unknown[91.215.85.17]
Feb  3 06:31:19 srv4hai trace_events[18492]: SHELLY trace_events.sh inkludiert: TRCF:'/srv/www/viehai/shelly/meter/trace_20240203.txt'
Feb  3 06:31:19 srv4hai bt_scan[18492]: SHELLY - who: 'Thomas' / phoneName: 'FP4_Thomas' / '0' found: 'No'
Feb  3 06:31:19 srv4hai bt_scan[18492]: SHELLY - lost BT-connection to BTmac: '0' found: 'No' - check presence
Feb  3 06:31:19 srv4hai trace_events[18520]: SHELLY trace_events.sh inkludiert: TRCF:'/srv/www/viehai/shelly/meter/trace_20240203.txt'
Feb  3 06:31:19 srv4hai check_presence[18520]: SHELLY ()-(bt_scan) what: 'presence' - persPresent: '(__/IP) (__/__) (__/__)' - anyPresent: 'true' - otherPresent:'true'
Feb  3 06:31:19 srv4hai check_presence[18520]: SHELLY ()-(bt_scan)-presence: NOT activate_scenario.shtml: offAll
Feb  3 06:31:21 srv4hai ping_SP[10492]: SHELLY (0) - ping 192.168.12.61 1 sucessfully  @~1706938281 - 'ping_SP_0'
Feb  3 06:31:21 srv4hai ping_SP[10492]: SHELLY (0) - ping 192.168.12.61 pCnt:'1'
Feb  3 06:31:21 srv4hai postfix/smtpd[18487]: warning: unknown[91.215.85.17]: SASL PLAIN authentication failed: 
Feb  3 06:31:21 srv4hai postfix/smtpd[18487]: disconnect from unknown[91.215.85.17] ehlo=2 starttls=1 auth=0/1 quit=1 unknown=0/1 commands=4/6
Feb  3 06:31:37 srv4hai trace_events[18557]: SHELLY trace_events.sh inkludiert: TRCF:'/srv/www/viehai/shelly/meter/trace_20240203.txt'
Feb  3 06:31:37 srv4hai bt_scan[18557]: SHELLY - who: 'Thomas' / phoneName: 'FP4_Thomas' / '0' found: 'Yes'
Feb  3 06:31:37 srv4hai bt_scan[18557]: SHELLY - ping_SP.sh started for BTmac: '0' - IPv4: '192.168.12.61'
Feb  3 06:31:37 srv4hai trace_events[18584]: SHELLY trace_events.sh inkludiert: TRCF:'/srv/www/viehai/shelly/meter/trace_20240203.txt'
Feb  3 06:31:37 srv4hai ping_SP[18584]: SHELLY ping_SP.sh started from bt_scan - trcF:'/srv/www/viehai/shelly/meter/trc_18584.txt'
Feb  3 06:31:37 srv4hai trace_events[18593]: SHELLY trace_events.sh inkludiert: TRCF:'/srv/www/viehai/shelly/meter/trace_20240203.txt'
Feb  3 06:31:37 srv4hai check_presence[18593]: SHELLY (ping_SP__bt_scan)-(0) what: 'coming' - persPresent: '(BT/IP) (__/__) (__/__)' - anyPresent: 'true' - otherPresent:'false'
Feb  3 06:31:37 srv4hai check_presence[18593]: SHELLY (ping_SP__bt_scan)-(0)-coming: activate_scenario.shtml: welcomeLight
Feb  3 06:31:37 srv4hai trace_events[18613]: SHELLY trace_events.sh inkludiert: TRCF:'/srv/www/viehai/shelly/meter/trace_20240203.txt'
Feb  3 06:31:37 srv4hai activate_scenario[18613]: SHELLY scenario: 'welcomeLight(welcomelight)' started
Feb  3 06:31:37 srv4hai activate_scenario[18613]: SHELLY dayState='night' <--> DayTime=checked NightTime=checked - phoneName:'0'

finished