OpenMQTTGateway -> MQTT und RollingCode .... mal wieder

andre07 · 28 Februar 2020, 21:16:39

Kein problem es funktioniert ja bei mir erst mal
mit etwas nachbessern

Andre

andre07 · 31 März 2020, 15:59:24

Hallo
Nachtrag
Seitdem ich das OpenMQTTGateway in Betrieb habe bekomme ich im Eventmonitor alle paar Secunden
diese Meldungen

Code Auswählen

[Freezemon] modulfreezer: Long function call detected ReadFn:MQTTServer_192.168.178.75_57732 - 0.603635 seconds
2020.03.31 15:45:58 1 : [Freezemon] modulfreezer: Long function call detected ReadFn:MQTTServer_192.168.178.85_62300 - 0.946939 seconds
2020.03.31 15:45:59 1 : [Freezemon] modulfreezer: Long function call detected ReadFn:MQTTServer_192.168.178.72_57732 - 0.773535 seconds

Kann man das irgenwie unterbinden denke mal das das ordentlich Leistung frißt in meinen System.
Beim Modulfreezer selber erscheinen diese Einträge auch in den Top 10

Andre

Beta-User · 31 März 2020, 16:10:25

Hmm, kann ich nicht beurteilen, ich habe freezmon nicht im Einsatz.

Zwei Anmerkungen:
Zum einen gehe ich davon aus, dass Rudi das in MQTT2_SERVER "non-blocking" gebaut hat, und sowas erkennt Freezmon teilweise nicht (bitte vorab verifizieren!).
Zum zweiten liest Rudi bisher in diesem Thread afaik nicht mit. Es wäre daher nach Prüfung von dem ersten Punkt besser, das Thema gesondert zu posten, unter einem Titel, den sowohl Rudi wie ggf. der Maintainer von Freezmon als "ihr" (mögliches!) Problem erkennen können.
Kann auch sein, dass die firmware schuld ist, aber das glaube ich eigentlich nicht, da wird intern genau dasselbe genutzt (pubsubclient) wie in vielen anderen firmwares auch... Aber ausschließen kann ich das selbstredend auch nicht.

rudolfkoenig · 31 März 2020, 18:12:19

Ich weiss nicht wie genau Freezemon arbeitet, aber an ReadFn aus MQTT2_Server "haengt" der Aufruf der MQTT2_DEVICE Datenverarbeitung, und daran wiederum die Event-Benachrichtigung, samt Logfile/DB-schreiben, notifies ausfuehren, Frontend Benachrichtigen, etc.

Gibts das Problem auch ohne Freezemon?
Der ist naemlich sicher nicht "kostenlos", was CPU-Benutzung betrifft.

Beta-User · 31 März 2020, 18:16:03

Hmm, dann _könnte_ es auch an der hier sehr viel komplexeren Weiterverarbeitung der Daten liegen, als das bei MQTT2_DEVICE an sich üblich ist? An sich ist das kein Hexenwerk, was da abläuft, aber eben auch nicht nur "ein bißchen Umpacken"...

andre07 · 02 April 2020, 22:40:21

Schalte mal Freezemon ab und las das über Nacht laufen

andre07 · 03 April 2020, 10:51:33

Mit ausgeschalteten Freezemon erscheinen die Einträge nicht mehr warum auch
aber apptime zeigt diese Device weiterhin ganz oben an

Code Auswählen

max    count      total  average   maxDly   avgDly TS Max call     param Max call
 MQTTServer_192.168.178.75_56384          MQTT2_SERVER_Read                      894       82   19693.54   240.17     0.00     0.00 03.04. 10:32:48 HASH(MQTTServer_192.168.178.75_56384)
 MQTTServer_192.168.178.64_53513          MQTT2_SERVER_Read                      134      390   19200.08    49.23     0.00     0.00 03.04. 10:30:45 HASH(MQTTServer_192.168.178.64_53513)
 MQTTServer_192.168.178.72_57823          MQTT2_SERVER_Read                      757       80   15508.56   193.86     0.00     0.00 03.04. 10:27:15 HASH(MQTTServer_192.168.178.72_57823)
 MQTTServer_192.168.178.85_62387          MQTT2_SERVER_Read                      534       67    8325.44   124.26     0.00     0.00 03.04. 10:27:15 HASH(MQTTServer_192.168.178.85_62387)

Die werden wohl im room hidden angelegt und beziehen sich auf dieses Device

Code Auswählen

Internals:
   CID        OMG_oben
   DEF        OMG_oben
   DEVICETOPIC MQTT2_OMG_oben
   FUUID      5e657e87-f33f-0b03-e041-02f5b93614166f43
   IODev      MQTTServer
   LASTInputDev MQTTServer
   MQTTServer_MSGCNT 14968
   MQTTServer_TIME 2020-04-03 10:39:19
   MSGCNT     14968
   NAME       MQTT2_OMG_oben
   NR         686
   STATE      <a href="http://192.168.178.72" target="_blank">
online
</a>Version: 0.9.4
   TYPE       MQTT2_DEVICE
   .attraggr:
   .attreocr:
     .*
   .attrminint:
   Helper:
     DBLOG:
       lux:
         logdb:
           TIME       1585903159.16395
           VALUE      76.0
   READINGS:
     2020-03-09 13:04:40   5_78.72___mac___B4_E6_2D_FB_24_59___modules___BT__0_ h
     2020-03-11 17:03:55   63___manufacturerdata_______rssi__-87__distance__18 
     2020-04-03 10:04:56   LWT             online
     2020-04-03 10:38:19   SSID            FRITZ!Box 7490
     2020-04-03 10:38:19   Sys_SSID        FRITZ!Box 7490
     2020-04-03 10:38:19   Sys_freeMem     53608
     2020-04-03 10:38:19   Sys_ip          192.168.178.72
     2020-04-03 10:38:19   Sys_mac         B4:E6:2D:FB:24:59
     2020-04-03 10:38:19   Sys_modules     BT
     2020-04-03 10:38:19   Sys_rssi        -69
     2020-04-03 10:38:19   Sys_uptime      382477
     2020-04-03 10:38:19   Sys_version     0.9.4
     2020-04-03 10:38:19   Sys_wifiPrt     0
     2020-04-03 10:39:19   distance        38.5
     2020-03-09 13:04:40   ed___name___Flower_care___rssi__-77__distance__7.1 
     2020-04-03 10:39:17   fer             70.0
     2020-04-03 10:38:19   freeMem         53608
     2020-04-03 10:39:19   id              cb:80:d6:cc:11:de
     2020-04-03 10:38:19   ip              192.168.178.72
     2020-04-03 10:39:19   lux             76.0
     2020-04-03 10:38:19   mac             B4:E6:2D:FB:24:59
     2020-04-03 10:39:19   manufacturerdata W
     2020-04-03 10:38:20   modules         BT
     2020-04-03 10:38:15   moi             11.0
     2020-04-02 20:54:38   name            JBL Pulse 3
     2020-03-09 11:56:33   nameFlowe       
     2020-04-03 10:39:19   rssi            -96
     2020-04-03 10:39:18   servicedata     71209800722651628d7cc40d0710034c0000
     2020-04-03 10:39:19   servicedatauuid 0000fe95-0000-1000-8000-00805f9b34fb
     2020-03-09 00:44:18   state           restart
     2020-03-18 00:51:38   steps           0.0
     2020-04-02 22:56:36   subscriptions   home/OMG_oben/commands/#
     2020-04-03 10:36:02   tem             26.0
     2020-04-02 18:19:08   txpower         12
     2020-04-03 10:38:19   uptime          382477
     2020-04-03 10:04:56   version         0.9.4
   helper:
     bm:
       MQTT2_DEVICE_Get:
         cnt        2
         dmx        -1000
         dtot       0
         dtotcnt    0
         mTS        03.04. 10:38:15
         max        0.000210046768188477
         tot        0.000254154205322266
         mAr:
           HASH(0x55cb2df922b0)
           MQTT2_OMG_oben
           ?
       MQTT2_DEVICE_Set:
         cnt        251
         dmx        -1000
         dtot       0
         dtotcnt    0
         mTS        03.04. 10:38:15
         max        0.000990867614746094
         tot        0.0620875358581543
         mAr:
           HASH(0x55cb2df922b0)
           MQTT2_OMG_oben
           ?
