FGMS001 - Can't read if there has been any motion / tamper alarm

Hi there!

I’ve been using openhab with Z-WAVE for quite some time now but I have a real big problem with my Fibaro FGMS001 sensor. It’s connected and fully recognized.

And there comes the “but”…
I can read the temperature, battery level and luminance. But there are no transmissions/events for the tamper and motion alarm!
I have tried every fix I’ve found on the internet, but nothing works.

  • excluded / included it several times
  • waited for weeks / woke it up several times for the initialisation process to be completed
  • resetted the controller (!) and the sensor several times.
  • changed the parameter 8 to “always active” and 12 to “Basic ON and Basic OFF”

This is one of the ways I’ve tried to access it:
String Movement_Gang “Movement: [%s]” { channel=“zwave:device:c61532e6:node9:alarm_motion” }

But as I mentioned before: there is nothing in the openhab.log and events.log. I really don’t know what to do other than buying another Fibaro sensor for testing.

Does anyone have any suggestion for me how to proceed?

Thank you very much in advance…

Andi

First thing is, you cannot actively “read” neither values such as the temperature nor alarms. FMGS, if configured correctly, will send them.
First, enable zwave debugging (log:set debug org.openhab.binding.zwave) in Karaf console and look for zwave messages from that node ID of your FGMS to ensure it’s sending them if triggered.
Next, you must properly map that to a Switch type item in your .items file (you used “String”, change that to “Switch”. Rest of the line is ok, assuming you’re using zwave2 binding and not OH1 binding any more).

Hi Markus!

Thanks for your reply. I just had the chance to check your suggestions. First, the word “read” was wrong, yes.

I’ve activated the zwave debugging as suggested and found the following lines in the openhab.log:

