Communication issue HG-HM-LC-Sw4-WM - No answer from device

Hi,

I am looking for hints on how I could fix the below described issue that I face with a Homematic HG-HM-LC-Sw4-WM that a lately installed. I have two other Homematic devices in my environment that work properly. The new device is not working properly and when I check the logs I see that there is some kind of communication issue (na answer from device). What I did so far:

Removed the thing and added the thing again.
update/upgrade openHAB
reinstalled homegear
updated homegear

Nothing helped. So I set the debug level for Homematic to DEBUG. As I am not able to interpret the log myself it would be great if someone could give me a hint.

My environment:
Openhab = openHAB 2.4.0-1 (Release Build)
Homegear = 0.7.39-2773
Release = Raspbian GNU/Linux 8 (jessie)
Kernel = Linux 4.9.35-v7+
Platform = Raspberry Pi 3 Model B Rev 1.2
Wireless Module for Homematic = HM-MOD-RPI-PCB

06:30:14.898 [INFO ] [smarthome.event.ItemStateChangedEvent] - Hm1Ch1_2_State changed from OFF to ON
06:30:14.897 [DEBUG] [mematic.handler.HomematicThingHandler] -     Received command 'ON' for channel 'homematic:HG-HM-LC-Sw4-WM:dcd1d685:PEQ1419156:2#STATE'
06:30:14.916 [DEBUG] [communicator.AbstractHomematicGateway] - Sending datapoint 'PEQ1419156:2#STATE' with value 'true' to gateway with id 'dcd1d685' using rxMode 'DEFAULT'
06:30:17.489 [DEBUG] [rnal.communicator.client.BinRpcClient] - BinRpcMessage socket failure, sending message again 1/1
06:30:20.072 [ERROR] [mematic.handler.HomematicThingHandler] - -100 No answer from device. (sending setValue()
PEQ1419156:2
STATE
true
)
java.io.IOException: -100 No answer from device. (sending setValue()
PEQ1419156:2
STATE
true
)
at org.eclipse.smarthome.binding.homematic.internal.communicator.parser.RpcResponseParser.parse(RpcResponseParser.java:51) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:82) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:94) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:70) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
at org.eclipse.smarthome.binding.homematic.internal.communicator.client.RpcClient.setDatapointValue(RpcClient.java:335) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway$1.execute(AbstractHomematicGateway.java:686) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
at org.eclipse.smarthome.binding.homematic.internal.misc.DelayedExecuter.start(DelayedExecuter.java:65) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway.sendDatapoint(AbstractHomematicGateway.java:665) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway.sendDatapoint(AbstractHomematicGateway.java:644) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
at org.eclipse.smarthome.binding.homematic.handler.HomematicThingHandler.sendDatapoint(HomematicThingHandler.java:307) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
at org.eclipse.smarthome.binding.homematic.handler.HomematicThingHandler.handleCommand(HomematicThingHandler.java:283) [198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
at sun.reflect.GeneratedMethodAccessor102.invoke(Unknown Source) ~[?:?]
at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) ~[?:?]
at java.lang.reflect.Method.invoke(Method.java:498) ~[?:?]
at org.eclipse.smarthome.core.internal.common.AbstractInvocationHandler.invokeDirect(AbstractInvocationHandler.java:153) [102:org.eclipse.smarthome.core:0.10.0.oh240]
at org.eclipse.smarthome.core.internal.common.InvocationHandlerSync.invoke(InvocationHandlerSync.java:59) [102:org.eclipse.smarthome.core:0.10.0.oh240]
at com.sun.proxy.$Proxy127.handleCommand(Unknown Source) [198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
at org.eclipse.smarthome.core.thing.internal.profiles.ProfileCallbackImpl.handleCommand(ProfileCallbackImpl.java:75) [109:org.eclipse.smarthome.core.thing:0.10.0.oh240]
at org.eclipse.smarthome.core.thing.internal.profiles.SystemDefaultProfile.onCommandFromItem(SystemDefaultProfile.java:49) [109:org.eclipse.smarthome.core.thing:0.10.0.oh240]
at sun.reflect.GeneratedMethodAccessor101.invoke(Unknown Source) ~[?:?]
at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) ~[?:?]
at java.lang.reflect.Method.invoke(Method.java:498) ~[?:?]
at org.eclipse.smarthome.core.internal.common.AbstractInvocationHandler.invokeDirect(AbstractInvocationHandler.java:153) [102:org.eclipse.smarthome.core:0.10.0.oh240]
at org.eclipse.smarthome.core.internal.common.Invocation.call(Invocation.java:53) [102:org.eclipse.smarthome.core:0.10.0.oh240]
at java.util.concurrent.FutureTask.run(FutureTask.java:266) [?:?]
at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1149) [?:?]
at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:624) [?:?]
at java.lang.Thread.run(Thread.java:748) [?:?]

Hey @bummzulu,

this is an openhab Log… could you check the homegear log while this happens?
The log is in /var/log/homegear.log. You can change the loglevel of homegear at runtime:

sudo homegear -r
dl 4

Debug Leve (dl) 3 is the default, 4 should be enough… if nothing is logged, check dl 5.

Hi @pmayer
thanks for the detailed instruction. Hope the log level was sufficient.

I increased the log level and replicated the issue at 08:03:59 according the openhab.log:

2019-07-13 08:03:53.968 [DEBUG] [ematic.handler.HomematicThingHandler] - Received command 'ON' for channel 'homematic:HG-HM-LC-Sw4-WM:dcd1d685:PEQ1419156:4#STATE'
2019-07-13 08:03:53.983 [DEBUG] [ommunicator.AbstractHomematicGateway] - Sending datapoint 'PEQ1419156:4#STATE' with value 'true' to gateway with id 'dcd1d685' using rxMode 'DEFAULT'
2019-07-13 08:03:56.550 [DEBUG] [nal.communicator.client.BinRpcClient] - BinRpcMessage socket failure, sending message again 1/1
2019-07-13 08:03:59.120 [ERROR] [ematic.handler.HomematicThingHandler] - -100 No answer from device. (sending setValue()
PEQ1419156:4
STATE
true
)
java.io.IOException: -100 No answer from device. (sending setValue()
PEQ1419156:4
STATE
true
)
	at org.eclipse.smarthome.binding.homematic.internal.communicator.parser.RpcResponseParser.parse(RpcResponseParser.java:51) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:82) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:94) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:70) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.RpcClient.setDatapointValue(RpcClient.java:335) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway$1.execute(AbstractHomematicGateway.java:686) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.misc.DelayedExecuter.start(DelayedExecuter.java:65) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway.sendDatapoint(AbstractHomematicGateway.java:665) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway.sendDatapoint(AbstractHomematicGateway.java:644) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.handler.HomematicThingHandler.sendDatapoint(HomematicThingHandler.java:307) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.handler.HomematicThingHandler.handleCommand(HomematicThingHandler.java:283) [198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at sun.reflect.GeneratedMethodAccessor102.invoke(Unknown Source) ~[?:?]
	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) ~[?:?]
	at java.lang.reflect.Method.invoke(Method.java:498) ~[?:?]
	at org.eclipse.smarthome.core.internal.common.AbstractInvocationHandler.invokeDirect(AbstractInvocationHandler.java:153) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at org.eclipse.smarthome.core.internal.common.InvocationHandlerSync.invoke(InvocationHandlerSync.java:59) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at com.sun.proxy.$Proxy127.handleCommand(Unknown Source) [198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.core.thing.internal.profiles.ProfileCallbackImpl.handleCommand(ProfileCallbackImpl.java:75) [109:org.eclipse.smarthome.core.thing:0.10.0.oh240]
	at org.eclipse.smarthome.core.thing.internal.profiles.SystemDefaultProfile.onCommandFromItem(SystemDefaultProfile.java:49) [109:org.eclipse.smarthome.core.thing:0.10.0.oh240]
	at sun.reflect.GeneratedMethodAccessor101.invoke(Unknown Source) ~[?:?]
	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) ~[?:?]
	at java.lang.reflect.Method.invoke(Method.java:498) ~[?:?]
	at org.eclipse.smarthome.core.internal.common.AbstractInvocationHandler.invokeDirect(AbstractInvocationHandler.java:153) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at org.eclipse.smarthome.core.internal.common.Invocation.call(Invocation.java:53) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at java.util.concurrent.FutureTask.run(FutureTask.java:266) [?:?]
	at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1149) [?:?]
	at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:624) [?:?]
	at java.lang.Thread.run(Thread.java:748) [?:?]
2019-07-13 08:04:00.244 [DEBUG] [ommunicator.AbstractHomematicGateway] - Received new (String) value 'dcd1d685' for 'CENTRAL:0#PONG' from gateway with id 'dcd1d685'
2019-07-13 08:04:04.105 [DEBUG] [ematic.handler.HomematicThingHandler] - Received command 'OFF' for channel 'homematic:HG-HM-LC-Sw4-WM:dcd1d685:PEQ1419156:4#STATE'
2019-07-13 08:04:04.115 [DEBUG] [ommunicator.AbstractHomematicGateway] - Sending datapoint 'PEQ1419156:4#STATE' with value 'false' to gateway with id 'dcd1d685' using rxMode 'DEFAULT'
2019-07-13 08:04:06.694 [DEBUG] [nal.communicator.client.BinRpcClient] - BinRpcMessage socket failure, sending message again 1/1
2019-07-13 08:04:09.267 [ERROR] [ematic.handler.HomematicThingHandler] - -100 No answer from device. (sending setValue()
PEQ1419156:4
STATE
false
)
java.io.IOException: -100 No answer from device. (sending setValue()
PEQ1419156:4
STATE
false
)
	at org.eclipse.smarthome.binding.homematic.internal.communicator.parser.RpcResponseParser.parse(RpcResponseParser.java:51) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:82) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:94) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:70) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.RpcClient.setDatapointValue(RpcClient.java:335) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway$1.execute(AbstractHomematicGateway.java:686) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.misc.DelayedExecuter.start(DelayedExecuter.java:65) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway.sendDatapoint(AbstractHomematicGateway.java:665) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway.sendDatapoint(AbstractHomematicGateway.java:644) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.handler.HomematicThingHandler.sendDatapoint(HomematicThingHandler.java:307) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.handler.HomematicThingHandler.handleCommand(HomematicThingHandler.java:283) [198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at sun.reflect.GeneratedMethodAccessor102.invoke(Unknown Source) ~[?:?]
	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) ~[?:?]
	at java.lang.reflect.Method.invoke(Method.java:498) ~[?:?]
	at org.eclipse.smarthome.core.internal.common.AbstractInvocationHandler.invokeDirect(AbstractInvocationHandler.java:153) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at org.eclipse.smarthome.core.internal.common.InvocationHandlerSync.invoke(InvocationHandlerSync.java:59) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at com.sun.proxy.$Proxy127.handleCommand(Unknown Source) [198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.core.thing.internal.profiles.ProfileCallbackImpl.handleCommand(ProfileCallbackImpl.java:75) [109:org.eclipse.smarthome.core.thing:0.10.0.oh240]
	at org.eclipse.smarthome.core.thing.internal.profiles.SystemDefaultProfile.onCommandFromItem(SystemDefaultProfile.java:49) [109:org.eclipse.smarthome.core.thing:0.10.0.oh240]
	at sun.reflect.GeneratedMethodAccessor101.invoke(Unknown Source) ~[?:?]
	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) ~[?:?]
	at java.lang.reflect.Method.invoke(Method.java:498) ~[?:?]
	at org.eclipse.smarthome.core.internal.common.AbstractInvocationHandler.invokeDirect(AbstractInvocationHandler.java:153) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at org.eclipse.smarthome.core.internal.common.Invocation.call(Invocation.java:53) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at java.util.concurrent.FutureTask.run(FutureTask.java:266) [?:?]
	at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1149) [?:?]
	at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:624) [?:?]
	at java.lang.Thread.run(Thread.java:748) [?:?]
2019-07-13 08:04:09.300 [DEBUG] [ematic.handler.HomematicThingHandler] - Received command 'ON' for channel 'homematic:HG-HM-LC-Sw4-WM:dcd1d685:PEQ1419156:3#STATE'
2019-07-13 08:04:09.307 [DEBUG] [ommunicator.AbstractHomematicGateway] - Sending datapoint 'PEQ1419156:3#STATE' with value 'true' to gateway with id 'dcd1d685' using rxMode 'DEFAULT'
2019-07-13 08:04:11.872 [DEBUG] [nal.communicator.client.BinRpcClient] - BinRpcMessage socket failure, sending message again 1/1
2019-07-13 08:04:14.443 [ERROR] [ematic.handler.HomematicThingHandler] - -100 No answer from device. (sending setValue()
PEQ1419156:3
STATE
true
)
java.io.IOException: -100 No answer from device. (sending setValue()
PEQ1419156:3
STATE
true
)
	at org.eclipse.smarthome.binding.homematic.internal.communicator.parser.RpcResponseParser.parse(RpcResponseParser.java:51) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:82) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:94) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:70) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.RpcClient.setDatapointValue(RpcClient.java:335) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway$1.execute(AbstractHomematicGateway.java:686) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.misc.DelayedExecuter.start(DelayedExecuter.java:65) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway.sendDatapoint(AbstractHomematicGateway.java:665) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway.sendDatapoint(AbstractHomematicGateway.java:644) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.handler.HomematicThingHandler.sendDatapoint(HomematicThingHandler.java:307) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.handler.HomematicThingHandler.handleCommand(HomematicThingHandler.java:283) [198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at sun.reflect.GeneratedMethodAccessor102.invoke(Unknown Source) ~[?:?]
	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) ~[?:?]
	at java.lang.reflect.Method.invoke(Method.java:498) ~[?:?]
	at org.eclipse.smarthome.core.internal.common.AbstractInvocationHandler.invokeDirect(AbstractInvocationHandler.java:153) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at org.eclipse.smarthome.core.internal.common.InvocationHandlerSync.invoke(InvocationHandlerSync.java:59) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at com.sun.proxy.$Proxy127.handleCommand(Unknown Source) [198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.core.thing.internal.profiles.ProfileCallbackImpl.handleCommand(ProfileCallbackImpl.java:75) [109:org.eclipse.smarthome.core.thing:0.10.0.oh240]
	at org.eclipse.smarthome.core.thing.internal.profiles.SystemDefaultProfile.onCommandFromItem(SystemDefaultProfile.java:49) [109:org.eclipse.smarthome.core.thing:0.10.0.oh240]
	at sun.reflect.GeneratedMethodAccessor101.invoke(Unknown Source) ~[?:?]
	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) ~[?:?]
	at java.lang.reflect.Method.invoke(Method.java:498) ~[?:?]
	at org.eclipse.smarthome.core.internal.common.AbstractInvocationHandler.invokeDirect(AbstractInvocationHandler.java:153) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at org.eclipse.smarthome.core.internal.common.Invocation.call(Invocation.java:53) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at java.util.concurrent.FutureTask.run(FutureTask.java:266) [?:?]
	at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1149) [?:?]
	at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:624) [?:?]
	at java.lang.Thread.run(Thread.java:748) [?:?]