Attributes:
   IODev      MQTTServer
   bridgeRegexp home/OMG_oben/BTtoMQTT/([0-9A-Z]+):.* "oMQTTgw_BT"
  home/OMG_oben/433toMQTT:.* "oMQTTgw_433"
  home/OMG_oben/IRtoMQTT:.* "oMQTTgw_IR"
  home/OMG_oben/CLIMAtoMQTT/([a-zA-Z0-9]+):.* "OMG_oben_$1"
   devStateIcon online:10px-kreis-gruen offline.*:10px-kreis-rot
   event-on-change-reading .*
   group      Gateway
   icon       mqtt
   model      OpenMQTTGateway_MCU
   readingList home/OMG_oben/LWT:.* LWT
  home/OMG_oben/version:.* version
  home/OMG_oben/SYStoMQTT:.* { json2nameValue($EVENT,'Sys_')}
  homeassistant/[^/]*sensor/[^/]+/config:.* { $EVENT =~ m,OMG_oben, ? json2nameValue($EVENT,"HASS_") : undef }
OMG_oben:home/OMG_oben/SYStoMQTT/uptime:.* uptime
OMG_oben:home/OMG_oben/SYStoMQTT/freeMem:.* freeMem
OMG_oben:home/OMG_oben/SYStoMQTT/rssi:.* rssi
OMG_oben:home/OMG_oben/SYStoMQTT/SSID:.* SSID
OMG_oben:home/OMG_oben/SYStoMQTT/ip:.* ip
OMG_oben:home/OMG_oben/SYStoMQTT/mac:.* mac
OMG_oben:home/OMG_oben/SYStoMQTT/modules:.* modules
OMG_oben:home/home_presence/OMG_oben:.* { json2nameValue($EVENT) }
OMG_oben:home/OMG_oben/BTtoMQTT/C47C8D625126/id:.* id
OMG_oben:home/OMG_oben/BTtoMQTT/C47C8D625126/name:.* name
OMG_oben:home/OMG_oben/BTtoMQTT/C47C8D625126/rssi:.* rssi
OMG_oben:home/OMG_oben/BTtoMQTT/C47C8D625126/distance:.* distance
OMG_oben:home/OMG_oben/BTtoMQTT/C47C8D625126/servicedata:.* servicedata
OMG_oben:home/OMG_oben/BTtoMQTT/C47C8D625126/servicedatauuid:.* servicedatauuid
 room       MQTT2_DEVICE
   setList    restart:noArg home/OMG_oben/commands/MQTTtoSYS/config {"cmd":"restart"}
   stateFormat <a href="http://Sys_ip" target="_blank">
LWT
</a>Version: version

Andre

rudolfkoenig · 03 April 2020, 11:27:15

Apptime sollte man auch mit Vorsicht geniessen: hat (was CPU betrifft) die gleichen Probleme wie Freezemon, weiterhin ersetzt zentrale FHEM-Funktionen durch die eigene Variante.
Hast du apptime vorhin zusammen mit Freezemon verwendet?

Ich bin immer noch ueberzeugt, dass das Problem nicht in MQTT2_SERVER_Read liegt, sondern in einem der nachgelagerten Funktionen, ich tippe auf eine durch notify ausgeloeste Aktion, bzw. was Gleichwertiges (wie DbLog). Das gezeigte MQTT2_DEVICE ist ein BridgeDevice, d.h. sie haengt in den Benachrichtigungsketten aller Geraete, die von ihm als bridge abstammen.

Ich kann bei der Suche helfen, wenn ich ein "attr global verbose 5" Log eines Haengers sehe, sowas soll ja laut apptime Log ja alle 3 Minuten geben.

andre07 · 03 April 2020, 12:10:16

ok versuch mal mit verbose 5 und stelle das log hier ein
verknüpft ist das Device mit diesem hier

Code Auswählen

Internals:
   CID        CB80D6CC11DE
   DEF        CB80D6CC11DE
   DEVICETOPIC miband_andre
   FUUID      5e65877f-f33f-0b03-2cca-27cb6da44820541e
   IODev      MQTTServer
   LASTInputDev MQTTServer
   MQTTServer_MSGCNT 446
   MQTTServer_TIME 2020-04-03 11:51:47
   MSGCNT     446
   NAME       miband_andre
   NR         692
   STATE      Last IO: OMG_unten
   TYPE       MQTT2_DEVICE
   .attraggr:
   .attrminint:
     300
   .userReadings:
     HASH(0x55cb2e1fca38)
   READINGS:
     2020-04-03 11:28:36   OMG_keller_distance 27.75274
     2020-04-03 11:28:36   OMG_keller_id   cb:80:d6:cc:11:de
     2020-04-03 11:28:36   OMG_keller_manufacturerdata W
     2020-03-18 17:16:59   OMG_keller_name MI Band 2
     2020-04-03 11:28:36   OMG_keller_rssi -92
     2020-04-03 10:54:38   OMG_oben_distance 5.270232
     2020-04-03 10:54:38   OMG_oben_id     cb:80:d6:cc:11:de
     2020-04-03 10:54:38   OMG_oben_manufacturerdata W
     2020-03-30 00:22:40   OMG_oben_name   MI Band 2
     2020-04-03 10:54:38   OMG_oben_rssi   -74
     2020-04-03 11:51:47   OMG_unten_distance 38.4873
     2020-04-03 11:51:47   OMG_unten_id    cb:80:d6:cc:11:de
     2020-04-03 11:51:47   OMG_unten_manufacturerdata W
     2020-04-03 11:51:47   OMG_unten_name  MI Band 2
     2020-04-03 11:51:47   OMG_unten_rssi  -96
     2020-04-03 11:51:47   bestRecentGW    OMG_unten
     2020-04-03 11:51:47   last_IO         OMG_unten
   helper:
     bm:
       MQTT2_DEVICE_Get:
         cnt        1
         dmx        -1000
         dtot       0
         dtotcnt    0
         mTS        03.04. 12:08:07
         max        3.814697265625e-05
         tot        3.814697265625e-05
         mAr:
           HASH(0x55cb2e2149c0)
           miband_andre
           ?
       MQTT2_DEVICE_Set:
         cnt        31
         dmx        -1000
         dtot       0
         dtotcnt    0
         mTS        03.04. 10:48:02
         max        8.58306884765625e-05
         tot        0.00191712379455566
         mAr:
           HASH(0x55cb2e2149c0)
           miband_andre
           ?