2018-08-12 20:26:39.884 [DEBUG] [ding.zwave.handler.ZWaveThingHandler] - NODE 9: Polling zwave:device:c61532e6:node9:sensor_binary
2018-08-12 20:26:39.885 [DEBUG] [converter.ZWaveBinarySensorConverter] - NODE 9: Generating poll message for SENSOR_BINARY, endpoint 0
2018-08-12 20:26:39.886 [DEBUG] [dclass.ZWaveBinarySensorCommandClass] - NODE 9: Creating new message for application command SENSOR_BINARY_GET
2018-08-12 20:26:39.888 [DEBUG] [ding.zwave.handler.ZWaveThingHandler] - NODE 9: Polling zwave:device:c61532e6:node9:sensor_temperature
2018-08-12 20:26:39.889 [DEBUG] [erter.ZWaveMultiLevelSensorConverter] - NODE 9: Generating poll message for SENSOR_MULTILEVEL, endpoint 0
2018-08-12 20:26:39.890 [DEBUG] [ss.ZWaveMultiLevelSensorCommandClass] - NODE 9: Creating new message for command SENSOR_MULTI_LEVEL_GET
2018-08-12 20:26:39.892 [DEBUG] [ding.zwave.handler.ZWaveThingHandler] - NODE 9: Polling zwave:device:c61532e6:node9:sensor_seismicintensity
2018-08-12 20:26:39.893 [DEBUG] [erter.ZWaveMultiLevelSensorConverter] - NODE 9: Generating poll message for SENSOR_MULTILEVEL, endpoint 0
2018-08-12 20:26:39.894 [DEBUG] [ss.ZWaveMultiLevelSensorCommandClass] - NODE 9: Creating new message for command SENSOR_MULTI_LEVEL_GET
2018-08-12 20:26:39.896 [DEBUG] [ding.zwave.handler.ZWaveThingHandler] - NODE 9: Polling zwave:device:c61532e6:node9:sensor_luminance
2018-08-12 20:26:39.897 [DEBUG] [erter.ZWaveMultiLevelSensorConverter] - NODE 9: Generating poll message for SENSOR_MULTILEVEL, endpoint 0
2018-08-12 20:26:39.898 [DEBUG] [ss.ZWaveMultiLevelSensorCommandClass] - NODE 9: Creating new message for command SENSOR_MULTI_LEVEL_GET
2018-08-12 20:26:39.900 [DEBUG] [ding.zwave.handler.ZWaveThingHandler] - NODE 9: Polling zwave:device:c61532e6:node9:alarm_motion
2018-08-12 20:26:39.901 [DEBUG] [ding.zwave.handler.ZWaveThingHandler] - NODE 9: Polling zwave:device:c61532e6:node9:alarm_tamper
2018-08-12 20:26:39.902 [DEBUG] [ding.zwave.handler.ZWaveThingHandler] - NODE 9: Polling zwave:device:c61532e6:node9:battery-level
2018-08-12 20:26:39.903 [DEBUG] [rnal.converter.ZWaveBatteryConverter] - NODE 9: Generating poll message for BATTERY endpoint 0
2018-08-12 20:26:39.904 [DEBUG] [ommandclass.ZWaveBatteryCommandClass] - NODE 9: Creating new message for application command BATTERY_GET
2018-08-12 20:26:39.906 [DEBUG] [ding.zwave.handler.ZWaveThingHandler] - NODE 9: Polling zwave:device:c61532e6:node9:alarm_general
2018-08-12 20:26:39.908 [DEBUG] [.converter.ZWaveAlarmSensorConverter] - NODE 9: Generating poll message for SENSOR_ALARM, endpoint 0, alarm null
2018-08-12 20:26:39.909 [DEBUG] [ndclass.ZWaveAlarmSensorCommandClass] - NODE 9: Creating new message for command SENSOR_ALARM_GET, type General
2018-08-12 20:26:39.911 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: Message already on the wake-up queue. Removing original.
2018-08-12 20:26:39.912 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: Putting message SendData in wakeup queue.
2018-08-12 20:26:39.913 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: Message already on the wake-up queue. Removing original.
2018-08-12 20:26:39.914 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: Putting message SendData in wakeup queue.
2018-08-12 20:26:39.916 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: Message already on the wake-up queue. Removing original.
2018-08-12 20:26:39.917 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: Putting message SendData in wakeup queue.
2018-08-12 20:26:39.918 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: Message already on the wake-up queue. Removing original.
2018-08-12 20:26:39.919 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: Putting message SendData in wakeup queue.
2018-08-12 20:26:39.921 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: Message already on the wake-up queue. Removing original.
2018-08-12 20:26:39.923 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: Putting message SendData in wakeup queue.
2018-08-12 20:26:39.924 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: Message already on the wake-up queue. Removing original.
2018-08-12 20:26:39.925 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: Putting message SendData in wakeup queue.

p

That “Message already on the wake-up queue” seems suspicious. Do you know what it means? Can this result in my problem?

Thanks!

PS: and it repeatedly says this:
2018-08-12 21:12:00.223 [DEBUG] [ssage.ApplicationCommandMessageClass] - NODE 9: Transaction not completed: node address inconsistent. lastSent=9, incoming=255

Your log is fine, it shows OH to poll the device but no messages to originate from the device.
You need to wake it up (push the button three times) or wait until it wakes up (I think every 2 hours by default).

I’ve done that also so many times…