2019-07-13 08:04:14.474 [DEBUG] [ematic.handler.HomematicThingHandler] - Received command 'OFF' for channel 'homematic:HG-HM-LC-Sw4-WM:dcd1d685:PEQ1419156:3#STATE'
2019-07-13 08:04:14.481 [DEBUG] [ommunicator.AbstractHomematicGateway] - Sending datapoint 'PEQ1419156:3#STATE' with value 'false' to gateway with id 'dcd1d685' using rxMode 'DEFAULT'
2019-07-13 08:04:17.045 [DEBUG] [nal.communicator.client.BinRpcClient] - BinRpcMessage socket failure, sending message again 1/1
2019-07-13 08:04:19.630 [DEBUG] [ommunicator.AbstractHomematicGateway] - Received new (String) value 'dcd1d685' for 'CENTRAL:0#PONG' from gateway with id 'dcd1d685'
2019-07-13 08:04:19.625 [ERROR] [ematic.handler.HomematicThingHandler] - -100 No answer from device. (sending setValue()
PEQ1419156:3
STATE
false
)
java.io.IOException: -100 No answer from device. (sending setValue()
PEQ1419156:3
STATE
false
)
	at org.eclipse.smarthome.binding.homematic.internal.communicator.parser.RpcResponseParser.parse(RpcResponseParser.java:51) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:82) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:94) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:70) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.RpcClient.setDatapointValue(RpcClient.java:335) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway$1.execute(AbstractHomematicGateway.java:686) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.misc.DelayedExecuter.start(DelayedExecuter.java:65) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway.sendDatapoint(AbstractHomematicGateway.java:665) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway.sendDatapoint(AbstractHomematicGateway.java:644) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.handler.HomematicThingHandler.sendDatapoint(HomematicThingHandler.java:307) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.handler.HomematicThingHandler.handleCommand(HomematicThingHandler.java:283) [198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at sun.reflect.GeneratedMethodAccessor102.invoke(Unknown Source) ~[?:?]
	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) ~[?:?]
	at java.lang.reflect.Method.invoke(Method.java:498) ~[?:?]
	at org.eclipse.smarthome.core.internal.common.AbstractInvocationHandler.invokeDirect(AbstractInvocationHandler.java:153) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at org.eclipse.smarthome.core.internal.common.InvocationHandlerSync.invoke(InvocationHandlerSync.java:59) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at com.sun.proxy.$Proxy127.handleCommand(Unknown Source) [198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.core.thing.internal.profiles.ProfileCallbackImpl.handleCommand(ProfileCallbackImpl.java:75) [109:org.eclipse.smarthome.core.thing:0.10.0.oh240]
	at org.eclipse.smarthome.core.thing.internal.profiles.SystemDefaultProfile.onCommandFromItem(SystemDefaultProfile.java:49) [109:org.eclipse.smarthome.core.thing:0.10.0.oh240]
	at sun.reflect.GeneratedMethodAccessor101.invoke(Unknown Source) ~[?:?]
	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) ~[?:?]
	at java.lang.reflect.Method.invoke(Method.java:498) ~[?:?]
	at org.eclipse.smarthome.core.internal.common.AbstractInvocationHandler.invokeDirect(AbstractInvocationHandler.java:153) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at org.eclipse.smarthome.core.internal.common.Invocation.call(Invocation.java:53) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at java.util.concurrent.FutureTask.run(FutureTask.java:266) [?:?]
	at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1149) [?:?]
	at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:624) [?:?]
	at java.lang.Thread.run(Thread.java:748) [?:?]
2019-07-13 08:04:23.253 [DEBUG] [ommunicator.AbstractHomematicGateway] - Received new (Boolean) value 'true' for 'PEQ1419156:0#UNREACH' from gateway with id 'dcd1d685'
2019-07-13 08:04:23.289 [DEBUG] [ommunicator.AbstractHomematicGateway] - Received new (Boolean) value 'true' for 'PEQ1419156:0#STICKY_UNREACH' from gateway with id 'dcd1d685'
2019-07-13 08:04:25.556 [DEBUG] [ommunicator.AbstractHomematicGateway] - Received new (Boolean) value 'false' for 'PEQ1419156:0#UNREACH' from gateway with id 'dcd1d685'
2019-07-13 08:04:34.641 [DEBUG] [ommunicator.AbstractHomematicGateway] - Received new (String) value 'dcd1d685' for 'CENTRAL:0#PONG' from gateway with id 'dcd1d685'
2019-07-13 08:04:38.258 [DEBUG] [ematic.handler.HomematicThingHandler] - Received command 'ON' for channel 'homematic:HG-HM-LC-Sw4-WM:dcd1d685:PEQ1419156:3#STATE'
2019-07-13 08:04:38.269 [DEBUG] [ommunicator.AbstractHomematicGateway] - Sending datapoint 'PEQ1419156:3#STATE' with value 'true' to gateway with id 'dcd1d685' using rxMode 'DEFAULT'
2019-07-13 08:04:38.388 [ERROR] [ersey.server.ServerRuntime$Responder] - An I/O error has occurred while writing a response message entity to the container output stream.
org.glassfish.jersey.server.internal.process.MappableException: org.eclipse.jetty.io.EofException
	at org.glassfish.jersey.server.internal.MappableExceptionWrapperInterceptor.aroundWriteTo(MappableExceptionWrapperInterceptor.java:92) ~[?:?]
	at org.glassfish.jersey.message.internal.WriterInterceptorExecutor.proceed(WriterInterceptorExecutor.java:162) ~[171:org.glassfish.jersey.core.jersey-common:2.22.2]
	at org.glassfish.jersey.message.internal.MessageBodyFactory.writeTo(MessageBodyFactory.java:1130) ~[171:org.glassfish.jersey.core.jersey-common:2.22.2]
	at org.glassfish.jersey.server.ServerRuntime$Responder.writeResponse(ServerRuntime.java:711) [172:org.glassfish.jersey.core.jersey-server:2.22.2]
	at org.glassfish.jersey.server.ServerRuntime$Responder.processResponse(ServerRuntime.java:444) [172:org.glassfish.jersey.core.jersey-server:2.22.2]
	at org.glassfish.jersey.server.ServerRuntime$Responder.process(ServerRuntime.java:434) [172:org.glassfish.jersey.core.jersey-server:2.22.2]
	at org.glassfish.jersey.server.ServerRuntime$2.run(ServerRuntime.java:329) [172:org.glassfish.jersey.core.jersey-server:2.22.2]
	at org.glassfish.jersey.internal.Errors$1.call(Errors.java:271) [171:org.glassfish.jersey.core.jersey-common:2.22.2]
	at org.glassfish.jersey.internal.Errors$1.call(Errors.java:267) [171:org.glassfish.jersey.core.jersey-common:2.22.2]
	at org.glassfish.jersey.internal.Errors.process(Errors.java:315) [171:org.glassfish.jersey.core.jersey-common:2.22.2]
	at org.glassfish.jersey.internal.Errors.process(Errors.java:297) [171:org.glassfish.jersey.core.jersey-common:2.22.2]
	at org.glassfish.jersey.internal.Errors.process(Errors.java:267) [171:org.glassfish.jersey.core.jersey-common:2.22.2]
	at org.glassfish.jersey.process.internal.RequestScope.runInScope(RequestScope.java:317) [171:org.glassfish.jersey.core.jersey-common:2.22.2]
	at org.glassfish.jersey.server.ServerRuntime.process(ServerRuntime.java:305) [172:org.glassfish.jersey.core.jersey-server:2.22.2]
	at org.glassfish.jersey.server.ApplicationHandler.handle(ApplicationHandler.java:1154) [172:org.glassfish.jersey.core.jersey-server:2.22.2]
	at org.glassfish.jersey.servlet.WebComponent.serviceImpl(WebComponent.java:473) [169:org.glassfish.jersey.containers.jersey-container-servlet-core:2.22.2]
	at org.glassfish.jersey.servlet.WebComponent.service(WebComponent.java:427) [169:org.glassfish.jersey.containers.jersey-container-servlet-core:2.22.2]
	at org.glassfish.jersey.servlet.ServletContainer.service(ServletContainer.java:388) [169:org.glassfish.jersey.containers.jersey-container-servlet-core:2.22.2]
	at org.glassfish.jersey.servlet.ServletContainer.service(ServletContainer.java:341) [169:org.glassfish.jersey.containers.jersey-container-servlet-core:2.22.2]
	at org.glassfish.jersey.servlet.ServletContainer.service(ServletContainer.java:228) [169:org.glassfish.jersey.containers.jersey-container-servlet-core:2.22.2]
	at com.eclipsesource.jaxrs.publisher.internal.ServletContainerBridge.service(ServletContainerBridge.java:76) [20:com.eclipsesource.jaxrs.publisher:5.3.1.201602281253]
	at org.eclipse.jetty.servlet.ServletHolder.handle(ServletHolder.java:865) [85:org.eclipse.jetty.servlet:9.4.11.v20180605]
	at org.eclipse.jetty.servlet.ServletHandler.doHandle(ServletHandler.java:535) [85:org.eclipse.jetty.servlet:9.4.11.v20180605]
	at org.ops4j.pax.web.service.jetty.internal.HttpServiceServletHandler.doHandle(HttpServiceServletHandler.java:71) [186:org.ops4j.pax.web.pax-web-jetty:7.2.3]
	at org.eclipse.jetty.server.handler.ScopedHandler.handle(ScopedHandler.java:146) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.security.SecurityHandler.handle(SecurityHandler.java:548) [82:org.eclipse.jetty.security:9.4.11.v20180605]
	at org.eclipse.jetty.server.handler.HandlerWrapper.handle(HandlerWrapper.java:132) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.handler.ScopedHandler.nextHandle(ScopedHandler.java:257) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.session.SessionHandler.doHandle(SessionHandler.java:1595) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.handler.ScopedHandler.nextHandle(ScopedHandler.java:255) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.handler.ContextHandler.doHandle(ContextHandler.java:1317) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.ops4j.pax.web.service.jetty.internal.HttpServiceContext.doHandle(HttpServiceContext.java:293) [186:org.ops4j.pax.web.pax-web-jetty:7.2.3]
	at org.eclipse.jetty.server.handler.ScopedHandler.nextScope(ScopedHandler.java:203) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.servlet.ServletHandler.doScope(ServletHandler.java:473) [85:org.eclipse.jetty.servlet:9.4.11.v20180605]
	at org.eclipse.jetty.server.session.SessionHandler.doScope(SessionHandler.java:1564) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.handler.ScopedHandler.nextScope(ScopedHandler.java:201) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.handler.ContextHandler.doScope(ContextHandler.java:1219) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.handler.ScopedHandler.handle(ScopedHandler.java:144) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.ops4j.pax.web.service.jetty.internal.JettyServerHandlerCollection.handle(JettyServerHandlerCollection.java:80) [186:org.ops4j.pax.web.pax-web-jetty:7.2.3]
	at org.eclipse.jetty.server.handler.HandlerWrapper.handle(HandlerWrapper.java:132) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.Server.handle(Server.java:531) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpChannel.handle(HttpChannel.java:352) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpConnection.onFillable(HttpConnection.java:260) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.io.AbstractConnection$ReadCallback.succeeded(AbstractConnection.java:281) [75:org.eclipse.jetty.io:9.4.11.v20180605]
	at org.eclipse.jetty.io.FillInterest.fillable(FillInterest.java:102) [75:org.eclipse.jetty.io:9.4.11.v20180605]
	at org.eclipse.jetty.io.ChannelEndPoint$2.run(ChannelEndPoint.java:118) [75:org.eclipse.jetty.io:9.4.11.v20180605]
	at org.eclipse.jetty.util.thread.strategy.EatWhatYouKill.runTask(EatWhatYouKill.java:333) [87:org.eclipse.jetty.util:9.4.11.v20180605]
	at org.eclipse.jetty.util.thread.strategy.EatWhatYouKill.doProduce(EatWhatYouKill.java:310) [87:org.eclipse.jetty.util:9.4.11.v20180605]
	at org.eclipse.jetty.util.thread.strategy.EatWhatYouKill.tryProduce(EatWhatYouKill.java:168) [87:org.eclipse.jetty.util:9.4.11.v20180605]
	at org.eclipse.jetty.util.thread.strategy.EatWhatYouKill.run(EatWhatYouKill.java:126) [87:org.eclipse.jetty.util:9.4.11.v20180605]
	at org.eclipse.jetty.util.thread.ReservedThreadExecutor$ReservedThread.run(ReservedThreadExecutor.java:366) [87:org.eclipse.jetty.util:9.4.11.v20180605]
	at org.eclipse.jetty.util.thread.QueuedThreadPool.runJob(QueuedThreadPool.java:762) [87:org.eclipse.jetty.util:9.4.11.v20180605]
	at org.eclipse.jetty.util.thread.QueuedThreadPool$2.run(QueuedThreadPool.java:680) [87:org.eclipse.jetty.util:9.4.11.v20180605]
	at java.lang.Thread.run(Thread.java:748) [?:?]