Attributes:
   DbLogExclude .*
   DbLogInclude bestRecentGW,last_IO,OMG_oben_rssi,OMG_keller_rssi,OMG_unten_rssi
   IODev      MQTTServer
   autocreate 0
   event-min-interval 300
   group      Personen
   icon       temperature_humidity
   maxPresenceAge 1200
   maxReadingsAge 700
   model      OpenMQTTGateway_BT_gtag
   readingList home/(O[^/]*M[^/]*G[^/]*)/BTtoMQTT/CB80D6CC11DE:.* { $TOPIC =~ m,home/(O[^/]*M[^/]*G[^/]*)/BTtoMQTT,;; json2nameValue($EVENT, "${1}_") }
  home/(O[^/]*M[^/]*G[^/]*)/BTtoMQTT/CB80D6CC11DE:.* { $TOPIC =~ m,home/(O[^/]*M[^/]*G[^/]*)/BTtoMQTT,;; {"last_IO"=>"$1"}}
   room       MQTT2_DEVICE
   stateFormat Last IO: last_IO
   userReadings bestRecentGW:.*_rssi.* {identifyMyBestGW($name)}
   userattr   maxPresenceAge maxReadingsAge

Ein notify oder Doif hängt da zur Zeit noch nicht mit dran.
Apptime und Freezemon sind beide zusammen gelaufen Freezemon hab ich dann erst mal rausgenommen.
Danach Rechner neustart und apptime gestartet
Andre

Beta-User · 03 April 2020, 12:41:35

@andre07:
Was die Frage nach den Event-Handlern angeht ist die Aussage evtl. mit Vorsicht zu genießen, denn häufig passiert sowas unbeabsichtigt... (Gestern (?) hatten wir einen Fall, da war es "nur" ein (!) userreadings-Eintrag, der ziemliche Verzögerungen verursacht hat - zu großzügiger Trigger, und schon ist es passiert... (der hiesige sollte eigentlich ok sein, der hat einen eher engen trigger).)

Schau also bitte wenn irgend möglich nochmal ALLE Event-Handler an, v.a. auch das Zeug, was einem nicht leich als notify oder DOIF ins Auge springt (einschl. FileLog/DBLog). Früher gab es z.B. mit "dewpoint" auch mal so einen Kandidaten, der alles "abgeräumt" hat, falls du das im Einsatz hast.

andre07 · 03 April 2020, 14:13:15

Hallo
Habe das jetzt hier im log finden können

Code Auswählen