2018-08-13 12:35:35.299 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: Is sleeping
2018-08-13 12:35:35.301 [DEBUG] [ding.zwave.handler.ZWaveThingHandler] - NODE 9: Got an event from Z-Wave network: ZWaveTransactionCompletedEvent
2018-08-13 12:35:35.303 [DEBUG] [ocol.ZWaveController$ZWaveSendThread] - NODE 9: Response processed after 162ms/4967ms.
2018-08-13 12:35:46.462 [DEBUG] [essage.ApplicationUpdateMessageClass] - NODE 9: Application update request. Node information received.
2018-08-13 12:35:46.465 [DEBUG] [alization.ZWaveNodeInitStageAdvancer] - NODE 9: Starting initialisation from DONE
2018-08-13 12:35:46.472 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: Is awake with 0 messages in the wake-up queue.
2018-08-13 12:35:46.478 [DEBUG] [ding.zwave.handler.ZWaveThingHandler] - NODE 9: Got an event from Z-Wave network: ZWaveWakeUpEvent
2018-08-13 12:35:47.523 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: No more messages, go back to sleep
2018-08-13 12:35:47.525 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: Creating new message for application command WAKE_UP_NO_MORE_INFORMATION
2018-08-13 12:35:47.532 [DEBUG] [ing.zwave.handler.ZWaveSerialHandler] - NODE 9: Sending REQUEST Message = 01 09 00 13 09 02 84 08 25 C3 84
2018-08-13 12:35:47.572 [DEBUG] [l.serialmessage.SendDataMessageClass] - NODE 9: Sent Data successfully placed on stack.
2018-08-13 12:35:47.589 [DEBUG] [l.serialmessage.SendDataMessageClass] - NODE 9: SendData Request. CallBack ID = 195, Status = Transmission complete and ACK received(0)
2018-08-13 12:35:47.592 [DEBUG] [alization.ZWaveNodeInitStageAdvancer] - NODE 9: Starting initialisation from DONE
2018-08-13 12:35:47.618 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: Went to sleep
2018-08-13 12:35:47.621 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: Is sleeping
2018-08-13 12:35:47.626 [DEBUG] [ding.zwave.handler.ZWaveThingHandler] - NODE 9: Got an event from Z-Wave network: ZWaveTransactionCompletedEvent
2018-08-13 12:35:47.629 [DEBUG] [ocol.ZWaveController$ZWaveSendThread] - NODE 9: Response processed after 93ms/4967ms.
2018-08-13 12:35:48.931 [DEBUG] [ssage.ApplicationCommandMessageClass] - NODE 9: Application Command Request (ALIVE:DONE)
2018-08-13 12:35:48.933 [DEBUG] [alization.ZWaveNodeInitStageAdvancer] - NODE 9: Starting initialisation from DONE
2018-08-13 12:35:48.938 [DEBUG] [ssage.ApplicationCommandMessageClass] - NODE 9: Incoming command class WAKE_UP
2018-08-13 12:35:48.940 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: Received Wake Up Request
2018-08-13 12:35:48.942 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: Received WAKE_UP_NOTIFICATION
2018-08-13 12:35:48.944 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: Is awake with 0 messages in the wake-up queue.
2018-08-13 12:35:48.948 [DEBUG] [ding.zwave.handler.ZWaveThingHandler] - NODE 9: Got an event from Z-Wave network: ZWaveWakeUpEvent
2018-08-13 12:35:49.985 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: No more messages, go back to sleep
2018-08-13 12:35:49.987 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: Creating new message for application command WAKE_UP_NO_MORE_INFORMATION
2018-08-13 12:35:50.003 [DEBUG] [ing.zwave.handler.ZWaveSerialHandler] - NODE 9: Sending REQUEST Message = 01 09 00 13 09 02 84 08 25 C4 83
2018-08-13 12:35:50.044 [DEBUG] [l.serialmessage.SendDataMessageClass] - NODE 9: Sent Data successfully placed on stack.
2018-08-13 12:35:50.077 [DEBUG] [l.serialmessage.SendDataMessageClass] - NODE 9: SendData Request. CallBack ID = 196, Status = Transmission complete and ACK received(0)
2018-08-13 12:35:50.079 [DEBUG] [alization.ZWaveNodeInitStageAdvancer] - NODE 9: Starting initialisation from DONE
2018-08-13 12:35:50.095 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: Went to sleep
2018-08-13 12:35:50.097 [DEBUG] [commandclass.ZWaveWakeUpCommandClass] - NODE 9: Is sleeping
2018-08-13 12:35:50.099 [DEBUG] [ding.zwave.handler.ZWaveThingHandler] - NODE 9: Got an event from Z-Wave network: ZWaveTransactionCompletedEvent
2018-08-13 12:35:50.102 [DEBUG] [ocol.ZWaveController$ZWaveSendThread] - NODE 9: Response processed after 96ms/4967ms.
2018-08-13 12:35:58.950 [DEBUG] [ssage.ApplicationCommandMessageClass] - NODE 9: Transaction not completed: node address inconsistent.  lastSent=9, incoming=255
2018-08-13 12:35:59.068 [DEBUG] [ssage.ApplicationCommandMessageClass] - NODE 9: Transaction not completed: node address inconsistent.  lastSent=9, incoming=255
2018-08-13 12:35:59.105 [DEBUG] [ssage.ApplicationCommandMessageClass] - NODE 9: Transaction not completed: node address inconsistent.  lastSent=9, incoming=255
2018-08-13 12:35:59.144 [DEBUG] [ssage.ApplicationCommandMessageClass] - NODE 9: Transaction not completed: node address inconsistent.  lastSent=9, incoming=255