Caused by: org.eclipse.jetty.io.EofException
	at org.eclipse.jetty.io.ChannelEndPoint.flush(ChannelEndPoint.java:286) ~[75:org.eclipse.jetty.io:9.4.11.v20180605]
	at org.eclipse.jetty.io.WriteFlusher.flush(WriteFlusher.java:429) ~[75:org.eclipse.jetty.io:9.4.11.v20180605]
	at org.eclipse.jetty.io.WriteFlusher.write(WriteFlusher.java:323) ~[75:org.eclipse.jetty.io:9.4.11.v20180605]
	at org.eclipse.jetty.io.AbstractEndPoint.write(AbstractEndPoint.java:380) ~[75:org.eclipse.jetty.io:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpConnection$SendCallback.process(HttpConnection.java:798) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.util.IteratingCallback.processing(IteratingCallback.java:241) ~[87:org.eclipse.jetty.util:9.4.11.v20180605]
	at org.eclipse.jetty.util.IteratingCallback.iterate(IteratingCallback.java:224) ~[87:org.eclipse.jetty.util:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpConnection.send(HttpConnection.java:538) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpChannel.sendResponse(HttpChannel.java:790) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpChannel.write(HttpChannel.java:846) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpOutput.write(HttpOutput.java:240) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpOutput.write(HttpOutput.java:216) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpOutput.write(HttpOutput.java:541) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at java.io.OutputStream.write(OutputStream.java:75) ~[?:?]
	at org.glassfish.jersey.servlet.internal.ResponseWriter$NonCloseableOutputStreamWrapper.write(ResponseWriter.java:320) ~[?:?]
	at org.glassfish.jersey.message.internal.CommittingOutputStream.write(CommittingOutputStream.java:218) ~[?:?]
	at org.glassfish.jersey.message.internal.WriterInterceptorExecutor$UnCloseableOutputStream.write(WriterInterceptorExecutor.java:294) ~[?:?]
	at org.eclipse.smarthome.io.rest.core.internal.GsonProvider.writeTo(GsonProvider.java:71) ~[?:?]
	at org.glassfish.jersey.message.internal.WriterInterceptorExecutor$TerminalWriterInterceptor.invokeWriteTo(WriterInterceptorExecutor.java:265) ~[?:?]
	at org.glassfish.jersey.message.internal.WriterInterceptorExecutor$TerminalWriterInterceptor.aroundWriteTo(WriterInterceptorExecutor.java:250) ~[?:?]
	at org.glassfish.jersey.message.internal.WriterInterceptorExecutor.proceed(WriterInterceptorExecutor.java:162) ~[?:?]
	at org.glassfish.jersey.server.internal.JsonWithPaddingInterceptor.aroundWriteTo(JsonWithPaddingInterceptor.java:106) ~[?:?]
	at org.glassfish.jersey.message.internal.WriterInterceptorExecutor.proceed(WriterInterceptorExecutor.java:162) ~[?:?]
	at org.glassfish.jersey.server.internal.MappableExceptionWrapperInterceptor.aroundWriteTo(MappableExceptionWrapperInterceptor.java:86) ~[?:?]
	... 53 more
Caused by: java.io.IOException: Broken pipe
	at sun.nio.ch.FileDispatcherImpl.writev0(Native Method) ~[?:?]
	at sun.nio.ch.SocketDispatcher.writev(SocketDispatcher.java:51) ~[?:?]
	at sun.nio.ch.IOUtil.write(IOUtil.java:148) ~[?:?]
	at sun.nio.ch.SocketChannelImpl.write(SocketChannelImpl.java:504) ~[?:?]
	at org.eclipse.jetty.io.ChannelEndPoint.flush(ChannelEndPoint.java:266) ~[75:org.eclipse.jetty.io:9.4.11.v20180605]
	at org.eclipse.jetty.io.WriteFlusher.flush(WriteFlusher.java:429) ~[75:org.eclipse.jetty.io:9.4.11.v20180605]
	at org.eclipse.jetty.io.WriteFlusher.write(WriteFlusher.java:323) ~[75:org.eclipse.jetty.io:9.4.11.v20180605]
	at org.eclipse.jetty.io.AbstractEndPoint.write(AbstractEndPoint.java:380) ~[75:org.eclipse.jetty.io:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpConnection$SendCallback.process(HttpConnection.java:798) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.util.IteratingCallback.processing(IteratingCallback.java:241) ~[87:org.eclipse.jetty.util:9.4.11.v20180605]
	at org.eclipse.jetty.util.IteratingCallback.iterate(IteratingCallback.java:224) ~[87:org.eclipse.jetty.util:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpConnection.send(HttpConnection.java:538) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpChannel.sendResponse(HttpChannel.java:790) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpChannel.write(HttpChannel.java:846) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpOutput.write(HttpOutput.java:240) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpOutput.write(HttpOutput.java:216) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpOutput.write(HttpOutput.java:541) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at java.io.OutputStream.write(OutputStream.java:75) ~[?:?]
	at org.glassfish.jersey.servlet.internal.ResponseWriter$NonCloseableOutputStreamWrapper.write(ResponseWriter.java:320) ~[?:?]
	at org.glassfish.jersey.message.internal.CommittingOutputStream.write(CommittingOutputStream.java:218) ~[?:?]
	at org.glassfish.jersey.message.internal.WriterInterceptorExecutor$UnCloseableOutputStream.write(WriterInterceptorExecutor.java:294) ~[?:?]
	at org.eclipse.smarthome.io.rest.core.internal.GsonProvider.writeTo(GsonProvider.java:71) ~[?:?]
	at org.glassfish.jersey.message.internal.WriterInterceptorExecutor$TerminalWriterInterceptor.invokeWriteTo(WriterInterceptorExecutor.java:265) ~[?:?]
	at org.glassfish.jersey.message.internal.WriterInterceptorExecutor$TerminalWriterInterceptor.aroundWriteTo(WriterInterceptorExecutor.java:250) ~[?:?]
	at org.glassfish.jersey.message.internal.WriterInterceptorExecutor.proceed(WriterInterceptorExecutor.java:162) ~[?:?]
	at org.glassfish.jersey.server.internal.JsonWithPaddingInterceptor.aroundWriteTo(JsonWithPaddingInterceptor.java:106) ~[?:?]
	at org.glassfish.jersey.message.internal.WriterInterceptorExecutor.proceed(WriterInterceptorExecutor.java:162) ~[?:?]
	at org.glassfish.jersey.server.internal.MappableExceptionWrapperInterceptor.aroundWriteTo(MappableExceptionWrapperInterceptor.java:86) ~[?:?]
	... 53 more
2019-07-13 08:04:38.699 [DEBUG] [ommunicator.AbstractHomematicGateway] - Received new (Integer) value '-55' for 'PEQ1419156:0#RSSI_DEVICE' from gateway with id 'dcd1d685'
2019-07-13 08:04:40.841 [DEBUG] [nal.communicator.client.BinRpcClient] - BinRpcMessage socket failure, sending message again 1/1
2019-07-13 08:04:43.415 [ERROR] [ematic.handler.HomematicThingHandler] - -100 No answer from device. (sending setValue()
PEQ1419156:3
STATE
true
)
java.io.IOException: -100 No answer from device. (sending setValue()
PEQ1419156:3
STATE
true
)
	at org.eclipse.smarthome.binding.homematic.internal.communicator.parser.RpcResponseParser.parse(RpcResponseParser.java:51) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:82) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:94) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:70) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.RpcClient.setDatapointValue(RpcClient.java:335) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway$1.execute(AbstractHomematicGateway.java:686) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.misc.DelayedExecuter.start(DelayedExecuter.java:65) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway.sendDatapoint(AbstractHomematicGateway.java:665) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway.sendDatapoint(AbstractHomematicGateway.java:644) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.handler.HomematicThingHandler.sendDatapoint(HomematicThingHandler.java:307) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.handler.HomematicThingHandler.handleCommand(HomematicThingHandler.java:283) [198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at sun.reflect.GeneratedMethodAccessor102.invoke(Unknown Source) ~[?:?]
	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) ~[?:?]
	at java.lang.reflect.Method.invoke(Method.java:498) ~[?:?]
	at org.eclipse.smarthome.core.internal.common.AbstractInvocationHandler.invokeDirect(AbstractInvocationHandler.java:153) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at org.eclipse.smarthome.core.internal.common.InvocationHandlerSync.invoke(InvocationHandlerSync.java:59) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at com.sun.proxy.$Proxy127.handleCommand(Unknown Source) [198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.core.thing.internal.profiles.ProfileCallbackImpl.handleCommand(ProfileCallbackImpl.java:75) [109:org.eclipse.smarthome.core.thing:0.10.0.oh240]
	at org.eclipse.smarthome.core.thing.internal.profiles.SystemDefaultProfile.onCommandFromItem(SystemDefaultProfile.java:49) [109:org.eclipse.smarthome.core.thing:0.10.0.oh240]
	at sun.reflect.GeneratedMethodAccessor101.invoke(Unknown Source) ~[?:?]
	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) ~[?:?]
	at java.lang.reflect.Method.invoke(Method.java:498) ~[?:?]
	at org.eclipse.smarthome.core.internal.common.AbstractInvocationHandler.invokeDirect(AbstractInvocationHandler.java:153) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at org.eclipse.smarthome.core.internal.common.Invocation.call(Invocation.java:53) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at java.util.concurrent.FutureTask.run(FutureTask.java:266) [?:?]
	at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1149) [?:?]
	at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:624) [?:?]
	at java.lang.Thread.run(Thread.java:748) [?:?]
2019-07-13 08:04:44.613 [DEBUG] [ematic.handler.HomematicThingHandler] - Received command 'OFF' for channel 'homematic:HG-HM-LC-Sw4-WM:dcd1d685:PEQ1419156:3#STATE'
2019-07-13 08:04:44.679 [DEBUG] [ommunicator.AbstractHomematicGateway] - Sending datapoint 'PEQ1419156:3#STATE' with value 'false' to gateway with id 'dcd1d685' using rxMode 'DEFAULT'
2019-07-13 08:04:47.254 [DEBUG] [nal.communicator.client.BinRpcClient] - BinRpcMessage socket failure, sending message again 1/1
2019-07-13 08:04:49.829 [ERROR] [ematic.handler.HomematicThingHandler] - -100 No answer from device. (sending setValue()
PEQ1419156:3
STATE
false
)
java.io.IOException: -100 No answer from device. (sending setValue()
PEQ1419156:3
STATE
false
)
	at org.eclipse.smarthome.binding.homematic.internal.communicator.parser.RpcResponseParser.parse(RpcResponseParser.java:51) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:82) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:94) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:70) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.RpcClient.setDatapointValue(RpcClient.java:335) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway$1.execute(AbstractHomematicGateway.java:686) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.misc.DelayedExecuter.start(DelayedExecuter.java:65) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway.sendDatapoint(AbstractHomematicGateway.java:665) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway.sendDatapoint(AbstractHomematicGateway.java:644) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.handler.HomematicThingHandler.sendDatapoint(HomematicThingHandler.java:307) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.handler.HomematicThingHandler.handleCommand(HomematicThingHandler.java:283) [198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at sun.reflect.GeneratedMethodAccessor102.invoke(Unknown Source) ~[?:?]
	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) ~[?:?]
	at java.lang.reflect.Method.invoke(Method.java:498) ~[?:?]
	at org.eclipse.smarthome.core.internal.common.AbstractInvocationHandler.invokeDirect(AbstractInvocationHandler.java:153) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at org.eclipse.smarthome.core.internal.common.InvocationHandlerSync.invoke(InvocationHandlerSync.java:59) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at com.sun.proxy.$Proxy127.handleCommand(Unknown Source) [198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.core.thing.internal.profiles.ProfileCallbackImpl.handleCommand(ProfileCallbackImpl.java:75) [109:org.eclipse.smarthome.core.thing:0.10.0.oh240]
	at org.eclipse.smarthome.core.thing.internal.profiles.SystemDefaultProfile.onCommandFromItem(SystemDefaultProfile.java:49) [109:org.eclipse.smarthome.core.thing:0.10.0.oh240]
	at sun.reflect.GeneratedMethodAccessor101.invoke(Unknown Source) ~[?:?]
	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) ~[?:?]
	at java.lang.reflect.Method.invoke(Method.java:498) ~[?:?]
	at org.eclipse.smarthome.core.internal.common.AbstractInvocationHandler.invokeDirect(AbstractInvocationHandler.java:153) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at org.eclipse.smarthome.core.internal.common.Invocation.call(Invocation.java:53) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at java.util.concurrent.FutureTask.run(FutureTask.java:266) [?:?]
	at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1149) [?:?]
	at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:624) [?:?]
	at java.lang.Thread.run(Thread.java:748) [?:?]