Trigger Dev Name   : MQTT2_OMG_oben
2020.04.03 12:17:54 4: dewpoint_notify: cmd_type=dewpoint devname=MQTT2_OMG_oben dewname=taupunk_all, dev=MQTT2_OMG_oben, dev_regex=.* temp_name=temperature hum_name=humidity
2020.04.03 12:17:54 5: dewpoint_notify: s='distance: 25.51913'
2020.04.03 12:17:54 5: dewpoint_notify: evName='distance:' val=25.51913'
2020.04.03 12:17:54 5: dewpoint_notify: s='id: 65:51:69:88:54:8c'
2020.04.03 12:17:54 5: dewpoint_notify: evName='id:' val=65:51:69:88:54:8c'
2020.04.03 12:17:54 5: dewpoint_notify: s='rssi: -91'
2020.04.03 12:17:54 5: dewpoint_notify: evName='rssi:' val=-91'
2020.04.03 12:17:54 5: dewpoint_notify: max_timediff=10
2020.04.03 12:17:54 5: batterieStatus: not on any display, ignoring notify
2020.04.03 12:17:54 4: DbLog logdb -> ################################################################
2020.04.03 12:17:54 4: DbLog logdb -> ###              start of new Logcycle                       ###
2020.04.03 12:17:54 4: DbLog logdb -> ################################################################
2020.04.03 12:17:54 4: DbLog logdb -> number of events received: 3 for device: MQTT2_OMG_oben
2020.04.03 12:17:54 4: DbLog logdb -> check Device: MQTT2_OMG_oben , Event: distance: 25.51913
2020.04.03 12:17:54 4: DbLog logdb -> check Device: MQTT2_OMG_oben , Event: id: 65:51:69:88:54:8c
2020.04.03 12:17:54 4: DbLog logdb -> check Device: MQTT2_OMG_oben , Event: rssi: -91
2020.04.03 12:17:54 5: End notify loop for MQTT2_OMG_oben
2020.04.03 12:17:54 4:   MQTTServer_192.168.178.72_57823 OMG_oben PUBLISH home/OMG_oben/BTtoMQTT/65516988548C:{"id":"65:51:69:88:54:8c","manufacturerdata":"","rssi":-91,"distance":25.51913}
2020.04.03 12:17:54 5: MQTTServer: dispatch autocreate=no\000OMG_oben\000home/OMG_oben/BTtoMQTT/65516988548C\000{"id":"65:51:69:88:54:8c","manufacturerdata":"\006","rssi":-91,"distance":25.51913}
2020.04.03 12:17:54 5: MQTT_GENERIC_BRIDGE: [mqttbridge] Parse (MQTT2_SERVER : 'MQTTServer'): Msg: home/OMG_oben/BTtoMQTT/65516988548C => {"id":"65:51:69:88:54:8c","manufacturerdata":"","rssi":-91,"distance":25.51913}
2020.04.03 12:17:54 5: Starting notify loop for MQTTServer, 1 event(s), first is home/OMG_oben/BTtoMQTT/65516988548C:{"id":"65:51:69:88:54:8c","manufacturerdata":"\006","rssi":-91,"distance":25.51913}
2020.04.03 12:17:54 5: meinStromCalculator : ElectricityCalculator_Notify - Trigger Dev Name   : MQTTServer
2020.04.03 12:17:54 4: dewpoint_notify: cmd_type=dewpoint devname=MQTTServer dewname=taupunk_all, dev=MQTTServer, dev_regex=.* temp_name=temperature hum_name=humidity
2020.04.03 12:17:54 5: dewpoint_notify: s='home/OMG_oben/BTtoMQTT/65516988548C:{"id":"65:51:69:88:54:8c","manufacturerdata":"","rssi":-91,"distance":25.51913}'
2020.04.03 12:17:54 5: dewpoint_notify: max_timediff=10
2020.04.03 12:17:54 5: batterieStatus: not on any display, ignoring notify
2020.04.03 12:17:54 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> ###              start of new Logcycle                       ###
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> number of events received: 1 for device: MQTTServer
2020.04.03 12:17:55 4: DbLog logdb -> check Device: MQTTServer , Event: home/OMG_oben/BTtoMQTT/65516988548C:{"id":"65:51:69:88:54:8c","manufacturerdata":"","rssi":-91,"distance":25.51913}
2020.04.03 12:17:55 5: DbLog logdb -> parsed Event: MQTTServer , Event: home/OMG_oben/BTtoMQTT/65516988548C:{"id":"65:51:69:88:54:8c","manufacturerdata":"","rssi":-91,"distance":25.51913}
2020.04.03 12:17:55 5: DbLog logdb -> DbLogExclude of "MQTTServer": .*
2020.04.03 12:17:55 5: End notify loop for MQTTServer
2020.04.03 12:17:55 4:   MQTTServer_192.168.178.72_57823 OMG_oben PUBLISH home/OMG_oben/BTtoMQTT/65516988548C/id:65:51:69:88:54:8c
2020.04.03 12:17:55 5: MQTTServer: dispatch autocreate=no\000OMG_oben\000home/OMG_oben/BTtoMQTT/65516988548C/id\00065:51:69:88:54:8c
2020.04.03 12:17:55 5: MQTT_GENERIC_BRIDGE: [mqttbridge] Parse (MQTT2_SERVER : 'MQTTServer'): Msg: home/OMG_oben/BTtoMQTT/65516988548C/id => 65:51:69:88:54:8c
2020.04.03 12:17:55 5: Starting notify loop for MQTTServer, 1 event(s), first is home/OMG_oben/BTtoMQTT/65516988548C/id:65:51:69:88:54:8c
2020.04.03 12:17:55 5: meinStromCalculator : ElectricityCalculator_Notify - Trigger Dev Name   : MQTTServer
2020.04.03 12:17:55 4: dewpoint_notify: cmd_type=dewpoint devname=MQTTServer dewname=taupunk_all, dev=MQTTServer, dev_regex=.* temp_name=temperature hum_name=humidity
2020.04.03 12:17:55 5: dewpoint_notify: s='home/OMG_oben/BTtoMQTT/65516988548C/id:65:51:69:88:54:8c'
2020.04.03 12:17:55 5: dewpoint_notify: max_timediff=10
2020.04.03 12:17:55 5: batterieStatus: not on any display, ignoring notify
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> ###              start of new Logcycle                       ###
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> number of events received: 1 for device: MQTTServer
2020.04.03 12:17:55 4: DbLog logdb -> check Device: MQTTServer , Event: home/OMG_oben/BTtoMQTT/65516988548C/id:65:51:69:88:54:8c
2020.04.03 12:17:55 5: DbLog logdb -> parsed Event: MQTTServer , Event: home/OMG_oben/BTtoMQTT/65516988548C/id:65:51:69:88:54:8c
2020.04.03 12:17:55 5: DbLog logdb -> DbLogExclude of "MQTTServer": .*
2020.04.03 12:17:55 5: End notify loop for MQTTServer
2020.04.03 12:17:55 4:   MQTTServer_192.168.178.72_57823 OMG_oben PUBLISH home/OMG_oben/BTtoMQTT/65516988548C/manufacturerdata:
2020.04.03 12:17:55 5: MQTTServer: dispatch autocreate=no\000OMG_oben\000home/OMG_oben/BTtoMQTT/65516988548C/manufacturerdata\000\006
2020.04.03 12:17:55 5: MQTT_GENERIC_BRIDGE: [mqttbridge] Parse (MQTT2_SERVER : 'MQTTServer'): Msg: home/OMG_oben/BTtoMQTT/65516988548C/manufacturerdata => 
2020.04.03 12:17:55 5: Starting notify loop for MQTTServer, 1 event(s), first is home/OMG_oben/BTtoMQTT/65516988548C/manufacturerdata:\006
2020.04.03 12:17:55 5: meinStromCalculator : ElectricityCalculator_Notify - Trigger Dev Name   : MQTTServer
2020.04.03 12:17:55 4: dewpoint_notify: cmd_type=dewpoint devname=MQTTServer dewname=taupunk_all, dev=MQTTServer, dev_regex=.* temp_name=temperature hum_name=humidity
2020.04.03 12:17:55 5: dewpoint_notify: s='home/OMG_oben/BTtoMQTT/65516988548C/manufacturerdata:'
2020.04.03 12:17:55 5: dewpoint_notify: max_timediff=10
2020.04.03 12:17:55 5: batterieStatus: not on any display, ignoring notify
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> ###              start of new Logcycle                       ###
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> number of events received: 1 for device: MQTTServer
2020.04.03 12:17:55 4: DbLog logdb -> check Device: MQTTServer , Event: home/OMG_oben/BTtoMQTT/65516988548C/manufacturerdata:
2020.04.03 12:17:55 5: DbLog logdb -> parsed Event: MQTTServer , Event: home/OMG_oben/BTtoMQTT/65516988548C/manufacturerdata:
2020.04.03 12:17:55 5: DbLog logdb -> DbLogExclude of "MQTTServer": .*
2020.04.03 12:17:55 5: End notify loop for MQTTServer
2020.04.03 12:17:55 4:   MQTTServer_192.168.178.72_57823 OMG_oben PUBLISH home/OMG_oben/BTtoMQTT/65516988548C/rssi:-91
2020.04.03 12:17:55 5: MQTTServer: dispatch autocreate=no\000OMG_oben\000home/OMG_oben/BTtoMQTT/65516988548C/rssi\000-91
2020.04.03 12:17:55 5: MQTT_GENERIC_BRIDGE: [mqttbridge] Parse (MQTT2_SERVER : 'MQTTServer'): Msg: home/OMG_oben/BTtoMQTT/65516988548C/rssi => -91
2020.04.03 12:17:55 5: Starting notify loop for MQTTServer, 1 event(s), first is home/OMG_oben/BTtoMQTT/65516988548C/rssi:-91
2020.04.03 12:17:55 5: meinStromCalculator : ElectricityCalculator_Notify - Trigger Dev Name   : MQTTServer
2020.04.03 12:17:55 4: dewpoint_notify: cmd_type=dewpoint devname=MQTTServer dewname=taupunk_all, dev=MQTTServer, dev_regex=.* temp_name=temperature hum_name=humidity
2020.04.03 12:17:55 5: dewpoint_notify: s='home/OMG_oben/BTtoMQTT/65516988548C/rssi:-91'
2020.04.03 12:17:55 5: dewpoint_notify: max_timediff=10
2020.04.03 12:17:55 5: batterieStatus: not on any display, ignoring notify
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> ###              start of new Logcycle                       ###
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> number of events received: 1 for device: MQTTServer
2020.04.03 12:17:55 4: DbLog logdb -> check Device: MQTTServer , Event: home/OMG_oben/BTtoMQTT/65516988548C/rssi:-91
2020.04.03 12:17:55 5: DbLog logdb -> parsed Event: MQTTServer , Event: home/OMG_oben/BTtoMQTT/65516988548C/rssi:-91
2020.04.03 12:17:55 5: DbLog logdb -> DbLogExclude of "MQTTServer": .*
2020.04.03 12:17:55 5: End notify loop for MQTTServer
2020.04.03 12:17:55 4:   MQTTServer_192.168.178.72_57823 OMG_oben PUBLISH home/OMG_oben/BTtoMQTT/65516988548C/distance:25.5
2020.04.03 12:17:55 5: MQTTServer: dispatch autocreate=no\000OMG_oben\000home/OMG_oben/BTtoMQTT/65516988548C/distance\00025.5
2020.04.03 12:17:55 5: MQTT_GENERIC_BRIDGE: [mqttbridge] Parse (MQTT2_SERVER : 'MQTTServer'): Msg: home/OMG_oben/BTtoMQTT/65516988548C/distance => 25.5
2020.04.03 12:17:55 5: Starting notify loop for MQTTServer, 1 event(s), first is home/OMG_oben/BTtoMQTT/65516988548C/distance:25.5
2020.04.03 12:17:55 5: meinStromCalculator : ElectricityCalculator_Notify - Trigger Dev Name   : MQTTServer
2020.04.03 12:17:55 4: dewpoint_notify: cmd_type=dewpoint devname=MQTTServer dewname=taupunk_all, dev=MQTTServer, dev_regex=.* temp_name=temperature hum_name=humidity
2020.04.03 12:17:55 5: dewpoint_notify: s='home/OMG_oben/BTtoMQTT/65516988548C/distance:25.5'
2020.04.03 12:17:55 5: dewpoint_notify: max_timediff=10
2020.04.03 12:17:55 5: batterieStatus: not on any display, ignoring notify
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> ###              start of new Logcycle                       ###
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> number of events received: 1 for device: MQTTServer
2020.04.03 12:17:55 4: DbLog logdb -> check Device: MQTTServer , Event: home/OMG_oben/BTtoMQTT/65516988548C/distance:25.5
2020.04.03 12:17:55 5: DbLog logdb -> parsed Event: MQTTServer , Event: home/OMG_oben/BTtoMQTT/65516988548C/distance:25.5
2020.04.03 12:17:55 5: DbLog logdb -> DbLogExclude of "MQTTServer": .*
2020.04.03 12:17:55 5: End notify loop for MQTTServer
2020.04.03 12:17:55 4:   MQTTServer_192.168.178.72_57823 OMG_oben PUBLISH home/home_presence/OMG_oben:{"id":"c4:7c:8d:62:51:26","rssi":-89,"distance":21.51847}
2020.04.03 12:17:55 5: MQTTServer: dispatch autocreate=no\000OMG_oben\000home/home_presence/OMG_oben\000{"id":"c4:7c:8d:62:51:26","rssi":-89,"distance":21.51847}
2020.04.03 12:17:55 4: MQTT2_DEVICE_Parse: MQTT2_OMG_oben home/home_presence/OMG_oben => { json2nameValue($EVENT) }
2020.04.03 12:17:55 5: MQTT_GENERIC_BRIDGE: [mqttbridge] Parse (MQTT2_SERVER : 'MQTTServer'): Msg: home/home_presence/OMG_oben => {"id":"c4:7c:8d:62:51:26","rssi":-89,"distance":21.51847}
2020.04.03 12:17:55 5: Starting notify loop for MQTT2_OMG_oben, 3 event(s), first is id: c4:7c:8d:62:51:26
2020.04.03 12:17:55 5: meinStromCalculator : ElectricityCalculator_Notify - Trigger Dev Name   : MQTT2_OMG_oben
2020.04.03 12:17:55 4: dewpoint_notify: cmd_type=dewpoint devname=MQTT2_OMG_oben dewname=taupunk_all, dev=MQTT2_OMG_oben, dev_regex=.* temp_name=temperature hum_name=humidity
2020.04.03 12:17:55 5: dewpoint_notify: s='id: c4:7c:8d:62:51:26'
2020.04.03 12:17:55 5: dewpoint_notify: evName='id:' val=c4:7c:8d:62:51:26'
2020.04.03 12:17:55 5: dewpoint_notify: s='distance: 21.51847'
2020.04.03 12:17:55 5: dewpoint_notify: evName='distance:' val=21.51847'
2020.04.03 12:17:55 5: dewpoint_notify: s='rssi: -89'
2020.04.03 12:17:55 5: dewpoint_notify: evName='rssi:' val=-89'
2020.04.03 12:17:55 5: dewpoint_notify: max_timediff=10
2020.04.03 12:17:55 5: batterieStatus: not on any display, ignoring notify
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> ###              start of new Logcycle                       ###
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> number of events received: 3 for device: MQTT2_OMG_oben
2020.04.03 12:17:55 4: DbLog logdb -> check Device: MQTT2_OMG_oben , Event: id: c4:7c:8d:62:51:26
2020.04.03 12:17:55 4: DbLog logdb -> check Device: MQTT2_OMG_oben , Event: distance: 21.51847
2020.04.03 12:17:55 4: DbLog logdb -> check Device: MQTT2_OMG_oben , Event: rssi: -89
2020.04.03 12:17:55 5: End notify loop for MQTT2_OMG_oben
2020.04.03 12:17:55 4:   MQTTServer_192.168.178.72_57823 OMG_oben PUBLISH home/OMG_oben/BTtoMQTT/C47C8D625126:{"id":"c4:7c:8d:62:51:26","rssi":-89,"distance":21.51847,"servicedata":"71209800582651628d7cc40d0910022100","servicedatauuid":"0000fe95-0000-1000-8000-00805f9b34fb"}
2020.04.03 12:17:55 5: MQTTServer: dispatch autocreate=no\000OMG_oben\000home/OMG_oben/BTtoMQTT/C47C8D625126\000{"id":"c4:7c:8d:62:51:26","rssi":-89,"distance":21.51847,"servicedata":"71209800582651628d7cc40d0910022100","servicedatauuid":"0000fe95-0000-1000-8000-00805f9b34fb"}
2020.04.03 12:17:55 4: MQTT2_DEVICE_Parse: MQTT2_oMQTTgw_BT home/OMG_oben/BTtoMQTT/C47C8D625126 => { json2nameValue($EVENT) }
2020.04.03 12:17:55 4: MQTT2_DEVICE_Parse: Aloe home/OMG_oben/BTtoMQTT/C47C8D625126 => { json2nameValue($EVENT,'',$JSONMAP) }
2020.04.03 12:17:55 5: MQTT_GENERIC_BRIDGE: [mqttbridge] Parse (MQTT2_SERVER : 'MQTTServer'): Msg: home/OMG_oben/BTtoMQTT/C47C8D625126 => {"id":"c4:7c:8d:62:51:26","rssi":-89,"distance":21.51847,"servicedata":"71209800582651628d7cc40d0910022100","servicedatauuid":"0000fe95-0000-1000-8000-00805f9b34fb"}
2020.04.03 12:17:55 5: Starting notify loop for MQTT2_oMQTTgw_BT, 5 event(s), first is rssi: -89
2020.04.03 12:17:55 5: meinStromCalculator : ElectricityCalculator_Notify - Trigger Dev Name   : MQTT2_oMQTTgw_BT
2020.04.03 12:17:55 4: dewpoint_notify: cmd_type=dewpoint devname=MQTT2_oMQTTgw_BT dewname=taupunk_all, dev=MQTT2_oMQTTgw_BT, dev_regex=.* temp_name=temperature hum_name=humidity
2020.04.03 12:17:55 5: dewpoint_notify: s='rssi: -89'
2020.04.03 12:17:55 5: dewpoint_notify: evName='rssi:' val=-89'
2020.04.03 12:17:55 5: dewpoint_notify: s='servicedata: 71209800582651628d7cc40d0910022100'
2020.04.03 12:17:55 5: dewpoint_notify: evName='servicedata:' val=71209800582651628d7cc40d0910022100'
2020.04.03 12:17:55 5: dewpoint_notify: s='servicedatauuid: 0000fe95-0000-1000-8000-00805f9b34fb'
2020.04.03 12:17:55 5: dewpoint_notify: evName='servicedatauuid:' val=0000fe95-0000-1000-8000-00805f9b34fb'
2020.04.03 12:17:55 5: dewpoint_notify: s='distance: 21.51847'
2020.04.03 12:17:55 5: dewpoint_notify: evName='distance:' val=21.51847'
2020.04.03 12:17:55 5: dewpoint_notify: s='id: c4:7c:8d:62:51:26'
2020.04.03 12:17:55 5: dewpoint_notify: evName='id:' val=c4:7c:8d:62:51:26'
2020.04.03 12:17:55 5: dewpoint_notify: max_timediff=10
2020.04.03 12:17:55 5: batterieStatus: not on any display, ignoring notify
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> ###              start of new Logcycle                       ###
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> number of events received: 5 for device: MQTT2_oMQTTgw_BT
2020.04.03 12:17:55 4: DbLog logdb -> check Device: MQTT2_oMQTTgw_BT , Event: rssi: -89
2020.04.03 12:17:55 4: DbLog logdb -> check Device: MQTT2_oMQTTgw_BT , Event: servicedata: 71209800582651628d7cc40d0910022100
2020.04.03 12:17:55 4: DbLog logdb -> check Device: MQTT2_oMQTTgw_BT , Event: servicedatauuid: 0000fe95-0000-1000-8000-00805f9b34fb
2020.04.03 12:17:55 4: DbLog logdb -> check Device: MQTT2_oMQTTgw_BT , Event: distance: 21.51847
2020.04.03 12:17:55 4: DbLog logdb -> check Device: MQTT2_oMQTTgw_BT , Event: id: c4:7c:8d:62:51:26
2020.04.03 12:17:55 5: End notify loop for MQTT2_oMQTTgw_BT
2020.04.03 12:17:55 5: Starting notify loop for MQTTServer, 1 event(s), first is home/OMG_oben/BTtoMQTT/C47C8D625126:{"id":"c4:7c:8d:62:51:26","rssi":-89,"distance":21.51847,"servicedata":"71209800582651628d7cc40d0910022100","servicedatauuid":"0000fe95-0000-1000-8000-00805f9b34fb"}
2020.04.03 12:17:55 5: meinStromCalculator : ElectricityCalculator_Notify - Trigger Dev Name   : MQTTServer
2020.04.03 12:17:55 4: dewpoint_notify: cmd_type=dewpoint devname=MQTTServer dewname=taupunk_all, dev=MQTTServer, dev_regex=.* temp_name=temperature hum_name=humidity
2020.04.03 12:17:55 5: dewpoint_notify: s='home/OMG_oben/BTtoMQTT/C47C8D625126:{"id":"c4:7c:8d:62:51:26","rssi":-89,"distance":21.51847,"servicedata":"71209800582651628d7cc40d0910022100","servicedatauuid":"0000fe95-0000-1000-8000-00805f9b34fb"}'
2020.04.03 12:17:55 5: dewpoint_notify: max_timediff=10
2020.04.03 12:17:55 5: batterieStatus: not on any display, ignoring notify
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> ###              start of new Logcycle                       ###
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> number of events received: 1 for device: MQTTServer
2020.04.03 12:17:55 4: DbLog logdb -> check Device: MQTTServer , Event: home/OMG_oben/BTtoMQTT/C47C8D625126:{"id":"c4:7c:8d:62:51:26","rssi":-89,"distance":21.51847,"servicedata":"71209800582651628d7cc40d0910022100","servicedatauuid":"0000fe95-0000-1000-8000-00805f9b34fb"}
2020.04.03 12:17:55 5: DbLog logdb -> parsed Event: MQTTServer , Event: home/OMG_oben/BTtoMQTT/C47C8D625126:{"id":"c4:7c:8d:62:51:26","rssi":-89,"distance":21.51847,"servicedata":"71209800582651628d7cc40d0910022100","servicedatauuid":"0000fe95-0000-1000-8000-00805f9b34fb"}
2020.04.03 12:17:55 5: DbLog logdb -> DbLogExclude of "MQTTServer": .*
2020.04.03 12:17:55 5: End notify loop for MQTTServer
2020.04.03 12:17:55 4:   MQTTServer_192.168.178.72_57823 OMG_oben PUBLISH home/OMG_oben/BTtoMQTT/C47C8D625126/id:c4:7c:8d:62:51:26
2020.04.03 12:17:55 5: MQTTServer: dispatch autocreate=no\000OMG_oben\000home/OMG_oben/BTtoMQTT/C47C8D625126/id\000c4:7c:8d:62:51:26
2020.04.03 12:17:55 4: MQTT2_DEVICE_Parse: MQTT2_OMG_oben home/OMG_oben/BTtoMQTT/C47C8D625126/id => id
2020.04.03 12:17:55 5: MQTT_GENERIC_BRIDGE: [mqttbridge] Parse (MQTT2_SERVER : 'MQTTServer'): Msg: home/OMG_oben/BTtoMQTT/C47C8D625126/id => c4:7c:8d:62:51:26
2020.04.03 12:17:55 5: Starting notify loop for MQTTServer, 1 event(s), first is home/OMG_oben/BTtoMQTT/C47C8D625126/id:c4:7c:8d:62:51:26
2020.04.03 12:17:55 5: meinStromCalculator : ElectricityCalculator_Notify - Trigger Dev Name   : MQTTServer
2020.04.03 12:17:55 4: dewpoint_notify: cmd_type=dewpoint devname=MQTTServer dewname=taupunk_all, dev=MQTTServer, dev_regex=.* temp_name=temperature hum_name=humidity
2020.04.03 12:17:55 5: dewpoint_notify: s='home/OMG_oben/BTtoMQTT/C47C8D625126/id:c4:7c:8d:62:51:26'
2020.04.03 12:17:55 5: dewpoint_notify: max_timediff=10
2020.04.03 12:17:55 5: batterieStatus: not on any display, ignoring notify
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> ###              start of new Logcycle                       ###
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> number of events received: 1 for device: MQTTServer
2020.04.03 12:17:55 4: DbLog logdb -> check Device: MQTTServer , Event: home/OMG_oben/BTtoMQTT/C47C8D625126/id:c4:7c:8d:62:51:26
2020.04.03 12:17:55 5: DbLog logdb -> parsed Event: MQTTServer , Event: home/OMG_oben/BTtoMQTT/C47C8D625126/id:c4:7c:8d:62:51:26
2020.04.03 12:17:55 5: DbLog logdb -> DbLogExclude of "MQTTServer": .*
2020.04.03 12:17:55 5: End notify loop for MQTTServer
2020.04.03 12:17:55 4:   MQTTServer_192.168.178.72_57823 OMG_oben PUBLISH home/OMG_oben/BTtoMQTT/C47C8D625126/rssi:-89
2020.04.03 12:17:55 5: MQTTServer: dispatch autocreate=no\000OMG_oben\000home/OMG_oben/BTtoMQTT/C47C8D625126/rssi\000-89
2020.04.03 12:17:55 4: MQTT2_DEVICE_Parse: MQTT2_OMG_oben home/OMG_oben/BTtoMQTT/C47C8D625126/rssi => rssi
2020.04.03 12:17:55 5: MQTT_GENERIC_BRIDGE: [mqttbridge] Parse (MQTT2_SERVER : 'MQTTServer'): Msg: home/OMG_oben/BTtoMQTT/C47C8D625126/rssi => -89
2020.04.03 12:17:55 5: Starting notify loop for MQTTServer, 1 event(s), first is home/OMG_oben/BTtoMQTT/C47C8D625126/rssi:-89
2020.04.03 12:17:55 5: meinStromCalculator : ElectricityCalculator_Notify - Trigger Dev Name   : MQTTServer
2020.04.03 12:17:55 4: dewpoint_notify: cmd_type=dewpoint devname=MQTTServer dewname=taupunk_all, dev=MQTTServer, dev_regex=.* temp_name=temperature hum_name=humidity
2020.04.03 12:17:55 5: dewpoint_notify: s='home/OMG_oben/BTtoMQTT/C47C8D625126/rssi:-89'
2020.04.03 12:17:55 5: dewpoint_notify: max_timediff=10
2020.04.03 12:17:55 5: batterieStatus: not on any display, ignoring notify
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> ###              start of new Logcycle                       ###
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> number of events received: 1 for device: MQTTServer
2020.04.03 12:17:55 4: DbLog logdb -> check Device: MQTTServer , Event: home/OMG_oben/BTtoMQTT/C47C8D625126/rssi:-89
2020.04.03 12:17:55 5: DbLog logdb -> parsed Event: MQTTServer , Event: home/OMG_oben/BTtoMQTT/C47C8D625126/rssi:-89
2020.04.03 12:17:55 5: DbLog logdb -> DbLogExclude of "MQTTServer": .*
2020.04.03 12:17:55 5: End notify loop for MQTTServer
2020.04.03 12:17:55 4:   MQTTServer_192.168.178.72_57823 OMG_oben PUBLISH home/OMG_oben/BTtoMQTT/C47C8D625126/distance:21.5
2020.04.03 12:17:55 5: MQTTServer: dispatch autocreate=no\000OMG_oben\000home/OMG_oben/BTtoMQTT/C47C8D625126/distance\00021.5
2020.04.03 12:17:55 4: MQTT2_DEVICE_Parse: MQTT2_OMG_oben home/OMG_oben/BTtoMQTT/C47C8D625126/distance => distance
2020.04.03 12:17:55 5: MQTT_GENERIC_BRIDGE: [mqttbridge] Parse (MQTT2_SERVER : 'MQTTServer'): Msg: home/OMG_oben/BTtoMQTT/C47C8D625126/distance => 21.5
2020.04.03 12:17:55 5: Starting notify loop for MQTT2_OMG_oben, 1 event(s), first is distance: 21.5
2020.04.03 12:17:55 5: meinStromCalculator : ElectricityCalculator_Notify - Trigger Dev Name   : MQTT2_OMG_oben
2020.04.03 12:17:55 4: dewpoint_notify: cmd_type=dewpoint devname=MQTT2_OMG_oben dewname=taupunk_all, dev=MQTT2_OMG_oben, dev_regex=.* temp_name=temperature hum_name=humidity
2020.04.03 12:17:55 5: dewpoint_notify: s='distance: 21.5'
2020.04.03 12:17:55 5: dewpoint_notify: evName='distance:' val=21.5'
2020.04.03 12:17:55 5: dewpoint_notify: max_timediff=10
2020.04.03 12:17:55 5: batterieStatus: not on any display, ignoring notify
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> ###              start of new Logcycle                       ###
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> number of events received: 1 for device: MQTT2_OMG_oben
2020.04.03 12:17:55 4: DbLog logdb -> check Device: MQTT2_OMG_oben , Event: distance: 21.5
2020.04.03 12:17:55 5: End notify loop for MQTT2_OMG_oben
2020.04.03 12:17:55 5: Starting notify loop for MQTTServer, 1 event(s), first is home/OMG_oben/BTtoMQTT/C47C8D625126/distance:21.5
2020.04.03 12:17:55 5: meinStromCalculator : ElectricityCalculator_Notify - Trigger Dev Name   : MQTTServer
2020.04.03 12:17:55 4: dewpoint_notify: cmd_type=dewpoint devname=MQTTServer dewname=taupunk_all, dev=MQTTServer, dev_regex=.* temp_name=temperature hum_name=humidity
2020.04.03 12:17:55 5: dewpoint_notify: s='home/OMG_oben/BTtoMQTT/C47C8D625126/distance:21.5'
2020.04.03 12:17:55 5: dewpoint_notify: max_timediff=10
2020.04.03 12:17:55 5: batterieStatus: not on any display, ignoring notify
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> ###              start of new Logcycle                       ###
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> number of events received: 1 for device: MQTTServer
2020.04.03 12:17:55 4: DbLog logdb -> check Device: MQTTServer , Event: home/OMG_oben/BTtoMQTT/C47C8D625126/distance:21.5
2020.04.03 12:17:55 5: DbLog logdb -> parsed Event: MQTTServer , Event: home/OMG_oben/BTtoMQTT/C47C8D625126/distance:21.5
2020.04.03 12:17:55 5: DbLog logdb -> DbLogExclude of "MQTTServer": .*
2020.04.03 12:17:55 5: End notify loop for MQTTServer
2020.04.03 12:17:55 4:   MQTTServer_192.168.178.72_57823 OMG_oben PUBLISH home/OMG_oben/BTtoMQTT/C47C8D625126/servicedata:71209800582651628d7cc40d0910022100
2020.04.03 12:17:55 5: MQTTServer: dispatch autocreate=no\000OMG_oben\000home/OMG_oben/BTtoMQTT/C47C8D625126/servicedata\00071209800582651628d7cc40d0910022100
2020.04.03 12:17:55 4: MQTT2_DEVICE_Parse: MQTT2_OMG_oben home/OMG_oben/BTtoMQTT/C47C8D625126/servicedata => servicedata
2020.04.03 12:17:55 5: MQTT_GENERIC_BRIDGE: [mqttbridge] Parse (MQTT2_SERVER : 'MQTTServer'): Msg: home/OMG_oben/BTtoMQTT/C47C8D625126/servicedata => 71209800582651628d7cc40d0910022100
2020.04.03 12:17:55 5: Starting notify loop for MQTT2_OMG_oben, 1 event(s), first is servicedata: 71209800582651628d7cc40d0910022100
2020.04.03 12:17:55 5: meinStromCalculator : ElectricityCalculator_Notify - Trigger Dev Name   : MQTT2_OMG_oben
2020.04.03 12:17:55 4: dewpoint_notify: cmd_type=dewpoint devname=MQTT2_OMG_oben dewname=taupunk_all, dev=MQTT2_OMG_oben, dev_regex=.* temp_name=temperature hum_name=humidity
2020.04.03 12:17:55 5: dewpoint_notify: s='servicedata: 71209800582651628d7cc40d0910022100'
2020.04.03 12:17:55 5: dewpoint_notify: evName='servicedata:' val=71209800582651628d7cc40d0910022100'
2020.04.03 12:17:55 5: dewpoint_notify: max_timediff=10
2020.04.03 12:17:55 5: batterieStatus: not on any display, ignoring notify
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> ###              start of new Logcycle                       ###
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> number of events received: 1 for device: MQTT2_OMG_oben
2020.04.03 12:17:55 4: DbLog logdb -> check Device: MQTT2_OMG_oben , Event: servicedata: 71209800582651628d7cc40d0910022100
2020.04.03 12:17:55 5: End notify loop for MQTT2_OMG_oben
2020.04.03 12:17:55 5: Starting notify loop for MQTTServer, 1 event(s), first is home/OMG_oben/BTtoMQTT/C47C8D625126/servicedata:71209800582651628d7cc40d0910022100
2020.04.03 12:17:55 5: meinStromCalculator : ElectricityCalculator_Notify - Trigger Dev Name   : MQTTServer
2020.04.03 12:17:55 4: dewpoint_notify: cmd_type=dewpoint devname=MQTTServer dewname=taupunk_all, dev=MQTTServer, dev_regex=.* temp_name=temperature hum_name=humidity
2020.04.03 12:17:55 5: dewpoint_notify: s='home/OMG_oben/BTtoMQTT/C47C8D625126/servicedata:71209800582651628d7cc40d0910022100'
2020.04.03 12:17:55 5: dewpoint_notify: max_timediff=10
2020.04.03 12:17:55 5: batterieStatus: not on any display, ignoring notify
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> ###              start of new Logcycle                       ###
2020.04.03 12:17:55 4: DbLog logdb -> ################################################################
2020.04.03 12:17:55 4: DbLog logdb -> number of events received: 1 for device: MQTTServer
2020.04.03 12:17:55 4: DbLog logdb -> check Device: MQTTServer , Event: home/OMG_oben/BTtoMQTT/C47C8D625126/servicedata:71209800582651628d7cc40d0910022100
2020.04.03 12:17:55 5: DbLog logdb -> parsed Event: MQTTServer , Event: home/OMG_oben/BTtoMQTT/C47C8D625126/servicedata:71209800582651628d7cc40d0910022100
2020.04.03 12:17:55 5: DbLog logdb -> DbLogExclude of "MQTTServer": .*
2020.04.03 12:17:55 5: End notify loop for MQTTServer