What about this “NODE 9: Transaction not completed: node address inconsistent.” message?

So messages are received.
Do you also see (ALARM or other) messages arrive when you trigger the motion and/or tamper sensor ?
Have you switched from String to Switch as mentioned in my first post ?

Have you checked the device associations ?

Yes, messages are received (temperature, luminance).

Today I found something new in the logs… (I’ve let my child play in front of the motion sensor)

2018-08-15 11:20:53.696 [DEBUG] [ding.zwave.handler.ZWaveThingHandler] - NODE 9: Command received zwave:device:c61532e6:node9:alarm_motion --> ON
2018-08-15 11:20:53.713 [DEBUG] [ternal.converter.ZWaveAlarmConverter] - NODE 9: No event found with name 'eventON'
2018-08-15 11:20:53.718 [DEBUG] [ding.zwave.handler.ZWaveThingHandler] - NODE 9: No messages returned from converter
2018-08-15 11:20:54.859 [DEBUG] [ding.zwave.handler.ZWaveThingHandler] - NODE 9: Command received zwave:device:c61532e6:node9:alarm_motion --> OFF
2018-08-15 11:20:54.936 [DEBUG] [ternal.converter.ZWaveAlarmConverter] - NODE 9: No event found with name 'eventOFF'
2018-08-15 11:20:54.938 [DEBUG] [ding.zwave.handler.ZWaveThingHandler] - NODE 9: No messages returned from converter

What event does it mean?

Edit: and now the event doesnt happen anymore…

Hmm, don’t know, but sounds the binding could not properly map the message it received.
Possibly an issue with the database used for mapping. It’s hardcoded into the binding.

I suggest you upgrade OH to the latest version (snapshot).

It’s strange… I’m currently using OH 2.2, I should really upgrade to 2.3. But I’ve had the same issue with 2.1 and before as well. As meationed earlier, I’ve had the problem for a very long time now. I’ve also just ordered a second FGMS001 now just to make sure it’s not a malfunction in the device itself.
Is there a way for a firmware upgrade for the FGMS001?

no. Well yes, you can send them in to Fibaro but need to pay for the return shipping which is almost as expensive as to get a new one.

This looks like you are sending a command TO the binding - it’s not a binding update where it’s received a status from the device.

And I found the solution! It’s working now / both are working.
I think my fault was that I added the first FGMS with PaperUI. I added the second one with Habmin and it worked. So I excluded the first one, reset it to factory settings and included it with Habmin. That worked for me.

Thanks everybody for your support.

Paper UI or habmin both are working. I think it’s rather because you’ve factory resetted your device.

No I don’t think so. I’ve resetted the sensor and even the controller itself got several times before. With no effect.