2019-07-13 08:04:49.838 [DEBUG] [ommunicator.AbstractHomematicGateway] - Received new (String) value 'dcd1d685' for 'CENTRAL:0#PONG' from gateway with id 'dcd1d685'
2019-07-13 08:04:56.526 [DEBUG] [ommunicator.AbstractHomematicGateway] - Received new (Boolean) value 'true' for 'PEQ1419156:0#UNREACH' from gateway with id 'dcd1d685'
2019-07-13 08:04:56.539 [DEBUG] [ommunicator.AbstractHomematicGateway] - Received new (Boolean) value 'true' for 'PEQ1419156:0#STICKY_UNREACH' from gateway with id 'dcd1d685'
2019-07-13 08:04:58.495 [DEBUG] [ommunicator.AbstractHomematicGateway] - Received new (Boolean) value 'false' for 'PEQ1419156:0#UNREACH' from gateway with id 'dcd1d685'
2019-07-13 08:05:04.847 [DEBUG] [ommunicator.AbstractHomematicGateway] - Received new (String) value 'dcd1d685' for 'CENTRAL:0#PONG' from gateway with id 'dcd1d685'
2019-07-13 08:05:15.469 [ERROR] [ersey.server.ServerRuntime$Responder] - An I/O error has occurred while writing a response message entity to the container output stream.
org.glassfish.jersey.server.internal.process.MappableException: org.eclipse.jetty.io.EofException
	at org.glassfish.jersey.server.internal.MappableExceptionWrapperInterceptor.aroundWriteTo(MappableExceptionWrapperInterceptor.java:92) ~[?:?]
	at org.glassfish.jersey.message.internal.WriterInterceptorExecutor.proceed(WriterInterceptorExecutor.java:162) ~[171:org.glassfish.jersey.core.jersey-common:2.22.2]
	at org.glassfish.jersey.message.internal.MessageBodyFactory.writeTo(MessageBodyFactory.java:1130) ~[171:org.glassfish.jersey.core.jersey-common:2.22.2]
	at org.glassfish.jersey.server.ServerRuntime$Responder.writeResponse(ServerRuntime.java:711) [172:org.glassfish.jersey.core.jersey-server:2.22.2]
	at org.glassfish.jersey.server.ServerRuntime$Responder.processResponse(ServerRuntime.java:444) [172:org.glassfish.jersey.core.jersey-server:2.22.2]
	at org.glassfish.jersey.server.ServerRuntime$Responder.process(ServerRuntime.java:434) [172:org.glassfish.jersey.core.jersey-server:2.22.2]
	at org.glassfish.jersey.server.ServerRuntime$2.run(ServerRuntime.java:329) [172:org.glassfish.jersey.core.jersey-server:2.22.2]
	at org.glassfish.jersey.internal.Errors$1.call(Errors.java:271) [171:org.glassfish.jersey.core.jersey-common:2.22.2]
	at org.glassfish.jersey.internal.Errors$1.call(Errors.java:267) [171:org.glassfish.jersey.core.jersey-common:2.22.2]
	at org.glassfish.jersey.internal.Errors.process(Errors.java:315) [171:org.glassfish.jersey.core.jersey-common:2.22.2]
	at org.glassfish.jersey.internal.Errors.process(Errors.java:297) [171:org.glassfish.jersey.core.jersey-common:2.22.2]
	at org.glassfish.jersey.internal.Errors.process(Errors.java:267) [171:org.glassfish.jersey.core.jersey-common:2.22.2]
	at org.glassfish.jersey.process.internal.RequestScope.runInScope(RequestScope.java:317) [171:org.glassfish.jersey.core.jersey-common:2.22.2]
	at org.glassfish.jersey.server.ServerRuntime.process(ServerRuntime.java:305) [172:org.glassfish.jersey.core.jersey-server:2.22.2]
	at org.glassfish.jersey.server.ApplicationHandler.handle(ApplicationHandler.java:1154) [172:org.glassfish.jersey.core.jersey-server:2.22.2]
	at org.glassfish.jersey.servlet.WebComponent.serviceImpl(WebComponent.java:473) [169:org.glassfish.jersey.containers.jersey-container-servlet-core:2.22.2]
	at org.glassfish.jersey.servlet.WebComponent.service(WebComponent.java:427) [169:org.glassfish.jersey.containers.jersey-container-servlet-core:2.22.2]
	at org.glassfish.jersey.servlet.ServletContainer.service(ServletContainer.java:388) [169:org.glassfish.jersey.containers.jersey-container-servlet-core:2.22.2]
	at org.glassfish.jersey.servlet.ServletContainer.service(ServletContainer.java:341) [169:org.glassfish.jersey.containers.jersey-container-servlet-core:2.22.2]
	at org.glassfish.jersey.servlet.ServletContainer.service(ServletContainer.java:228) [169:org.glassfish.jersey.containers.jersey-container-servlet-core:2.22.2]
	at com.eclipsesource.jaxrs.publisher.internal.ServletContainerBridge.service(ServletContainerBridge.java:76) [20:com.eclipsesource.jaxrs.publisher:5.3.1.201602281253]
	at org.eclipse.jetty.servlet.ServletHolder.handle(ServletHolder.java:865) [85:org.eclipse.jetty.servlet:9.4.11.v20180605]
	at org.eclipse.jetty.servlet.ServletHandler.doHandle(ServletHandler.java:535) [85:org.eclipse.jetty.servlet:9.4.11.v20180605]
	at org.ops4j.pax.web.service.jetty.internal.HttpServiceServletHandler.doHandle(HttpServiceServletHandler.java:71) [186:org.ops4j.pax.web.pax-web-jetty:7.2.3]
	at org.eclipse.jetty.server.handler.ScopedHandler.handle(ScopedHandler.java:146) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.security.SecurityHandler.handle(SecurityHandler.java:548) [82:org.eclipse.jetty.security:9.4.11.v20180605]
	at org.eclipse.jetty.server.handler.HandlerWrapper.handle(HandlerWrapper.java:132) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.handler.ScopedHandler.nextHandle(ScopedHandler.java:257) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.session.SessionHandler.doHandle(SessionHandler.java:1595) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.handler.ScopedHandler.nextHandle(ScopedHandler.java:255) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.handler.ContextHandler.doHandle(ContextHandler.java:1317) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.ops4j.pax.web.service.jetty.internal.HttpServiceContext.doHandle(HttpServiceContext.java:293) [186:org.ops4j.pax.web.pax-web-jetty:7.2.3]
	at org.eclipse.jetty.server.handler.ScopedHandler.nextScope(ScopedHandler.java:203) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.servlet.ServletHandler.doScope(ServletHandler.java:473) [85:org.eclipse.jetty.servlet:9.4.11.v20180605]
	at org.eclipse.jetty.server.session.SessionHandler.doScope(SessionHandler.java:1564) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.handler.ScopedHandler.nextScope(ScopedHandler.java:201) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.handler.ContextHandler.doScope(ContextHandler.java:1219) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.handler.ScopedHandler.handle(ScopedHandler.java:144) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.ops4j.pax.web.service.jetty.internal.JettyServerHandlerCollection.handle(JettyServerHandlerCollection.java:80) [186:org.ops4j.pax.web.pax-web-jetty:7.2.3]
	at org.eclipse.jetty.server.handler.HandlerWrapper.handle(HandlerWrapper.java:132) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.Server.handle(Server.java:531) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpChannel.handle(HttpChannel.java:352) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpConnection.onFillable(HttpConnection.java:260) [84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.io.AbstractConnection$ReadCallback.succeeded(AbstractConnection.java:281) [75:org.eclipse.jetty.io:9.4.11.v20180605]
	at org.eclipse.jetty.io.FillInterest.fillable(FillInterest.java:102) [75:org.eclipse.jetty.io:9.4.11.v20180605]
	at org.eclipse.jetty.io.ChannelEndPoint$2.run(ChannelEndPoint.java:118) [75:org.eclipse.jetty.io:9.4.11.v20180605]
	at org.eclipse.jetty.util.thread.strategy.EatWhatYouKill.runTask(EatWhatYouKill.java:333) [87:org.eclipse.jetty.util:9.4.11.v20180605]
	at org.eclipse.jetty.util.thread.strategy.EatWhatYouKill.doProduce(EatWhatYouKill.java:310) [87:org.eclipse.jetty.util:9.4.11.v20180605]
	at org.eclipse.jetty.util.thread.strategy.EatWhatYouKill.tryProduce(EatWhatYouKill.java:168) [87:org.eclipse.jetty.util:9.4.11.v20180605]
	at org.eclipse.jetty.util.thread.strategy.EatWhatYouKill.run(EatWhatYouKill.java:126) [87:org.eclipse.jetty.util:9.4.11.v20180605]
	at org.eclipse.jetty.util.thread.ReservedThreadExecutor$ReservedThread.run(ReservedThreadExecutor.java:366) [87:org.eclipse.jetty.util:9.4.11.v20180605]
	at org.eclipse.jetty.util.thread.QueuedThreadPool.runJob(QueuedThreadPool.java:762) [87:org.eclipse.jetty.util:9.4.11.v20180605]
	at org.eclipse.jetty.util.thread.QueuedThreadPool$2.run(QueuedThreadPool.java:680) [87:org.eclipse.jetty.util:9.4.11.v20180605]
	at java.lang.Thread.run(Thread.java:748) [?:?]
Caused by: org.eclipse.jetty.io.EofException
	at org.eclipse.jetty.io.ChannelEndPoint.flush(ChannelEndPoint.java:286) ~[75:org.eclipse.jetty.io:9.4.11.v20180605]
	at org.eclipse.jetty.io.WriteFlusher.flush(WriteFlusher.java:429) ~[75:org.eclipse.jetty.io:9.4.11.v20180605]
	at org.eclipse.jetty.io.WriteFlusher.write(WriteFlusher.java:323) ~[75:org.eclipse.jetty.io:9.4.11.v20180605]
	at org.eclipse.jetty.io.AbstractEndPoint.write(AbstractEndPoint.java:380) ~[75:org.eclipse.jetty.io:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpConnection$SendCallback.process(HttpConnection.java:798) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.util.IteratingCallback.processing(IteratingCallback.java:241) ~[87:org.eclipse.jetty.util:9.4.11.v20180605]
	at org.eclipse.jetty.util.IteratingCallback.iterate(IteratingCallback.java:224) ~[87:org.eclipse.jetty.util:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpConnection.send(HttpConnection.java:538) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpChannel.sendResponse(HttpChannel.java:790) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpChannel.write(HttpChannel.java:846) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpOutput.write(HttpOutput.java:240) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpOutput.write(HttpOutput.java:216) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpOutput.write(HttpOutput.java:541) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at java.io.OutputStream.write(OutputStream.java:75) ~[?:?]
	at org.glassfish.jersey.servlet.internal.ResponseWriter$NonCloseableOutputStreamWrapper.write(ResponseWriter.java:320) ~[?:?]
	at org.glassfish.jersey.message.internal.CommittingOutputStream.write(CommittingOutputStream.java:218) ~[?:?]
	at org.glassfish.jersey.message.internal.WriterInterceptorExecutor$UnCloseableOutputStream.write(WriterInterceptorExecutor.java:294) ~[?:?]
	at org.eclipse.smarthome.io.rest.core.internal.GsonProvider.writeTo(GsonProvider.java:71) ~[?:?]
	at org.glassfish.jersey.message.internal.WriterInterceptorExecutor$TerminalWriterInterceptor.invokeWriteTo(WriterInterceptorExecutor.java:265) ~[?:?]
	at org.glassfish.jersey.message.internal.WriterInterceptorExecutor$TerminalWriterInterceptor.aroundWriteTo(WriterInterceptorExecutor.java:250) ~[?:?]
	at org.glassfish.jersey.message.internal.WriterInterceptorExecutor.proceed(WriterInterceptorExecutor.java:162) ~[?:?]
	at org.glassfish.jersey.server.internal.JsonWithPaddingInterceptor.aroundWriteTo(JsonWithPaddingInterceptor.java:106) ~[?:?]
	at org.glassfish.jersey.message.internal.WriterInterceptorExecutor.proceed(WriterInterceptorExecutor.java:162) ~[?:?]
	at org.glassfish.jersey.server.internal.MappableExceptionWrapperInterceptor.aroundWriteTo(MappableExceptionWrapperInterceptor.java:86) ~[?:?]
	... 53 more
Caused by: java.io.IOException: Broken pipe
	at sun.nio.ch.FileDispatcherImpl.writev0(Native Method) ~[?:?]
	at sun.nio.ch.SocketDispatcher.writev(SocketDispatcher.java:51) ~[?:?]
	at sun.nio.ch.IOUtil.write(IOUtil.java:148) ~[?:?]
	at sun.nio.ch.SocketChannelImpl.write(SocketChannelImpl.java:504) ~[?:?]
	at org.eclipse.jetty.io.ChannelEndPoint.flush(ChannelEndPoint.java:266) ~[75:org.eclipse.jetty.io:9.4.11.v20180605]
	at org.eclipse.jetty.io.WriteFlusher.flush(WriteFlusher.java:429) ~[75:org.eclipse.jetty.io:9.4.11.v20180605]
	at org.eclipse.jetty.io.WriteFlusher.write(WriteFlusher.java:323) ~[75:org.eclipse.jetty.io:9.4.11.v20180605]
	at org.eclipse.jetty.io.AbstractEndPoint.write(AbstractEndPoint.java:380) ~[75:org.eclipse.jetty.io:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpConnection$SendCallback.process(HttpConnection.java:798) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.util.IteratingCallback.processing(IteratingCallback.java:241) ~[87:org.eclipse.jetty.util:9.4.11.v20180605]
	at org.eclipse.jetty.util.IteratingCallback.iterate(IteratingCallback.java:224) ~[87:org.eclipse.jetty.util:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpConnection.send(HttpConnection.java:538) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpChannel.sendResponse(HttpChannel.java:790) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpChannel.write(HttpChannel.java:846) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpOutput.write(HttpOutput.java:240) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpOutput.write(HttpOutput.java:216) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at org.eclipse.jetty.server.HttpOutput.write(HttpOutput.java:541) ~[84:org.eclipse.jetty.server:9.4.11.v20180605]
	at java.io.OutputStream.write(OutputStream.java:75) ~[?:?]
	at org.glassfish.jersey.servlet.internal.ResponseWriter$NonCloseableOutputStreamWrapper.write(ResponseWriter.java:320) ~[?:?]
	at org.glassfish.jersey.message.internal.CommittingOutputStream.write(CommittingOutputStream.java:218) ~[?:?]
	at org.glassfish.jersey.message.internal.WriterInterceptorExecutor$UnCloseableOutputStream.write(WriterInterceptorExecutor.java:294) ~[?:?]
	at org.eclipse.smarthome.io.rest.core.internal.GsonProvider.writeTo(GsonProvider.java:71) ~[?:?]
	at org.glassfish.jersey.message.internal.WriterInterceptorExecutor$TerminalWriterInterceptor.invokeWriteTo(WriterInterceptorExecutor.java:265) ~[?:?]
	at org.glassfish.jersey.message.internal.WriterInterceptorExecutor$TerminalWriterInterceptor.aroundWriteTo(WriterInterceptorExecutor.java:250) ~[?:?]
	at org.glassfish.jersey.message.internal.WriterInterceptorExecutor.proceed(WriterInterceptorExecutor.java:162) ~[?:?]
	at org.glassfish.jersey.server.internal.JsonWithPaddingInterceptor.aroundWriteTo(JsonWithPaddingInterceptor.java:106) ~[?:?]
	at org.glassfish.jersey.message.internal.WriterInterceptorExecutor.proceed(WriterInterceptorExecutor.java:162) ~[?:?]
	at org.glassfish.jersey.server.internal.MappableExceptionWrapperInterceptor.aroundWriteTo(MappableExceptionWrapperInterceptor.java:86) ~[?:?]
	... 53 more 

Here is the corresponding homegear.log:

07/13/19 08:03:00.195 RPC Server (Port 2001): Info: Client number 10495 is calling RPC method: ping (2) Parameters:
(String) dcd1d685
07/13/19 08:03:00.195 RPC Server (Port 2001): Info: Client number 10495 is calling RPC method: ping (2) Parameters:
(String) dcd1d685
07/13/19 08:03:00.199 RPC Server (Port 2001): Info: Client number 10495 is calling RPC method: listBidcosInterfaces (2) Parameters:
07/13/19 08:03:15.204 RPC Server (Port 2001): Info: Client number 10495 is calling RPC method: ping (2) Parameters:
(String) dcd1d685
07/13/19 08:03:15.210 RPC Server (Port 2001): Info: Client number 10495 is calling RPC method: listBidcosInterfaces (2) Parameters:
07/13/19 08:03:22.644 HomeMatic BidCoS packet received (My-HM-MOD-RPI-PCB, RSSI: -58 dBm): 1496845E55405000000093ACAC0000040000090FFF
07/13/19 08:03:22.645 Module HomeMatic BidCoS: Info: CURRENT on channel 2 of HomeMatic BidCoS peer 2 with serial number OEQ0022366 was set to 0x0000.
07/13/19 08:03:22.645 Module HomeMatic BidCoS: Info: ENERGY_COUNTER on channel 2 of HomeMatic BidCoS peer 2 with serial number OEQ0022366 was set to 0x13ACAC.
07/13/19 08:03:22.645 Module HomeMatic BidCoS: Info: FREQUENCY on channel 2 of HomeMatic BidCoS peer 2 with serial number OEQ0022366 was set to 0xFF.
07/13/19 08:03:22.645 Module HomeMatic BidCoS: Info: POWER on channel 2 of HomeMatic BidCoS peer 2 with serial number OEQ0022366 was set to 0x000004.
07/13/19 08:03:22.645 Module HomeMatic BidCoS: Info: VOLTAGE on channel 2 of HomeMatic BidCoS peer 2 with serial number OEQ0022366 was set to 0x090F.
07/13/19 08:03:30.215 RPC Server (Port 2001): Info: Client number 10495 is calling RPC method: ping (2) Parameters:
(String) dcd1d685
07/13/19 08:03:30.220 RPC Server (Port 2001): Info: Client number 10495 is calling RPC method: listBidcosInterfaces (2) Parameters:
07/13/19 08:03:45.225 RPC Server (Port 2001): Info: Client number 10495 is calling RPC method: ping (2) Parameters:
(String) dcd1d685
07/13/19 08:03:45.233 RPC Server (Port 2001): Info: Client number 10495 is calling RPC method: listBidcosInterfaces (2) Parameters:
07/13/19 08:03:53.991 RPC Server (Port 2001): Info: Client number 10495 is calling RPC method: setValue (2) Parameters:
(String) PEQ1419156:4
(String) STATE
(Boolean) 1
07/13/19 08:03:53.992 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: Sending (My-HM-MOD-RPI-PCB): 0E82A011FD491F6863CD0204C80000
07/13/19 08:03:55.180 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: No answer to packet 0E82A011FD491F6863CD0204C80000
07/13/19 08:03:56.556 RPC Server (Port 2001): Info: Connection from ::ffff:10.0.0.45:35052 accepted. Client number: 10512
07/13/19 08:03:56.557 RPC Server (Port 2001): Info: RPC server client id for client number 10512 is: 248
07/13/19 08:03:56.558 RPC Server (Port 2001): Info: Client number 10512 is calling RPC method: setValue (2) Parameters:
(String) PEQ1419156:4
(String) STATE
(Boolean) 1
07/13/19 08:03:59.602 Module HomeMatic BidCoS: Info: Setting peer to unreachable, because the queue processing was interrupted.
07/13/19 08:03:59.602 Module HomeMatic BidCoS: Info: Queue is not finished (peer: 3). Retrying...
07/13/19 08:03:59.702 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: Sending (My-HM-MOD-RPI-PCB): 0E83A011FD491F6863CD0204C80000
07/13/19 08:04:00.241 RPC Server (Port 2001): Info: Client number 10512 is calling RPC method: ping (2) Parameters:
(String) dcd1d685
07/13/19 08:04:00.244 RPC Server (Port 2001): Info: Client number 10512 is calling RPC method: listBidcosInterfaces (2) Parameters:
07/13/19 08:04:00.574 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: No answer to packet 0E83A011FD491F6863CD0204C80000
07/13/19 08:04:02.708 Module HomeMatic BidCoS: Info: Setting peer to unreachable, because the queue processing was interrupted.
07/13/19 08:04:02.708 Module HomeMatic BidCoS: Info: Queue is not finished (peer: 3). Retrying...
07/13/19 08:04:02.808 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: Sending (My-HM-MOD-RPI-PCB): 0E83A011FD491F6863CD0204C80000
07/13/19 08:04:03.724 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: No answer to packet 0E83A011FD491F6863CD0204C80000
07/13/19 08:04:04.135 RPC Server (Port 2001): Info: Client number 10512 is calling RPC method: setValue (2) Parameters:
(String) PEQ1419156:4
(String) STATE
(Boolean) 0
07/13/19 08:04:06.705 RPC Server (Port 2001): Info: Connection from ::ffff:10.0.0.45:35066 accepted. Client number: 10514
07/13/19 08:04:06.706 RPC Server (Port 2001): Info: RPC server client id for client number 10514 is: 249
07/13/19 08:04:06.708 RPC Server (Port 2001): Info: Client number 10514 is calling RPC method: setValue (2) Parameters:
(String) PEQ1419156:4
(String) STATE
(Boolean) 0

07/13/19 08:04:09.313 RPC Server (Port 2001): Info: Client number 10514 is calling RPC method: setValue (2) Parameters:
(String) PEQ1419156:3
(String) STATE
(Boolean) 1

07/13/19 08:04:11.880 RPC Server (Port 2001): Info: Connection from ::ffff:10.0.0.45:35068 accepted. Client number: 10515
(Boolean) 1

07/13/19 08:04:11.880 RPC Server (Port 2001): Info: Connection from ::ffff:10.0.0.45:35068 accepted. Client number: 10515
07/13/19 08:04:11.881 RPC Server (Port 2001): Info: RPC server client id for client number 10515 is: 250
07/13/19 08:04:11.883 RPC Server (Port 2001): Info: Client number 10515 is calling RPC method: setValue (2) Parameters:
(String) PEQ1419156:3
(String) STATE
(Boolean) 1
07/13/19 08:04:14.487 RPC Server (Port 2001): Info: Client number 10515 is calling RPC method: setValue (2) Parameters:
(String) PEQ1419156:3
(String) STATE
(Boolean) 0
07/13/19 08:04:17.051 RPC Server (Port 2001): Info: Connection from ::ffff:10.0.0.45:35106 accepted. Client number: 10516
07/13/19 08:04:17.051 RPC Server (Port 2001): Info: RPC server client id for client number 10516 is: 251
07/13/19 08:04:17.053 RPC Server (Port 2001): Info: Client number 10516 is calling RPC method: setValue (2) Parameters:
(String) PEQ1419156:3
(String) STATE
(Boolean) 0
07/13/19 08:04:19.625 RPC Server (Port 2001): Info: Client number 10516 is calling RPC method: ping (2) Parameters:
(String) dcd1d685
07/13/19 08:04:19.629 RPC Server (Port 2001): Info: Client number 10516 is calling RPC method: listBidcosInterfaces (2) Parameters:
07/13/19 08:04:20.140 Module HomeMatic BidCoS: Info: Setting peer to unreachable, because the queue processing was interrupted.
07/13/19 08:04:20.140 Module HomeMatic BidCoS: Info: Queue is not finished (peer: 3). Retrying...
07/13/19 08:04:20.240 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: Sending (My-HM-MOD-RPI-PCB): 0E85A011FD491F6863CD0204000000
07/13/19 08:04:21.077 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: No answer to packet 0E85A011FD491F6863CD0204000000
07/13/19 08:04:23.245 Module HomeMatic BidCoS: Info: Setting peer to unreachable, because the queue processing was interrupted.
07/13/19 08:04:23.247 Info: Peer 3 is unreachable.
07/13/19 08:04:25.552 Info: Peer 3 is reachable again.
07/13/19 08:04:34.635 RPC Server (Port 2001): Info: Client number 10516 is calling RPC method: ping (2) Parameters:
(String) dcd1d685
07/13/19 08:04:34.640 RPC Server (Port 2001): Info: Client number 10516 is calling RPC method: listBidcosInterfaces (2) Parameters:
07/13/19 08:04:38.282 RPC Server (Port 2001): Info: Client number 10516 is calling RPC method: setValue (2) Parameters:
(String) PEQ1419156:3
(String) STATE
(Boolean) 1
07/13/19 08:04:38.284 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: Sending (My-HM-MOD-RPI-PCB): 0E85A011FD491F6863CD0204000000
07/13/19 08:04:38.696 HomeMatic BidCoS packet received (My-HM-MOD-RPI-PCB, RSSI: -55 dBm): 128580026863CDFD491F0104000040559BDF22
07/13/19 08:04:38.790 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: Sending (My-HM-MOD-RPI-PCB): 0E8AA011FD491F6863CD0203C80000
07/13/19 08:04:39.977 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: No answer to packet 0E8AA011FD491F6863CD0203C80000
07/13/19 08:04:40.850 RPC Server (Port 2001): Info: Connection from ::ffff:10.0.0.45:35154 accepted. Client number: 10522
07/13/19 08:04:40.851 RPC Server (Port 2001): Info: RPC server client id for client number 10522 is: 252
07/13/19 08:04:40.852 RPC Server (Port 2001): Info: Client number 10522 is calling RPC method: setValue (2) Parameters:
(String) PEQ1419156:3
(String) STATE
(Boolean) 1
07/13/19 08:04:43.893 Module HomeMatic BidCoS: Info: Setting peer to unreachable, because the queue processing was interrupted.
07/13/19 08:04:43.893 Module HomeMatic BidCoS: Info: Queue is not finished (peer: 3). Retrying...
07/13/19 08:04:43.993 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: Sending (My-HM-MOD-RPI-PCB): 0E8BA011FD491F6863CD0203C80000
07/13/19 08:04:44.696 RPC Server (Port 2001): Info: Client number 10522 is calling RPC method: setValue (2) Parameters:
(String) PEQ1419156:3
(String) STATE
(Boolean) 0
07/13/19 08:04:44.959 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: No answer to packet 0E8BA011FD491F6863CD0203C80000
07/13/19 08:04:47.262 RPC Server (Port 2001): Info: Connection from ::ffff:10.0.0.45:35166 accepted. Client number: 10523
07/13/19 08:04:47.262 RPC Server (Port 2001): Info: RPC server client id for client number 10523 is: 253
07/13/19 08:04:47.263 RPC Server (Port 2001): Info: Client number 10523 is calling RPC method: setValue (2) Parameters:
(String) PEQ1419156:3
(String) STATE
07/13/19 08:04:47.263 RPC Server (Port 2001): Info: Client number 10523 is calling RPC method: setValue (2) Parameters:
(String) PEQ1419156:3
(String) STATE
(Boolean) 0
07/13/19 08:04:49.829 RPC Server (Port 2001): Info: Client number 10523 is calling RPC method: ping (2) Parameters:
(String) dcd1d685
07/13/19 08:04:49.836 RPC Server (Port 2001): Info: Client number 10523 is calling RPC method: listBidcosInterfaces (2) Parameters:
07/13/19 08:04:50.307 Module HomeMatic BidCoS: Info: Setting peer to unreachable, because the queue processing was interrupted.
07/13/19 08:04:50.307 Module HomeMatic BidCoS: Info: Queue is not finished (peer: 3). Retrying...
07/13/19 08:04:50.407 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: Sending (My-HM-MOD-RPI-PCB): 0E8DA011FD491F6863CD0203000000
07/13/19 08:04:51.310 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: No answer to packet 0E8DA011FD491F6863CD0203000000
07/13/19 08:04:53.412 Module HomeMatic BidCoS: Info: Setting peer to unreachable, because the queue processing was interrupted.
07/13/19 08:04:53.412 Module HomeMatic BidCoS: Info: Queue is not finished (peer: 3). Retrying...
07/13/19 08:04:53.513 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: Sending (My-HM-MOD-RPI-PCB): 0E8DA011FD491F6863CD0203000000
07/13/19 08:04:54.412 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: No answer to packet 0E8DA011FD491F6863CD0203000000
07/13/19 08:04:56.518 Module HomeMatic BidCoS: Info: Setting peer to unreachable, because the queue processing was interrupted.
07/13/19 08:04:56.518 Info: Peer 3 is unreachable.
07/13/19 08:04:58.491 Info: Peer 3 is reachable again.
07/13/19 08:05:04.842 RPC Server (Port 2001): Info: Client number 10523 is calling RPC method: ping (2) Parameters:
(String) dcd1d685
07/13/19 08:05:04.853 RPC Server (Port 2001): Info: Client number 10523 is calling RPC method: listBidcosInterfaces (2) Parameters:

I tried to extract only the necessary parts from the logs to not flood you with data. Let me know if I can help you better in helping me :slight_smile:

Thanks again!

It seems that homegear can’t setValue on a device and afterwards setting the device to unreachable.

The problem here seems to be that PEQ1419156:4 (String) is trying to be set on STATE which is boolean… this does not fit.
Where is the coresponging setValue on openHab side coming from?

//edit:
Ok, forget about that. Obivously openHab tries to set STATE on the peer with PEQ1419156:4.
Could you give us the output of:

sudo homegear -r
fs 0
ls

?

Here is the information you asked for:
image

In the meanwhile I did unpair, reset and remove the device from homematic. I removed all related things/items from openhab. Took me some time to pair it again. Now I have only configured one switch for testing purposes in openhab.

Unfortunately still the same issue. Though it is not appearing constantly. Sometimes it works fine and I can quickly toggle the switches. Then again the issue:

Openhab:

2019-07-14 10:41:04.456 [DEBUG] [ematic.handler.HomematicThingHandler] - Received command 'ON' for channel 'homematic:HG-HM-LC-Sw4-WM:dcd1d685:PEQ1419156:1#STATE'
2019-07-14 10:41:04.463 [DEBUG] [ommunicator.AbstractHomematicGateway] - Sending datapoint 'PEQ1419156:1#STATE' with value 'true' to gateway with id 'dcd1d685' using rxMode 'DEFAULT'
2019-07-14 10:41:07.039 [DEBUG] [nal.communicator.client.BinRpcClient] - BinRpcMessage socket failure, sending message again 1/1
2019-07-14 10:41:09.608 [ERROR] [ematic.handler.HomematicThingHandler] - -100 No answer from device. (sending setValue()
PEQ1419156:1
STATE
true
)
java.io.IOException: -100 No answer from device. (sending setValue()
PEQ1419156:1
STATE
true
)
	at org.eclipse.smarthome.binding.homematic.internal.communicator.parser.RpcResponseParser.parse(RpcResponseParser.java:51) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:82) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:94) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:70) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.RpcClient.setDatapointValue(RpcClient.java:335) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway$1.execute(AbstractHomematicGateway.java:686) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.misc.DelayedExecuter.start(DelayedExecuter.java:65) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway.sendDatapoint(AbstractHomematicGateway.java:665) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway.sendDatapoint(AbstractHomematicGateway.java:644) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.handler.HomematicThingHandler.sendDatapoint(HomematicThingHandler.java:307) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.handler.HomematicThingHandler.handleCommand(HomematicThingHandler.java:283) [198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at sun.reflect.GeneratedMethodAccessor179.invoke(Unknown Source) ~[?:?]
	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) ~[?:?]
	at java.lang.reflect.Method.invoke(Method.java:498) ~[?:?]
	at org.eclipse.smarthome.core.internal.common.AbstractInvocationHandler.invokeDirect(AbstractInvocationHandler.java:153) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at org.eclipse.smarthome.core.internal.common.InvocationHandlerSync.invoke(InvocationHandlerSync.java:59) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at com.sun.proxy.$Proxy133.handleCommand(Unknown Source) [198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.core.thing.internal.profiles.ProfileCallbackImpl.handleCommand(ProfileCallbackImpl.java:75) [109:org.eclipse.smarthome.core.thing:0.10.0.oh240]
	at org.eclipse.smarthome.core.thing.internal.profiles.SystemDefaultProfile.onCommandFromItem(SystemDefaultProfile.java:49) [109:org.eclipse.smarthome.core.thing:0.10.0.oh240]
	at sun.reflect.GeneratedMethodAccessor178.invoke(Unknown Source) ~[?:?]
	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) ~[?:?]
	at java.lang.reflect.Method.invoke(Method.java:498) ~[?:?]
	at org.eclipse.smarthome.core.internal.common.AbstractInvocationHandler.invokeDirect(AbstractInvocationHandler.java:153) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at org.eclipse.smarthome.core.internal.common.Invocation.call(Invocation.java:53) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at java.util.concurrent.FutureTask.run(FutureTask.java:266) [?:?]
	at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1149) [?:?]
	at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:624) [?:?]
	at java.lang.Thread.run(Thread.java:748) [?:?]