dewpoint ist übrigens im Einsatz

@Beta-User
Wie geht man da am besten methodisch vor um den schuldigen zu finden meine Installation ist ziemlich umfangreich hab bestimmt so an die hundert userreadings.
Was mir aufgefallen ist das mysql viel Cpu Leistung nimmt könnte das vielleicht entventuell an dblog liegen

An freezes ist mir dies erst mal das ins Auge gefallen was mehrmals auftaucht

Code Auswählen

2020.04.03 13:55:39 5: HMUARTLGW myHmUARTLGW checking credits (from timer)
2020.04.03 13:55:39 5: HMUARTLGW myHmUARTLGW send: 00 08
2020.04.03 13:55:39 5: HMUARTLGW myHmUARTLGW send: (8): fd0003005b084235
2020.04.03 13:55:39 5: SW: fd0003005b084235
2020.04.03 13:55:39 1: Perfmon: possible freeze starting at 13:55:38, delay is 1.627
2020.04.03 13:55:39 4: [amazonecho] [echodevice_LoginStart] Alter COOKIE=2156/6000

werde das weiter untersuchen
Andre

Beta-User · 03 April 2020, 14:25:18

Na ja, m.E. sieht man hier ja schon, wer sich alles in die loop reinhängt:

- dewpoint (was ne gut kalibrierte Glaskugel, oder...?)
- DBLog
- das batterieStatus-Ding
- MQTT_GENERIC_BRIDGE
- der Strom-Calculator...

