on restart of the bundle:
2020-11-21 00:27:56.776 [TRACE] [control.internal.WebSocketConnection] - Scheduling pong timeout
2020-11-21 00:27:56.776 [DEBUG] [trol.internal.handler.AccountHandler] - refreshing data amazonechocontrol:account:XXXXXXXXXX
2020-11-21 00:27:56.777 [DEBUG] [mazonechocontrol.internal.Connection] - Make request to https://alexa.amazon.in/api/devices-v2/device?cached=false
2020-11-21 00:27:56.917 [DEBUG] [trol.internal.handler.AccountHandler] - updateSmartHomeState started with deviceFilerId=SKILL_XXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXX
2020-11-21 00:27:56.918 [DEBUG] [mazonechocontrol.internal.Connection] - Make request to https://alexa.amazon.in/api/phoenix/state
2020-11-21 00:27:56.918 [DEBUG] [mazonechocontrol.internal.Connection] - POST: {"stateRequests":[{"entityId":"SKILL_XXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXX","entityType":"APPLIANCE"}]}
2020-11-21 00:27:57.660 [DEBUG] [mazonechocontrol.internal.Connection] - Call to https://alexa.amazon.in/api/phoenix/state succeeded
2020-11-21 00:27:57.661 [DEBUG] [mazonechocontrol.internal.Connection] - Result of POST https://alexa.amazon.in/api/phoenix/state:{"deviceStates":[{"entity":{"entityId":"SKILL_XXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXX","entityType":"CLOUD_DISCOVERED_DEVICE"},"capabilityStates":["{\"namespace\":\"Alexa.PowerController\",\"name\":\"powerState\",\"value\":\"ON\",\"timeOfSample\":\"2020-11-20T18:57:57.474Z\",\"uncertaintyInMilliseconds\":500,\"deepQuery\":true,\"timeOfStateChange\":\"\"}","{\"namespace\":\"Alexa.EndpointHealth\",\"name\":\"connectivity\",\"value\":{\"value\":\"OK\"},\"timeOfSample\":\"2020-11-20T18:57:57.474Z\",\"uncertaintyInMilliseconds\":0,\"deepQuery\":true,\"timeOfStateChange\":\"\"}"],"error":null}],"errors":[]}
2020-11-21 00:27:57.662 [TRACE] [mazonechocontrol.internal.Connection] - Requested {"stateRequests":[{"entityId":"SKILL_XXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXX","entityType":"APPLIANCE"}]} and received {"deviceStates":[{"entity":{"entityId":"SKILL_XXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXX","entityType":"CLOUD_DISCOVERED_DEVICE"},"capabilityStates":["{\"namespace\":\"Alexa.PowerController\",\"name\":\"powerState\",\"value\":\"ON\",\"timeOfSample\":\"2020-11-20T18:57:57.474Z\",\"uncertaintyInMilliseconds\":500,\"deepQuery\":true,\"timeOfStateChange\":\"\"}","{\"namespace\":\"Alexa.EndpointHealth\",\"name\":\"connectivity\",\"value\":{\"value\":\"OK\"},\"timeOfSample\":\"2020-11-20T18:57:57.474Z\",\"uncertaintyInMilliseconds\":0,\"deepQuery\":true,\"timeOfStateChange\":\"\"}"],"error":null}],"errors":[]}
2020-11-21 00:27:57.663 [TRACE] [trol.internal.handler.AccountHandler] - Trying to distributes update {SKILL_XXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXX=["{\"namespace\":\"Alexa.PowerController\",\"name\":\"powerState\",\"value\":\"ON\",\"timeOfSample\":\"2020-11-20T18:57:57.474Z\",\"uncertaintyInMilliseconds\":500,\"deepQuery\":true,\"timeOfStateChange\":\"\"}","{\"namespace\":\"Alexa.EndpointHealth\",\"name\":\"connectivity\",\"value\":{\"value\":\"OK\"},\"timeOfSample\":\"2020-11-20T18:57:57.474Z\",\"uncertaintyInMilliseconds\":0,\"deepQuery\":true,\"timeOfStateChange\":\"\"}"]} to smarthome devices with deviceFilterId SKILL_XXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXX
2020-11-21 00:27:57.663 [DEBUG] [trol.internal.handler.AccountHandler] - Found id SKILL_XXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXX, updating channels
2020-11-21 00:27:57.664 [TRACE] [ernal.handler.SmartHomeDeviceHandler] - mapInterfaceToStates {Alexa.PowerController=[{"namespace":"Alexa.PowerController","name":"powerState","value":"ON","timeOfSample":"2020-11-20T18:57:57.474Z","uncertaintyInMilliseconds":500,"deepQuery":true,"timeOfStateChange":""}], Alexa.EndpointHealth=[{"namespace":"Alexa.EndpointHealth","name":"connectivity","value":{"value":"OK"},"timeOfSample":"2020-11-20T18:57:57.474Z","uncertaintyInMilliseconds":0,"deepQuery":true,"timeOfStateChange":""}]}
2020-11-21 00:27:57.664 [TRACE] [ernal.handler.SmartHomeDeviceHandler] - handlerbase = class org.openhab.binding.amazonechocontrol.internal.smarthome.HandlerPowerController, supportedInterfaces = [Alexa.PowerController]
2020-11-21 00:27:57.664 [TRACE] [nal.smarthome.HandlerPowerController] - SKILL_XXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXX received [{"namespace":"Alexa.PowerController","name":"powerState","value":"ON","timeOfSample":"2020-11-20T18:57:57.474Z","uncertaintyInMilliseconds":500,"deepQuery":true,"timeOfStateChange":""}]
2020-11-21 00:27:57.665 [TRACE] [nal.smarthome.HandlerPowerController] - SKILL_XXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXX final state true
2020-11-21 00:27:57.666 [DEBUG] [trol.internal.handler.AccountHandler] - updateSmartHomeState finished
==> /var/log/openhab/events.log <==
2020-11-21 00:27:57.668 [INFO ] [me.event.ThingStatusInfoChangedEvent] - Thing 'amazonechocontrol:smartHomeDevice:XXXXXXXXXX:YYYYYYYY-YYYY-YYYY-YYYY-YYYYYYYYYYYY' changed from UNKNOWN: Thing has changed. to ONLINE
2020-11-21 00:27:57.669 [INFO ] [marthome.event.ItemStateChangedEvent] - Item 'Plug_State' changed from OFF to ON
on continuos updates:
2020-11-21 00:32:14.744 [DEBUG] [trol.internal.handler.AccountHandler] - updateSmartHomeState started with deviceFilerId=null
2020-11-21 00:32:14.745 [DEBUG] [mazonechocontrol.internal.Connection] - Make request to https://alexa.amazon.in/api/phoenix/state
2020-11-21 00:32:14.746 [DEBUG] [mazonechocontrol.internal.Connection] - POST: {"stateRequests":[{"entityId":"SKILL_XXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXX","entityType":"APPLIANCE"}]}
2020-11-21 00:32:15.541 [DEBUG] [mazonechocontrol.internal.Connection] - Call to https://alexa.amazon.in/api/phoenix/state succeeded
2020-11-21 00:32:15.543 [DEBUG] [mazonechocontrol.internal.Connection] - Result of POST https://alexa.amazon.in/api/phoenix/state:{"deviceStates":[{"entity":{"entityId":"SKILL_XXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXX","entityType":"CLOUD_DISCOVERED_DEVICE"},"capabilityStates":["{\"namespace\":\"Alexa.PowerController\",\"name\":\"powerState\",\"value\":\"OFF\",\"timeOfSample\":\"2020-11-20T19:02:15.343Z\",\"uncertaintyInMilliseconds\":500,\"deepQuery\":true,\"timeOfStateChange\":\"\"}","{\"namespace\":\"Alexa.EndpointHealth\",\"name\":\"connectivity\",\"value\":{\"value\":\"OK\"},\"timeOfSample\":\"2020-11-20T19:02:15.343Z\",\"uncertaintyInMilliseconds\":0,\"deepQuery\":true,\"timeOfStateChange\":\"\"}"],"error":null}],"errors":[]}
2020-11-21 00:32:15.543 [TRACE] [mazonechocontrol.internal.Connection] - Requested {"stateRequests":[{"entityId":"SKILL_XXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXX","entityType":"APPLIANCE"}]} and received {"deviceStates":[{"entity":{"entityId":"SKILL_XXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXX","entityType":"CLOUD_DISCOVERED_DEVICE"},"capabilityStates":["{\"namespace\":\"Alexa.PowerController\",\"name\":\"powerState\",\"value\":\"OFF\",\"timeOfSample\":\"2020-11-20T19:02:15.343Z\",\"uncertaintyInMilliseconds\":500,\"deepQuery\":true,\"timeOfStateChange\":\"\"}","{\"namespace\":\"Alexa.EndpointHealth\",\"name\":\"connectivity\",\"value\":{\"value\":\"OK\"},\"timeOfSample\":\"2020-11-20T19:02:15.343Z\",\"uncertaintyInMilliseconds\":0,\"deepQuery\":true,\"timeOfStateChange\":\"\"}"],"error":null}],"errors":[]}
2020-11-21 00:32:15.544 [TRACE] [trol.internal.handler.AccountHandler] - Trying to distributes update {SKILL_XXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXX=["{\"namespace\":\"Alexa.PowerController\",\"name\":\"powerState\",\"value\":\"OFF\",\"timeOfSample\":\"2020-11-20T19:02:15.343Z\",\"uncertaintyInMilliseconds\":500,\"deepQuery\":true,\"timeOfStateChange\":\"\"}","{\"namespace\":\"Alexa.EndpointHealth\",\"name\":\"connectivity\",\"value\":{\"value\":\"OK\"},\"timeOfSample\":\"2020-11-20T19:02:15.343Z\",\"uncertaintyInMilliseconds\":0,\"deepQuery\":true,\"timeOfStateChange\":\"\"}"]} to smarthome devices with deviceFilterId null
2020-11-21 00:32:15.544 [TRACE] [trol.internal.handler.AccountHandler] - Id SKILL_XXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXXX not matching filter null
2020-11-21 00:32:15.545 [DEBUG] [trol.internal.handler.AccountHandler] - updateSmartHomeState finished
got to do something with the deviceFilterId
being null later on