2019-07-14 10:41:09.644 [DEBUG] [ematic.handler.HomematicThingHandler] - Received command 'OFF' for channel 'homematic:HG-HM-LC-Sw4-WM:dcd1d685:PEQ1419156:1#STATE'
2019-07-14 10:41:09.650 [DEBUG] [ommunicator.AbstractHomematicGateway] - Sending datapoint 'PEQ1419156:1#STATE' with value 'false' to gateway with id 'dcd1d685' using rxMode 'DEFAULT'
2019-07-14 10:41:12.214 [DEBUG] [nal.communicator.client.BinRpcClient] - BinRpcMessage socket failure, sending message again 1/1
2019-07-14 10:41:14.785 [ERROR] [ematic.handler.HomematicThingHandler] - -100 No answer from device. (sending setValue()
PEQ1419156:1
STATE
false
)
java.io.IOException: -100 No answer from device. (sending setValue()
PEQ1419156:1
STATE
false
)
	at org.eclipse.smarthome.binding.homematic.internal.communicator.parser.RpcResponseParser.parse(RpcResponseParser.java:51) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:82) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:94) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.BinRpcClient.sendMessage(BinRpcClient.java:70) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.client.RpcClient.setDatapointValue(RpcClient.java:335) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway$1.execute(AbstractHomematicGateway.java:686) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.misc.DelayedExecuter.start(DelayedExecuter.java:65) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway.sendDatapoint(AbstractHomematicGateway.java:665) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.internal.communicator.AbstractHomematicGateway.sendDatapoint(AbstractHomematicGateway.java:644) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.handler.HomematicThingHandler.sendDatapoint(HomematicThingHandler.java:307) ~[198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.binding.homematic.handler.HomematicThingHandler.handleCommand(HomematicThingHandler.java:283) [198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at sun.reflect.GeneratedMethodAccessor179.invoke(Unknown Source) ~[?:?]
	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) ~[?:?]
	at java.lang.reflect.Method.invoke(Method.java:498) ~[?:?]
	at org.eclipse.smarthome.core.internal.common.AbstractInvocationHandler.invokeDirect(AbstractInvocationHandler.java:153) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at org.eclipse.smarthome.core.internal.common.InvocationHandlerSync.invoke(InvocationHandlerSync.java:59) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at com.sun.proxy.$Proxy133.handleCommand(Unknown Source) [198:org.eclipse.smarthome.binding.homematic:0.10.0.oh240]
	at org.eclipse.smarthome.core.thing.internal.profiles.ProfileCallbackImpl.handleCommand(ProfileCallbackImpl.java:75) [109:org.eclipse.smarthome.core.thing:0.10.0.oh240]
	at org.eclipse.smarthome.core.thing.internal.profiles.SystemDefaultProfile.onCommandFromItem(SystemDefaultProfile.java:49) [109:org.eclipse.smarthome.core.thing:0.10.0.oh240]
	at sun.reflect.GeneratedMethodAccessor178.invoke(Unknown Source) ~[?:?]
	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) ~[?:?]
	at java.lang.reflect.Method.invoke(Method.java:498) ~[?:?]
	at org.eclipse.smarthome.core.internal.common.AbstractInvocationHandler.invokeDirect(AbstractInvocationHandler.java:153) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at org.eclipse.smarthome.core.internal.common.Invocation.call(Invocation.java:53) [102:org.eclipse.smarthome.core:0.10.0.oh240]
	at java.util.concurrent.FutureTask.run(FutureTask.java:266) [?:?]
	at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1149) [?:?]
	at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:624) [?:?]
	at java.lang.Thread.run(Thread.java:748) [?:?]