Würde vorschlagen, das außerhalb dieses Threads zu diskutieren, kannst gerne hierher verlinken und auch ausnahmsweise (!) einen multi-topic-Thread aufmachen.

Vorab aber noch zwei Hinweise:
Bei dewpoint gab's die Diskussion schon länger nicht mehr, da wurde afaik was am Modul geändert und auch in der Doku, so dass sich das jetzt mit aktueller Konfiguration eigentlich nicht mehr so "reinzwängen" sollte.
Für DBLog gibt's ein gutes Analysetool, um das alles zu optimieren bzw. die Konfiguration auch auf der DB-Seite zu optimieren. Bitte den Namen des Teils in der Doku suchen und das mal laufen lassen. (Das darf dann auch ein gesondertes Thema sein, FALLS dazu noch Fragen sind.) Dazu evtl. noch "exclude"/"include" an diesem Device setzen?

rudolfkoenig · 03 April 2020, 14:35:53

Ich sehe in diesem Log aber immer noch nicht die besagten 19 Sekunden.
Apropos: mit "attr global mseclog" kann man die Millisekunden-Angabe im Log aktivieren.

andre07 · 03 April 2020, 18:38:14

@Beta-User
Was für ein Analysetool für DBlog meinst du Dbrep? Der Batteriestatus und Mqtt-Bridge ist erst mal raus
da ich diese sowieso nicht mehr benötige.In Dblog läuft einmal am Tag ein at mit reduceLogNbl um die Datenbank aufzuräumen. Außerdem habe ich ein notify das bei allen neuen Devices
erst mal ein DbLogExclude setzt.Es wird auch nicht alles geloggt

Code Auswählen

./db.conf .*:(temperature|pressure|humidity|place|energy|kWh|power|desired-temp|costs|energy_kwh|absent|present|home|watt|place).*

@rudolfkoenig
attr global mseclog habe ich aktiviert und lass den log noch mal mit verbose 5 laufen.

Habe das hier noch mal neu aufgemacht unter Sonstiges da es wohl nicht mehr hier reingehört
unter "EventMonitor Freezemon meldet ständig freezer"

Andre

Beta-User · 04 April 2020, 10:29:34

configCheck am LogDB-Gerät selbst war gemeint...

Kannst du bitte in dem anderen Thread (https://forum.fhem.de/index.php/topic,109826.0/topicseen.html) auch nach hierhin verlinken, damit den Leuten, die sich (neben Rudi) auch mit sowas auskennen, aber die Infos aus Freeezmon "aus dem effeff" deuten können nicht im Dunkeln tappen?

(Ist doch eigentlich klar, dass man wechselseitig verlinken sollte, oder?!? Grummel, immerhin war wenigstens der Threadtitel hier genannt, aber trotzdem unbefriedigend...)