2019-07-14 10:41:17.293 [DEBUG] [ommunicator.AbstractHomematicGateway] - Received new (String) value 'dcd1d685' for 'CENTRAL:0#PONG' from gateway with id 'dcd1d685'
2019-07-14 10:41:24.622 [DEBUG] [ommunicator.AbstractHomematicGateway] - Received new (Boolean) value 'true' for 'PEQ1419156:0#UNREACH' from gateway with id 'dcd1d685'
2019-07-14 10:41:24.652 [DEBUG] [ommunicator.AbstractHomematicGateway] - Received new (Boolean) value 'true' for 'PEQ1419156:0#STICKY_UNREACH' from gateway with id 'dcd1d685'
2019-07-14 10:41:27.711 [DEBUG] [ommunicator.AbstractHomematicGateway] - Received new (Boolean) value 'false' for 'PEQ1419156:0#UNREACH' from gateway with id 'dcd1d685'

Homegear:

07/14/19 10:41:02.271 RPC Server (Port 2001): Debug: Packet received: 42696E000000001C0000000470696E670000000100000003000000086463643164363835
07/14/19 10:41:02.272 RPC Server (Port 2001): Info: Client number 7133 is calling RPC method: ping (2) Parameters:
(String) dcd1d685
07/14/19 10:41:02.272 RPC client: Debug: Calling RPC method "system.multicall" on server 10.0.0.45.
07/14/19 10:41:02.273 RPC client: Parameters:
(Array length=1)
[
  (Struct length=2)
  {
[methodName] (String) event
[params] (Array length=4)
[
  (String) RF-dcd1d685
  (String) CENTRAL
  (String) PONG
  (String) dcd1d685
]
  }
]
07/14/19 10:41:02.273 Debug: Calling getFileDescriptor...
07/14/19 10:41:02.273 Debug: Connecting to host 10.0.0.45 on port 9126...
07/14/19 10:41:02.273 Debug: Connected to host 10.0.0.45 on port 9126. Client number is: 7211
07/14/19 10:41:02.274 RPC client: Debug: Sending packet: 42696E00000000930000001073797374656D2E6D756C746963616C6C00000001000001000000000100000101000000020000000A6D6574686F644E616D6500000003000000056576656E7400000006706172616D730000010000000004000000030000000B52462D6463643164363835000000030000000743454E5452414C0000000300000004504F4E4700000003000000086463643164363835
07/14/19 10:41:02.275 RPC client: Debug: Calling RPC method "system.multicall" on server 10.0.0.135.
07/14/19 10:41:02.275 RPC client: Parameters:
(Array length=1)
[
  (Struct length=2)
  {
[methodName] (String) event
[params] (Array length=5)
[
  (String) HomegearLib.10.0.0.135:9876
  (Integer64) 0
  (Integer) -1
  (String) PONG
  (String) dcd1d685
]
  }
]
07/14/19 10:41:02.276 RPC client: Debug: Sending packet: 42696E00000000A80000001073797374656D2E6D756C746963616C6C00000001000001000000000100000101000000020000000A6D6574686F644E616D6500000003000000056576656E7400000006706172616D730000010000000005000000030000001B486F6D65676561724C69622E31302E302E302E3133353A39383736000000D1000000000000000000000001FFFFFFFF0000000300000004504F4E4700000003000000086463643164363835
07/14/19 10:41:02.276 RPC Server (Port 2001): Response: 
(Boolean) 1
07/14/19 10:41:02.277 RPC Server (Port 2001): Response binary:
42696E01000000050000000201
07/14/19 10:41:02.278 RPC client: Debug: Packet received: 42696E01000000080000000300000000
07/14/19 10:41:02.279 RPC client: Debug: Received packet from server 10.0.0.135: 42696E01000000080000000300000000
07/14/19 10:41:02.279 RPC client: Response was:
(String) 
07/14/19 10:41:02.280 RPC client: Debug: Packet received: 42696E0100000015000001000000000100000003000000056576656E74
07/14/19 10:41:02.280 RPC client: Debug: Received packet from server 10.0.0.45: 42696E0100000015000001000000000100000003000000056576656E74
07/14/19 10:41:02.281 RPC client: Response was:
(Array length=1)
[
  (String) event
]
07/14/19 10:41:02.281 RPC Server (Port 2001): Debug: Packet received: 42696E000000001C000000146C697374426964636F73496E746572666163657300000000
07/14/19 10:41:02.281 RPC Server (Port 2001): Info: Client number 7133 is calling RPC method: listBidcosInterfaces (2) Parameters:
07/14/19 10:41:02.282 RPC Server (Port 2001): Response: 
(Array length=1)
[
  (Struct length=4)
  {
[ADDRESS] (String) VBC0208840
[CONNECTED] (Boolean) 1
[DEFAULT] (Boolean) 1
[DESCRIPTION] (String) Homegear default BidCoS interface
  }
]
07/14/19 10:41:02.282 RPC Server (Port 2001): Response binary:
42696E0100000087000001000000000100000101000000040000000741444452455353000000030000000A5642433032303838343000000009434F4E4E454354454400000002010000000744454641554C5400000002010000000B4445534352495054494F4E0000000300000021486F6D65676561722064656661756C7420426964436F5320696E74657266616365
07/14/19 10:41:04.480 RPC Server (Port 2001): Debug: Packet received: 42696E00000000360000000873657456616C756500000003000000030000000C504551313431393135363A31000000030000000553544154450000000201
07/14/19 10:41:04.481 RPC Server (Port 2001): Info: Client number 7133 is calling RPC method: setValue (2) Parameters:
(String) PEQ1419156:1
(String) STATE
(Boolean) 1
07/14/19 10:41:04.481 Module HomeMatic BidCoS: Debug: STATE of peer 3 with serial number PEQ1419156:1 was set to C8.
07/14/19 10:41:04.482 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: Sending (My-HM-MOD-RPI-PCB): 0EB4A011FD491F6863CD0201C80000
07/14/19 10:41:04.482 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Debug: Sending: FD001401C902000000B4A011FC7D491F6863CD0201C800004BBD
07/14/19 10:41:05.409 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Debug: Packet received. Raw data: FD000401C9040402
07/14/19 10:41:05.409 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Debug: Packet received. Raw data: 94
07/14/19 10:41:05.409 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Debug: Packet received from HM-MOD-RPI-PCB: FD000401C904040294
07/14/19 10:41:05.409 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: No answer to packet 0EB4A011FD491F6863CD0201C80000
07/14/19 10:41:06.809 RPC Server (Port 2001): Debug: Packet received: 42696E000000004200000017636C69656E74536572766572496E697469616C697A656400000001000000030000001B486F6D65676561724C69622E31302E302E302E3133353A39383736
07/14/19 10:41:06.809 RPC Server (Port 2001): Info: Client number 6789 is calling RPC method: clientServerInitialized (2) Parameters:
(String) HomegearLib.10.0.0.135:9876
07/14/19 10:41:06.809 RPC Server (Port 2001): Response: 
(Boolean) 1
07/14/19 10:41:06.809 RPC Server (Port 2001): Response binary:
42696E01000000050000000201
07/14/19 10:41:07.036 RPC Server (Port 2001): Response: 
(Struct length=2)
{
  [faultCode] (Integer) -100
  [faultString] (String) No answer from device.
}
07/14/19 10:41:07.036 RPC Server (Port 2001): Response binary:
42696EFF0000004A0000010100000002000000096661756C74436F646500000001FFFFFF9C0000000B6661756C74537472696E6700000003000000164E6F20616E737765722066726F6D206465766963652E
07/14/19 10:41:07.046 RPC Server (Port 2001): Debug: Connection to client number 7133 closed (3).
07/14/19 10:41:07.047 RPC Server (Port 2001): Info: Connection from ::ffff:10.0.0.45:36432 accepted. Client number: 7212
07/14/19 10:41:07.048 RPC Server (Port 2001): Info: RPC server client id for client number 7212 is: 231
07/14/19 10:41:07.049 RPC Server (Port 2001): Listening for incoming packets from client number 7212.
07/14/19 10:41:07.049 RPC Server (Port 2001): Debug: Packet received: 42696E00000000360000000873657456616C756500000003000000030000000C504551313431393135363A31000000030000000553544154450000000201
07/14/19 10:41:07.049 RPC Server (Port 2001): Info: Client number 7212 is calling RPC method: setValue (2) Parameters:
(String) PEQ1419156:1
(String) STATE
(Boolean) 1
07/14/19 10:41:07.049 Module HomeMatic BidCoS: Debug: STATE of peer 3 with serial number PEQ1419156:1 was set to C8.
07/14/19 10:41:09.604 RPC Server (Port 2001): Response: 
(Struct length=2)
{
  [faultCode] (Integer) -100
  [faultString] (String) No answer from device.
}
07/14/19 10:41:09.604 RPC Server (Port 2001): Response binary:
42696EFF0000004A0000010100000002000000096661756C74436F646500000001FFFFFF9C0000000B6661756C74537472696E6700000003000000164E6F20616E737765722066726F6D206465766963652E
07/14/19 10:41:09.654 RPC Server (Port 2001): Debug: Packet received: 42696E00000000360000000873657456616C756500000003000000030000000C504551313431393135363A31000000030000000553544154450000000200
07/14/19 10:41:09.655 RPC Server (Port 2001): Info: Client number 7212 is calling RPC method: setValue (2) Parameters:
(String) PEQ1419156:1
(String) STATE
(Boolean) 0
07/14/19 10:41:09.655 Module HomeMatic BidCoS: Debug: STATE of peer 3 with serial number PEQ1419156:1 was set to 00.
07/14/19 10:41:12.209 RPC Server (Port 2001): Response: 
(Struct length=2)
{
  [faultCode] (Integer) -100
  [faultString] (String) No answer from device.
}
07/14/19 10:41:12.210 RPC Server (Port 2001): Response binary:
42696EFF0000004A0000010100000002000000096661756C74436F646500000001FFFFFF9C0000000B6661756C74537472696E6700000003000000164E6F20616E737765722066726F6D206465766963652E
07/14/19 10:41:12.218 RPC Server (Port 2001): Debug: Connection to client number 7212 closed (3).
07/14/19 10:41:12.219 RPC Server (Port 2001): Info: Connection from ::ffff:10.0.0.45:36444 accepted. Client number: 7213
07/14/19 10:41:12.220 RPC Server (Port 2001): Info: RPC server client id for client number 7213 is: 232
07/14/19 10:41:12.221 RPC Server (Port 2001): Listening for incoming packets from client number 7213.
07/14/19 10:41:12.221 RPC Server (Port 2001): Debug: Packet received: 42696E00000000360000000873657456616C756500000003000000030000000C504551313431393135363A31000000030000000553544154450000000200
07/14/19 10:41:12.222 RPC Server (Port 2001): Info: Client number 7213 is calling RPC method: setValue (2) Parameters:
(String) PEQ1419156:1
(String) STATE
(Boolean) 0
07/14/19 10:41:12.222 Module HomeMatic BidCoS: Debug: STATE of peer 3 with serial number PEQ1419156:1 was set to 00.
07/14/19 10:41:14.085 UPnP Server: Debug: Sending notify packets.
07/14/19 10:41:14.782 RPC Server (Port 2001): Response: 
(Struct length=2)
{
  [faultCode] (Integer) -100
  [faultString] (String) No answer from device.
}
07/14/19 10:41:14.782 RPC Server (Port 2001): Response binary:
42696EFF0000004A0000010100000002000000096661756C74436F646500000001FFFFFF9C0000000B6661756C74537472696E6700000003000000164E6F20616E737765722066726F6D206465766963652E
07/14/19 10:41:15.300 Module HomeMatic BidCoS: Debug: Deleting queue 88 for BidCoS peer with address 0x6863CD
07/14/19 10:41:15.300 Module HomeMatic BidCoS: Info: Setting peer to unreachable, because the queue processing was interrupted.
07/14/19 10:41:15.300 Module HomeMatic BidCoS: Info: Queue is not finished (peer: 3). Retrying...
07/14/19 10:41:15.400 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: Sending (My-HM-MOD-RPI-PCB): 0EB7A011FD491F6863CD0201000000
07/14/19 10:41:15.401 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Debug: Sending: FD001401CA02000000B7A011FC7D491F6863CD0201000000FB95
07/14/19 10:41:16.262 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Debug: Packet received. Raw data: FD000401CA040402
07/14/19 10:41:16.262 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Debug: Packet received. Raw data: A8
07/14/19 10:41:16.262 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Debug: Packet received from HM-MOD-RPI-PCB: FD000401CA040402A8
07/14/19 10:41:16.262 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: No answer to packet 0EB7A011FD491F6863CD0201000000
07/14/19 10:41:16.832 RPC Server (Port 2001): Debug: Packet received: 42696E000000004200000017636C69656E74536572766572496E697469616C697A656400000001000000030000001B486F6D65676561724C69622E31302E302E302E3133353A39383736
07/14/19 10:41:16.832 RPC Server (Port 2001): Info: Client number 6789 is calling RPC method: clientServerInitialized (2) Parameters:
(String) HomegearLib.10.0.0.135:9876
07/14/19 10:41:16.832 RPC Server (Port 2001): Response: 
(Boolean) 1
07/14/19 10:41:16.832 RPC Server (Port 2001): Response binary:
42696E01000000050000000201
07/14/19 10:41:17.291 RPC Server (Port 2001): Debug: Packet received: 42696E000000001C0000000470696E670000000100000003000000086463643164363835
07/14/19 10:41:17.291 RPC Server (Port 2001): Info: Client number 7213 is calling RPC method: ping (2) Parameters:
(String) dcd1d685
07/14/19 10:41:17.291 RPC client: Debug: Calling RPC method "system.multicall" on server 10.0.0.45.
07/14/19 10:41:17.291 RPC client: Parameters:
(Array length=1)
[
  (Struct length=2)
  {
[methodName] (String) event
[params] (Array length=4)
[
  (String) RF-dcd1d685
  (String) CENTRAL
  (String) PONG
  (String) dcd1d685
]
  }
]
07/14/19 10:41:17.291 RPC Server (Port 2001): Response: 
(Boolean) 1
07/14/19 10:41:17.291 Debug: Calling getFileDescriptor...
07/14/19 10:41:17.291 Debug: Connecting to host 10.0.0.45 on port 9126...
07/14/19 10:41:17.291 RPC Server (Port 2001): Response binary:
42696E01000000050000000201
07/14/19 10:41:17.292 Debug: Connected to host 10.0.0.45 on port 9126. Client number is: 7214
07/14/19 10:41:17.292 RPC client: Debug: Sending packet: 42696E00000000930000001073797374656D2E6D756C746963616C6C00000001000001000000000100000101000000020000000A6D6574686F644E616D6500000003000000056576656E7400000006706172616D730000010000000004000000030000000B52462D6463643164363835000000030000000743454E5452414C0000000300000004504F4E4700000003000000086463643164363835
07/14/19 10:41:17.292 RPC client: Debug: Calling RPC method "system.multicall" on server 10.0.0.135.
07/14/19 10:41:17.292 RPC client: Parameters:
(Array length=1)
[
  (Struct length=2)
  {
[methodName] (String) event
[params] (Array length=5)
[
  (String) HomegearLib.10.0.0.135:9876
  (Integer64) 0
  (Integer) -1
  (String) PONG
  (String) dcd1d685
]
  }
]
07/14/19 10:41:17.293 RPC client: Debug: Sending packet: 42696E00000000A80000001073797374656D2E6D756C746963616C6C00000001000001000000000100000101000000020000000A6D6574686F644E616D6500000003000000056576656E7400000006706172616D730000010000000005000000030000001B486F6D65676561724C69622E31302E302E302E3133353A39383736000000D1000000000000000000000001FFFFFFFF0000000300000004504F4E4700000003000000086463643164363835
07/14/19 10:41:17.295 RPC Server (Port 2001): Debug: Packet received: 42696E000000001C000000146C697374426964636F73496E746572666163657300000000
07/14/19 10:41:17.295 RPC Server (Port 2001): Info: Client number 7213 is calling RPC method: listBidcosInterfaces (2) Parameters:
07/14/19 10:41:17.295 RPC Server (Port 2001): Response: 
(Array length=1)
[
  (Struct length=4)
  {
[ADDRESS] (String) VBC0208840
[CONNECTED] (Boolean) 1
[DEFAULT] (Boolean) 1
[DESCRIPTION] (String) Homegear default BidCoS interface
  }
]
07/14/19 10:41:17.295 RPC Server (Port 2001): Response binary:
42696E0100000087000001000000000100000101000000040000000741444452455353000000030000000A5642433032303838343000000009434F4E4E454354454400000002010000000744454641554C5400000002010000000B4445534352495054494F4E0000000300000021486F6D65676561722064656661756C7420426964436F5320696E74657266616365
07/14/19 10:41:17.296 RPC client: Debug: Packet received: 42696E0100000015000001000000000100000003000000056576656E74
07/14/19 10:41:17.297 RPC client: Debug: Received packet from server 10.0.0.45: 42696E0100000015000001000000000100000003000000056576656E74
07/14/19 10:41:17.297 RPC client: Response was:
(Array length=1)
[
  (String) event
]
07/14/19 10:41:17.336 RPC client: Debug: Packet received: 42696E01000000080000000300000000
07/14/19 10:41:17.336 RPC client: Debug: Received packet from server 10.0.0.135: 42696E01000000080000000300000000
07/14/19 10:41:17.336 RPC client: Response was:
(String) 
07/14/19 10:41:18.405 Module HomeMatic BidCoS: Debug: Deleting queue 89 for BidCoS peer with address 0x6863CD
07/14/19 10:41:18.405 Module HomeMatic BidCoS: Info: Setting peer to unreachable, because the queue processing was interrupted.
07/14/19 10:41:18.405 Module HomeMatic BidCoS: Info: Queue is not finished (peer: 3). Retrying...
07/14/19 10:41:18.505 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: Sending (My-HM-MOD-RPI-PCB): 0EB7A011FD491F6863CD0201000000
07/14/19 10:41:18.506 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Debug: Sending: FD001401CB02000000B7A011FC7D491F6863CD02010000006FEE
07/14/19 10:41:19.380 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Debug: Packet received. Raw data: FD000401CB040482
07/14/19 10:41:19.380 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Debug: Packet received. Raw data: BF
07/14/19 10:41:19.390 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Debug: Packet received from HM-MOD-RPI-PCB: FD000401CB040482BF
07/14/19 10:41:19.391 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: No answer to packet 0EB7A011FD491F6863CD0201000000
07/14/19 10:41:21.510 Module HomeMatic BidCoS: Debug: Deleting queue 90 for BidCoS peer with address 0x6863CD
07/14/19 10:41:21.510 Module HomeMatic BidCoS: Info: Setting peer to unreachable, because the queue processing was interrupted.
07/14/19 10:41:21.510 Module HomeMatic BidCoS: Info: Queue is not finished (peer: 3). Retrying...
07/14/19 10:41:21.610 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: Sending (My-HM-MOD-RPI-PCB): 0EB7A011FD491F6863CD0201000000
07/14/19 10:41:21.611 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Debug: Sending: FD001401CC02000000B7A011FC7D491F6863CD02010000008285
07/14/19 10:41:22.513 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Debug: Packet received. Raw data: FD000401CC040402
07/14/19 10:41:22.514 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Debug: Packet received. Raw data: D0
07/14/19 10:41:22.514 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Debug: Packet received from HM-MOD-RPI-PCB: FD000401CC040402D0
07/14/19 10:41:22.514 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Info: No answer to packet 0EB7A011FD491F6863CD0201000000
07/14/19 10:41:24.616 Module HomeMatic BidCoS: Debug: Deleting queue 91 for BidCoS peer with address 0x6863CD
07/14/19 10:41:24.616 Module HomeMatic BidCoS: Info: Setting peer to unreachable, because the queue processing was interrupted.
07/14/19 10:41:24.616 Info: Peer 3 is unreachable.
07/14/19 10:41:24.617 RPC client: Debug: Calling RPC method "system.multicall" on server 10.0.0.45.
07/14/19 10:41:24.618 RPC client: Parameters:
(Array length=2)
[
  (Struct length=2)
  {
[methodName] (String) event
[params] (Array length=4)
[
  (String) RF-dcd1d685
  (String) PEQ1419156:0
  (String) UNREACH
  (Boolean) 1
]
  }
  (Struct length=2)
  {
[methodName] (String) event
[params] (Array length=4)
[
  (String) RF-dcd1d685
  (String) PEQ1419156:0
  (String) STICKY_UNREACH
  (Boolean) 1
]
  }
]
07/14/19 10:41:24.618 Debug: Calling getFileDescriptor...
07/14/19 10:41:24.618 Debug: Connecting to host 10.0.0.45 on port 9126...
07/14/19 10:41:24.619 Debug: Connected to host 10.0.0.45 on port 9126. Client number is: 7215
07/14/19 10:41:24.619 RPC client: Debug: Sending packet: 42696E00000001070000001073797374656D2E6D756C746963616C6C00000001000001000000000200000101000000020000000A6D6574686F644E616D6500000003000000056576656E7400000006706172616D730000010000000004000000030000000B52462D6463643164363835000000030000000C504551313431393135363A300000000300000007554E5245414348000000020100000101000000020000000A6D6574686F644E616D6500000003000000056576656E7400000006706172616D730000010000000004000000030000000B52462D6463643164363835000000030000000C504551313431393135363A30000000030000000E535449434B595F554E52454143480000000201
07/14/19 10:41:24.620 RPC client: Debug: Calling RPC method "system.multicall" on server 10.0.0.135.
07/14/19 10:41:24.620 RPC client: Parameters:
(Array length=2)
[
  (Struct length=2)
  {
[methodName] (String) event
[params] (Array length=5)
[
  (String) HomegearLib.10.0.0.135:9876
  (Integer64) 3
  (Integer) 0
  (String) UNREACH
  (Boolean) 1
]
  }
  (Struct length=2)
  {
[methodName] (String) event
[params] (Array length=5)
[
  (String) HomegearLib.10.0.0.135:9876
  (Integer64) 3
  (Integer) 0
  (String) STICKY_UNREACH
  (Boolean) 1
]
  }
]
07/14/19 10:41:24.620 RPC client: Debug: Sending packet: 42696E00000001270000001073797374656D2E6D756C746963616C6C00000001000001000000000200000101000000020000000A6D6574686F644E616D6500000003000000056576656E7400000006706172616D730000010000000005000000030000001B486F6D65676561724C69622E31302E302E302E3133353A39383736000000D1000000000000000300000001000000000000000300000007554E5245414348000000020100000101000000020000000A6D6574686F644E616D6500000003000000056576656E7400000006706172616D730000010000000005000000030000001B486F6D65676561724C69622E31302E302E302E3133353A39383736000000D100000000000000030000000100000000000000030000000E535449434B595F554E52454143480000000201
07/14/19 10:41:24.631 RPC client: Debug: Packet received: 42696E01000000080000000300000000
07/14/19 10:41:24.632 RPC client: Debug: Received packet from server 10.0.0.135: 42696E01000000080000000300000000
07/14/19 10:41:24.632 RPC client: Response was:
(String) 
07/14/19 10:41:24.660 RPC client: Debug: Packet received: 42696E0100000015000001000000000100000003000000056576656E74
07/14/19 10:41:24.661 RPC client: Debug: Received packet from server 10.0.0.45: 42696E0100000015000001000000000100000003000000056576656E74
07/14/19 10:41:24.661 RPC client: Response was:
(Array length=1)
[
  (String) event
]
07/14/19 10:41:26.825 RPC Server (Port 2001): Debug: Packet received: 42696E000000004200000017636C69656E74536572766572496E697469616C697A656400000001000000030000001B486F6D65676561724C69622E31302E302E302E3133353A39383736
07/14/19 10:41:26.825 RPC Server (Port 2001): Info: Client number 6789 is calling RPC method: clientServerInitialized (2) Parameters:
(String) HomegearLib.10.0.0.135:9876
07/14/19 10:41:26.825 RPC Server (Port 2001): Response: 
(Boolean) 1
07/14/19 10:41:26.825 RPC Server (Port 2001): Response binary:
42696E01000000050000000201
07/14/19 10:41:27.705 Info: Peer 3 is reachable again.
07/14/19 10:41:27.707 RPC client: Debug: Calling RPC method "system.multicall" on server 10.0.0.45.
07/14/19 10:41:27.707 RPC client: Parameters:
07/14/19 10:41:27.707 RPC client: Debug: Calling RPC method "system.multicall" on server 10.0.0.135.
07/14/19 10:41:27.707 RPC client: Parameters:
(Array length=1)
[
  (Struct length=2)
  {
[methodName] (String) event
[params] (Array length=4)
[
  (String) RF-dcd1d685
  (String) PEQ1419156:0
  (String) UNREACH
  (Boolean) 0
]
  }
]
07/14/19 10:41:27.707 Debug: Calling getFileDescriptor...
07/14/19 10:41:27.707 Debug: Connecting to host 10.0.0.45 on port 9126...
(Array length=1)
[
  (Struct length=2)
  {
[methodName] (String) event
[params] (Array length=5)
[
  (String) HomegearLib.10.0.0.135:9876
  (Integer64) 3
  (Integer) 0
  (String) UNREACH
  (Boolean) 0
]
  }
]
07/14/19 10:41:27.708 RPC client: Debug: Sending packet: 42696E00000000A00000001073797374656D2E6D756C746963616C6C00000001000001000000000100000101000000020000000A6D6574686F644E616D6500000003000000056576656E7400000006706172616D730000010000000005000000030000001B486F6D65676561724C69622E31302E302E302E3133353A39383736000000D1000000000000000300000001000000000000000300000007554E52454143480000000200
07/14/19 10:41:27.708 Debug: Connected to host 10.0.0.45 on port 9126. Client number is: 7216
07/14/19 10:41:27.708 RPC client: Debug: Sending packet: 42696E00000000900000001073797374656D2E6D756C746963616C6C00000001000001000000000100000101000000020000000A6D6574686F644E616D6500000003000000056576656E7400000006706172616D730000010000000004000000030000000B52462D6463643164363835000000030000000C504551313431393135363A300000000300000007554E52454143480000000200
07/14/19 10:41:27.711 RPC client: Debug: Packet received: 42696E01000000080000000300000000
07/14/19 10:41:27.711 RPC client: Debug: Received packet from server 10.0.0.135: 42696E01000000080000000300000000
07/14/19 10:41:27.712 RPC client: Response was:
(String) 
07/14/19 10:41:27.722 RPC client: Debug: Packet received: 42696E0100000015000001000000000100000003000000056576656E74
07/14/19 10:41:27.722 RPC client: Debug: Received packet from server 10.0.0.45: 42696E0100000015000001000000000100000003000000056576656E74
07/14/19 10:41:27.723 RPC client: Response was:
(Array length=1)
[
  (String) event
]
07/14/19 10:41:31.530 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Debug: Packet received. Raw data: FD00100164050000
07/14/19 10:41:31.530 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Debug: Packet received. Raw data: 57C780022BC90E48
07/14/19 10:41:31.531 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Debug: Packet received. Raw data: 241F002B13
07/14/19 10:41:31.531 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Debug: Packet received from HM-MOD-RPI-PCB: FD0010016405000057C780022BC90E48241F002B13
07/14/19 10:41:31.531 Debug (My-HM-MOD-RPI-PCB): Packet 0AC780022BC90E48241F00 enters raisePacketReceived.
07/14/19 10:41:31.532 Debug (My-HM-MOD-RPI-PCB): Packet 0AC780022BC90E48241F00 is now passed to the EventHandler.
07/14/19 10:41:31.531 HomeMatic BidCoS packet received (My-HM-MOD-RPI-PCB, RSSI: -87 dBm): 0AC780022BC90E48241F00
07/14/19 10:41:31.532 Debug (My-HM-MOD-RPI-PCB): Packet processing of packet 0AC780022BC90E48241F00 took 1 ms.
07/14/19 10:41:32.300 RPC Server (Port 2001): Debug: Packet received: 42696E000000001C0000000470696E670000000100000003000000086463643164363835
07/14/19 10:41:32.300 RPC Server (Port 2001): Info: Client number 7213 is calling RPC method: ping (2) Parameters:
(String) dcd1d685
07/14/19 10:41:32.301 RPC client: Debug: Calling RPC method "system.multicall" on server 10.0.0.45.
07/14/19 10:41:32.301 RPC client: Parameters:
(Array length=1)
[
  (Struct length=2)
  {
[methodName] (String) event
[params] (Array length=4)
[
  (String) RF-dcd1d685
  (String) CENTRAL
  (String) PONG
  (String) dcd1d685
]
  }
]
07/14/19 10:41:32.301 RPC client: Debug: Calling RPC method "system.multicall" on server 10.0.0.135.
07/14/19 10:41:32.301 RPC client: Parameters:
07/14/19 10:41:32.302 Debug: Calling getFileDescriptor...
07/14/19 10:41:32.302 Debug: Connecting to host 10.0.0.45 on port 9126...
(Array length=1)
[
  (Struct length=2)
  {
[methodName] (String) event
[params] (Array length=5)
[
  (String) HomegearLib.10.0.0.135:9876
  (Integer64) 0
  (Integer) -1
  (String) PONG
  (String) dcd1d685
]
  }
]
07/14/19 10:41:32.302 RPC client: Debug: Sending packet: 42696E00000000A80000001073797374656D2E6D756C746963616C6C00000001000001000000000100000101000000020000000A6D6574686F644E616D6500000003000000056576656E7400000006706172616D730000010000000005000000030000001B486F6D65676561724C69622E31302E302E302E3133353A39383736000000D1000000000000000000000001FFFFFFFF0000000300000004504F4E4700000003000000086463643164363835
07/14/19 10:41:32.302 Debug: Connected to host 10.0.0.45 on port 9126. Client number is: 7217
07/14/19 10:41:32.302 RPC client: Debug: Sending packet: 42696E00000000930000001073797374656D2E6D756C746963616C6C00000001000001000000000100000101000000020000000A6D6574686F644E616D6500000003000000056576656E7400000006706172616D730000010000000004000000030000000B52462D6463643164363835000000030000000743454E5452414C0000000300000004504F4E4700000003000000086463643164363835
07/14/19 10:41:32.303 RPC Server (Port 2001): Response: 
(Boolean) 1
07/14/19 10:41:32.303 RPC Server (Port 2001): Response binary:
42696E01000000050000000201
07/14/19 10:41:32.308 RPC client: Debug: Packet received: 42696E01000000080000000300000000
07/14/19 10:41:32.308 RPC client: Debug: Received packet from server 10.0.0.135: 42696E01000000080000000300000000
07/14/19 10:41:32.308 RPC Server (Port 2001): Debug: Packet received: 42696E000000001C000000146C697374426964636F73496E746572666163657300000000
07/14/19 10:41:32.308 RPC Server (Port 2001): Info: Client number 7213 is calling RPC method: listBidcosInterfaces (2) Parameters:
07/14/19 10:41:32.309 RPC client: Response was:
(String) 
07/14/19 10:41:32.309 RPC Server (Port 2001): Response: 
(Array length=1)
[
  (Struct length=4)
  {
[ADDRESS] (String) VBC0208840
[CONNECTED] (Boolean) 1
[DEFAULT] (Boolean) 1
[DESCRIPTION] (String) Homegear default BidCoS interface
  }
]
07/14/19 10:41:32.309 RPC Server (Port 2001): Response binary:
42696E0100000087000001000000000100000101000000040000000741444452455353000000030000000A5642433032303838343000000009434F4E4E454354454400000002010000000744454641554C5400000002010000000B4445534352495054494F4E0000000300000021486F6D65676561722064656661756C7420426964436F5320696E74657266616365
07/14/19 10:41:32.310 RPC client: Debug: Packet received: 42696E0100000015000001000000000100000003000000056576656E74
07/14/19 10:41:32.310 RPC client: Debug: Received packet from server 10.0.0.45: 42696E0100000015000001000000000100000003000000056576656E74
07/14/19 10:41:32.310 RPC client: Response was:
(Array length=1)
[
  (String) event
]
07/14/19 10:41:34.061 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Debug: Packet received. Raw data: FD00100165050000
07/14/19 10:41:34.062 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Debug: Packet received. Raw data: 57C780022BC90E3F
07/14/19 10:41:34.062 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Debug: Packet received. Raw data: D4BD00C6C8
07/14/19 10:41:34.062 Module HomeMatic BidCoS: HM-MOD-RPI-PCB "My-HM-MOD-RPI-PCB": Debug: Packet received from HM-MOD-RPI-PCB: FD0010016505000057C780022BC90E3FD4BD00C6C8
07/14/19 10:41:34.063 Debug (My-HM-MOD-RPI-PCB): Packet 0AC780022BC90E3FD4BD00 enters raisePacketReceived.
07/14/19 10:41:34.063 Debug (My-HM-MOD-RPI-PCB): Packet 0AC780022BC90E3FD4BD00 is now passed to the EventHandler.
07/14/19 10:41:34.063 HomeMatic BidCoS packet received (My-HM-MOD-RPI-PCB, RSSI: -87 dBm): 0AC780022BC90E3FD4BD00
07/14/19 10:41:34.063 Debug (My-HM-MOD-RPI-PCB): Packet processing of packet 0AC780022BC90E3FD4BD00 took 0 ms.
07/14/19 10:41:36.845 RPC Server (Port 2001): Debug: Packet received: 42696E000000004200000017636C69656E74536572766572496E697469616C697A656400000001000000030000001B486F6D65676561724C69622E31302E302E302E3133353A39383736
07/14/19 10:41:36.845 RPC Server (Port 2001): Info: Client number 6789 is calling RPC method: clientServerInitialized (2) Parameters:
(String) HomegearLib.10.0.0.135:9876
07/14/19 10:41:36.846 RPC Server (Port 2001): Response: 
(Boolean) 1
07/14/19 10:41:36.846 RPC Server (Port 2001): Response binary:
42696E01000000050000000201
07/14/19 10:41:46.856 RPC Server (Port 2001): Debug: Packet received: 42696E000000004200000017636C69656E74536572766572496E697469616C697A656400000001000000030000001B486F6D65676561724C69622E31302E302E302E3133353A39383736
07/14/19 10:41:46.856 RPC Server (Port 2001): Info: Client number 6789 is calling RPC method: clientServerInitialized (2) Parameters:
(String) HomegearLib.10.0.0.135:9876
07/14/19 10:41:46.856 RPC Server (Port 2001): Response: 
(Boolean) 1
07/14/19 10:41:46.856 RPC Server (Port 2001): Response binary:
42696E01000000050000000201
07/14/19 10:41:47.314 RPC Server (Port 2001): Debug: Packet received: 42696E000000001C0000000470696E670000000100000003000000086463643164363835
07/14/19 10:41:47.314 RPC Server (Port 2001): Info: Client number 7213 is calling RPC method: ping (2) Parameters:
(String) dcd1d685
07/14/19 10:41:47.315 RPC client: Debug: Calling RPC method "system.multicall" on server 10.0.0.45.
07/14/19 10:41:47.315 RPC client: Parameters:
07/14/19 10:41:47.315 RPC Server (Port 2001): Response: 
(Array length=1)
[
  (Struct length=2)
  {
[methodName] (String) event
[params] (Array length=4)
[
  (String) RF-dcd1d685
  (String) CENTRAL
  (String) PONG
  (String) dcd1d685
]
  }
]
(Boolean) 1
07/14/19 10:41:47.315 RPC client: Debug: Calling RPC method "system.multicall" on server 10.0.0.135.
07/14/19 10:41:47.315 RPC Server (Port 2001): Response binary:
07/14/19 10:41:47.315 Debug: Calling getFileDescriptor...
07/14/19 10:41:47.316 Debug: Connecting to host 10.0.0.45 on port 9126...
42696E01000000050000000201
07/14/19 10:41:47.316 RPC client: Parameters:
(Array length=1)
[
  (Struct length=2)
  {
[methodName] (String) event
[params] (Array length=5)
[
  (String) HomegearLib.10.0.0.135:9876
  (Integer64) 0
  (Integer) -1
  (String) PONG
  (String) dcd1d685
]
  }
]
07/14/19 10:41:47.316 Debug: Connected to host 10.0.0.45 on port 9126. Client number is: 7218
07/14/19 10:41:47.316 RPC client: Debug: Sending packet: 42696E00000000A80000001073797374656D2E6D756C746963616C6C00000001000001000000000100000101000000020000000A6D6574686F644E616D6500000003000000056576656E7400000006706172616D730000010000000005000000030000001B486F6D65676561724C69622E31302E302E302E3133353A39383736000000D1000000000000000000000001FFFFFFFF0000000300000004504F4E4700000003000000086463643164363835
07/14/19 10:41:47.316 RPC client: Debug: Sending packet: 42696E00000000930000001073797374656D2E6D756C746963616C6C00000001000001000000000100000101000000020000000A6D6574686F644E616D6500000003000000056576656E7400000006706172616D730000010000000004000000030000000B52462D6463643164363835000000030000000743454E5452414C0000000300000004504F4E4700000003000000086463643164363835
07/14/19 10:41:47.319 RPC Server (Port 2001): Debug: Packet received: 42696E000000001C000000146C697374426964636F73496E746572666163657300000000
07/14/19 10:41:47.319 RPC Server (Port 2001): Info: Client number 7213 is calling RPC method: listBidcosInterfaces (2) Parameters:
07/14/19 10:41:47.320 RPC Server (Port 2001): Response: 
(Array length=1)
[
  (Struct length=4)
  {
[ADDRESS] (String) VBC0208840
[CONNECTED] (Boolean) 1
[DEFAULT] (Boolean) 1
[DESCRIPTION] (String) Homegear default BidCoS interface
  }
]
07/14/19 10:41:47.320 RPC Server (Port 2001): Response binary:
07/14/19 10:41:47.320 RPC client: Debug: Packet received: 42696E01000000080000000300000000
07/14/19 10:41:47.320 RPC client: Debug: Received packet from server 10.0.0.135: 42696E01000000080000000300000000
42696E0100000087000001000000000100000101000000040000000741444452455353000000030000000A5642433032303838343000000009434F4E4E454354454400000002010000000744454641554C5400000002010000000B4445534352495054494F4E0000000300000021486F6D65676561722064656661756C7420426964436F5320696E74657266616365
07/14/19 10:41:47.321 RPC client: Response was:
(String) 
07/14/19 10:41:47.324 RPC client: Debug: Packet received: 42696E0100000015000001000000000100000003000000056576656E74
07/14/19 10:41:47.324 RPC client: Debug: Received packet from server 10.0.0.45: 42696E0100000015000001000000000100000003000000056576656E74
07/14/19 10:41:47.324 RPC client: Response was:
(Array length=1)
[
  (String) event
]
07/14/19 10:41:56.869 RPC Server (Port 2001): Debug: Packet received: 42696E000000004200000017636C69656E74536572766572496E697469616C697A656400000001000000030000001B486F6D65676561724C69622E31302E302E302E3133353A39383736
07/14/19 10:41:56.869 RPC Server (Port 2001): Info: Client number 6789 is calling RPC method: clientServerInitialized (2) Parameters:
(String) HomegearLib.10.0.0.135:9876
07/14/19 10:41:56.870 RPC Server (Port 2001): Response: 
(Boolean) 1
07/14/19 10:41:56.870 RPC Server (Port 2001): Response binary:
42696E01000000050000000201

Turning on is the value C8 and turning off 00

I try to figure out why homegear sets the device as unreachable…
@sathya, do you have any idea?

Nevertheless, openHab simply crashing when this happens is a non welcome situation.

Hello @bummzulu,

as the device is working sometimes the setup seems to be fine in general. So my first guess is that the rf signal does not reach the device (the other direction, device => Homegear, is fine with a RSSI of -55 dBm). How far away is the device from the Pi? Have you tried to move it closer? Have you tried to disable AES (needs several packets and thus communication is disrupted more easily)?

Cheers,

Sathya

Thanks again for your support. It seems that the device that I am trying to control with the HG-HM-LC-SW4-WM is causing somehow the communication issues. No clue how this can happen but the good news is that homegear is not the causing this.

1 Like