· 6 years ago · Jan 26, 2020, 01:32 AM
12020-01-25 15:27:07.113 Always, OpenZwave Version 1.4.3452 Starting Up
22020-01-25 15:27:30.823 Info, Setting Up Provided Network Key for Secure Communications
32020-01-25 15:27:30.824 Info, mgr, Added driver for controller /dev/serial/by-id/usb-Silicon_Labs_HubZ_Smart_Home_Controller_61200DAA-if00-port0
42020-01-25 15:27:30.824 Info, Opening controller /dev/serial/by-id/usb-Silicon_Labs_HubZ_Smart_Home_Controller_61200DAA-if00-port0
52020-01-25 15:27:30.824 Info, Trying to open serial port /dev/serial/by-id/usb-Silicon_Labs_HubZ_Smart_Home_Controller_61200DAA-if00-port0 (attempt 1)
62020-01-25 15:27:30.834 Info, Serial port /dev/serial/by-id/usb-Silicon_Labs_HubZ_Smart_Home_Controller_61200DAA-if00-port0 opened (attempt 1)
72020-01-25 15:27:30.834 Detail, contrlr, Queuing (Command) FUNC_ID_ZW_GET_VERSION: 0x01, 0x03, 0x00, 0x15, 0xe9
82020-01-25 15:27:30.834 Detail, contrlr, Queuing (Command) FUNC_ID_ZW_MEMORY_GET_ID: 0x01, 0x03, 0x00, 0x20, 0xdc
92020-01-25 15:27:30.834 Detail, contrlr, Queuing (Command) FUNC_ID_ZW_GET_CONTROLLER_CAPABILITIES: 0x01, 0x03, 0x00, 0x05, 0xf9
102020-01-25 15:27:30.834 Detail, contrlr, Queuing (Command) FUNC_ID_SERIAL_API_GET_CAPABILITIES: 0x01, 0x03, 0x00, 0x07, 0xfb
112020-01-25 15:27:30.834 Detail, contrlr, Queuing (Command) FUNC_ID_ZW_GET_SUC_NODE_ID: 0x01, 0x03, 0x00, 0x56, 0xaa
122020-01-25 15:27:30.834 Detail,
132020-01-25 15:27:30.834 Info, contrlr, Sending (Command) message (Callback ID=0x00, Expected Reply=0x15) - FUNC_ID_ZW_GET_VERSION: 0x01, 0x03, 0x00, 0x15, 0xe9
142020-01-25 15:27:30.837 Detail, contrlr, Received: 0x01, 0x10, 0x01, 0x15, 0x5a, 0x2d, 0x57, 0x61, 0x76, 0x65, 0x20, 0x34, 0x2e, 0x30, 0x35, 0x00, 0x01, 0x97
152020-01-25 15:27:30.838 Detail,
162020-01-25 15:27:30.838 Info, contrlr, Received reply to FUNC_ID_ZW_GET_VERSION:
172020-01-25 15:27:30.838 Info, contrlr, Static Controller library, version Z-Wave 4.05
182020-01-25 15:27:30.838 Detail, Node045, Expected reply was received
192020-01-25 15:27:30.838 Detail, Node045, Message transaction complete
202020-01-25 15:27:30.838 Detail,
212020-01-25 15:27:30.838 Detail, contrlr, Removing current message
222020-01-25 15:27:30.838 Detail,
232020-01-25 15:27:30.838 Info, contrlr, Sending (Command) message (Callback ID=0x00, Expected Reply=0x20) - FUNC_ID_ZW_MEMORY_GET_ID: 0x01, 0x03, 0x00, 0x20, 0xdc
242020-01-25 15:27:30.841 Detail, contrlr, Received: 0x01, 0x08, 0x01, 0x20, 0xd0, 0x05, 0xe2, 0x2e, 0x01, 0xce
252020-01-25 15:27:30.841 Detail,
262020-01-25 15:27:30.841 Info, contrlr, Received reply to FUNC_ID_ZW_MEMORY_GET_ID. Home ID = 0xd005e22e. Our node ID = 1
272020-01-25 15:27:30.841 Detail, Node005, Expected reply was received
282020-01-25 15:27:30.842 Detail, Node005, Message transaction complete
292020-01-25 15:27:30.842 Detail,
302020-01-25 15:27:30.842 Detail, contrlr, Removing current message
312020-01-25 15:27:30.842 Detail,
322020-01-25 15:27:30.842 Info, contrlr, Sending (Command) message (Callback ID=0x00, Expected Reply=0x05) - FUNC_ID_ZW_GET_CONTROLLER_CAPABILITIES: 0x01, 0x03, 0x00, 0x05, 0xf9
332020-01-25 15:27:30.844 Detail, contrlr, Received: 0x01, 0x04, 0x01, 0x05, 0x08, 0xf7
342020-01-25 15:27:30.844 Detail,
352020-01-25 15:27:30.844 Info, contrlr, Received reply to FUNC_ID_ZW_GET_CONTROLLER_CAPABILITIES:
362020-01-25 15:27:30.844 Info, contrlr, There is no SUC ID Server (SIS) in this network.
372020-01-25 15:27:30.844 Info, contrlr, The PC controller is a primary controller.
382020-01-25 15:27:30.844 Detail, Node247, Expected reply was received
392020-01-25 15:27:30.844 Detail, Node247, Message transaction complete
402020-01-25 15:27:30.844 Detail,
412020-01-25 15:27:30.844 Detail, contrlr, Removing current message
422020-01-25 15:27:30.844 Detail,
432020-01-25 15:27:30.844 Info, contrlr, Sending (Command) message (Callback ID=0x00, Expected Reply=0x07) - FUNC_ID_SERIAL_API_GET_CAPABILITIES: 0x01, 0x03, 0x00, 0x07, 0xfb
442020-01-25 15:27:30.849 Detail, contrlr, Received: 0x01, 0x2b, 0x01, 0x07, 0x04, 0x20, 0x00, 0x00, 0x00, 0x01, 0x00, 0x01, 0xfe, 0x81, 0xff, 0x88, 0xcf, 0x1f, 0x00, 0x00, 0xfb, 0x9f, 0x7d, 0xa0, 0x67, 0x00, 0x80, 0x80, 0x00, 0x80, 0x86, 0x00, 0x00, 0x00, 0xe8, 0x73, 0x00, 0x00, 0x0e, 0x00, 0x00, 0x60, 0x00, 0x00, 0x03
452020-01-25 15:27:30.850 Detail,
462020-01-25 15:27:30.850 Info, contrlr, Received reply to FUNC_ID_SERIAL_API_GET_CAPABILITIES
472020-01-25 15:27:30.850 Info, contrlr, Serial API Version: 4.32
482020-01-25 15:27:30.850 Info, contrlr, Manufacturer ID: 0x0000
492020-01-25 15:27:30.850 Info, contrlr, Product Type: 0x0001
502020-01-25 15:27:30.850 Info, contrlr, Product ID: 0x0001
512020-01-25 15:27:30.850 Detail, contrlr, Queuing (Command) FUNC_ID_ZW_GET_RANDOM: 0x01, 0x04, 0x00, 0x1c, 0x20, 0xc7
522020-01-25 15:27:30.850 Detail, contrlr, Queuing (Command) FUNC_ID_SERIAL_API_GET_INIT_DATA: 0x01, 0x03, 0x00, 0x02, 0xfe
532020-01-25 15:27:30.850 Detail, contrlr, Queuing (Command) FUNC_ID_SERIAL_API_SET_TIMEOUTS: 0x01, 0x05, 0x00, 0x06, 0x64, 0x0f, 0x97
542020-01-25 15:27:30.850 Detail, contrlr, Queuing (Command) FUNC_ID_SERIAL_API_APPL_NODE_INFORMATION: 0x01, 0x07, 0x00, 0x03, 0x01, 0x02, 0x01, 0x00, 0xf9
552020-01-25 15:27:30.850 Detail, Node032, Expected reply was received
562020-01-25 15:27:30.850 Detail, Node032, Message transaction complete
572020-01-25 15:27:30.850 Detail,
582020-01-25 15:27:30.850 Detail, contrlr, Removing current message
592020-01-25 15:27:30.850 Detail,
602020-01-25 15:27:30.850 Info, contrlr, Sending (Command) message (Callback ID=0x00, Expected Reply=0x56) - FUNC_ID_ZW_GET_SUC_NODE_ID: 0x01, 0x03, 0x00, 0x56, 0xaa
612020-01-25 15:27:30.852 Detail, contrlr, Received: 0x01, 0x04, 0x01, 0x56, 0x00, 0xac
622020-01-25 15:27:30.852 Detail,
632020-01-25 15:27:30.852 Info, contrlr, Received reply to GET_SUC_NODE_ID. Node ID = 0
642020-01-25 15:27:30.852 Info, Controller Does not Support SUC - Cannot Setup Controller as SUC Node
652020-01-25 15:27:30.852 Detail, Node172, Expected reply was received
662020-01-25 15:27:30.852 Detail, Node172, Message transaction complete
672020-01-25 15:27:30.852 Detail,
682020-01-25 15:27:30.852 Detail, contrlr, Removing current message
692020-01-25 15:27:30.852 Detail,
702020-01-25 15:27:30.852 Info, contrlr, Sending (Command) message (Callback ID=0x00, Expected Reply=0x1c) - FUNC_ID_ZW_GET_RANDOM: 0x01, 0x04, 0x00, 0x1c, 0x20, 0xc7
712020-01-25 15:27:30.906 Detail, contrlr, Received: 0x01, 0x25, 0x01, 0x1c, 0x01, 0x20, 0x1e, 0x3b, 0xfd, 0xa8, 0x46, 0x25, 0x22, 0xaf, 0xbc, 0xee, 0xa8, 0xbe, 0x2c, 0x4f, 0xf7, 0xb6, 0x7a, 0xdb, 0x92, 0x20, 0xea, 0xe9, 0xde, 0x1a, 0xd3, 0xe0, 0x47, 0x76, 0xb9, 0x97, 0x08, 0x89, 0x67
722020-01-25 15:27:30.906 Detail,
732020-01-25 15:27:30.906 Info, contrlr, Received reply to FUNC_ID_ZW_GET_RANDOM: true
742020-01-25 15:27:30.906 Detail, Node032, Expected reply was received
752020-01-25 15:27:30.906 Detail, Node032, Message transaction complete
762020-01-25 15:27:30.906 Detail,
772020-01-25 15:27:30.906 Detail, contrlr, Removing current message
782020-01-25 15:27:30.906 Detail,
792020-01-25 15:27:30.906 Info, contrlr, Sending (Command) message (Callback ID=0x00, Expected Reply=0x02) - FUNC_ID_SERIAL_API_GET_INIT_DATA: 0x01, 0x03, 0x00, 0x02, 0xfe
802020-01-25 15:27:30.963 Detail, contrlr, Received: 0x01, 0x25, 0x01, 0x02, 0x05, 0x00, 0x1d, 0x03, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x05, 0x00, 0xc7
812020-01-25 15:27:30.963 Detail,
822020-01-25 15:27:30.963 Info, mgr, Driver with Home ID of 0xd005e22e is now ready.
832020-01-25 15:27:30.963 Info,
842020-01-25 15:27:30.967 Detail, Node002, Queuing (Controller) Delete All Return Routes
852020-01-25 15:27:30.967 Detail, Node002, Queuing (Controller) Assign Return Route
862020-01-25 15:27:30.968 Info, contrlr, Received reply to FUNC_ID_SERIAL_API_GET_INIT_DATA:
872020-01-25 15:27:30.968 Info, contrlr, Node 001 - Known
882020-01-25 15:27:30.968 Detail, Node001, AdvanceQueries queryPending=0 queryRetries=0 queryStage=CacheLoad live=1
892020-01-25 15:27:30.968 Detail, Node001, QueryStage_CacheLoad
902020-01-25 15:27:30.968 Info, Node001, Node Identity Codes: 0000:0001:0001
912020-01-25 15:27:30.968 Detail, Node001, QueryStage_Associations
922020-01-25 15:27:30.968 Detail, Node001, QueryStage_Neighbors
932020-01-25 15:27:30.968 Detail, contrlr, Requesting routing info (neighbor list) for Node 1
942020-01-25 15:27:30.968 Detail, Node001, Queuing (Command) Get Routing Info (Node=1): 0x01, 0x07, 0x00, 0x80, 0x01, 0x00, 0x00, 0x03, 0x7a
952020-01-25 15:27:30.968 Detail, Node001, Queuing (Query) Query Stage Complete (Neighbors)
962020-01-25 15:27:30.969 Info, contrlr, Node 002 - Known
972020-01-25 15:27:30.969 Detail, Node002, AdvanceQueries queryPending=0 queryRetries=0 queryStage=CacheLoad live=1
982020-01-25 15:27:30.969 Detail, Node002, QueryStage_CacheLoad
992020-01-25 15:27:30.969 Info, Node002, Node Identity Codes: 0090:0003:0541
1002020-01-25 15:27:30.969 Info, Node002, NoOperation::Set - Routing=true
1012020-01-25 15:27:30.969 Detail, Node002, Queuing (NoOp) NoOperation_Set (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x00, 0x00, 0x25, 0x0a, 0xca
1022020-01-25 15:27:30.969 Detail, Node002, Queuing (Query) Query Stage Complete (CacheLoad)
1032020-01-25 15:27:30.969 Detail, Expected reply was received
1042020-01-25 15:27:30.969 Detail, Message transaction complete
1052020-01-25 15:27:30.969 Detail,
1062020-01-25 15:27:30.969 Detail, contrlr, Removing current message
1072020-01-25 15:27:30.969 Detail, Node001, Notification: DriverReady
1082020-01-25 15:27:30.978 Detail, Node001, Notification: NodeAdded
1092020-01-25 15:27:30.980 Detail, Node001, Notification: NodeProtocolInfo
1102020-01-25 15:27:30.980 Detail, Node001, Notification: EssentialNodeQueriesComplete
1112020-01-25 15:27:30.981 Detail, Node001, Notification: ValueAdded
1122020-01-25 15:27:30.981 Detail, Node002, Notification: NodeAdded
1132020-01-25 15:27:30.983 Detail, Node002, Notification: NodeProtocolInfo
1142020-01-25 15:27:30.983 Detail, Node002, Notification: EssentialNodeQueriesComplete
1152020-01-25 15:27:30.984 Detail, Node002, Notification: ValueAdded
1162020-01-25 15:27:30.984 Detail, Node002, Notification: ValueAdded
1172020-01-25 15:27:30.985 Detail, Node002, Notification: ValueAdded
1182020-01-25 15:27:30.985 Detail, Node002, Notification: ValueAdded
1192020-01-25 15:27:30.988 Detail, Node002, Notification: ValueAdded
1202020-01-25 15:27:30.990 Detail, Node002, Notification: ValueAdded
1212020-01-25 15:27:30.996 Detail, Node002, Notification: ValueAdded
1222020-01-25 15:27:30.997 Detail, Node002, Notification: ValueAdded
1232020-01-25 15:27:30.997 Detail, Node002, Notification: ValueAdded
1242020-01-25 15:27:30.998 Detail, Node002, Notification: ValueAdded
1252020-01-25 15:27:30.998 Detail, Node002, Notification: ValueAdded
1262020-01-25 15:27:30.999 Detail, Node002, Notification: ValueAdded
1272020-01-25 15:27:31.000 Detail, Node002, Notification: ValueAdded
1282020-01-25 15:27:31.001 Detail, Node002, Notification: ValueAdded
1292020-01-25 15:27:31.004 Detail, Node002, Notification: ValueAdded
1302020-01-25 15:27:31.007 Detail, Node002, Notification: ValueAdded
1312020-01-25 15:27:31.008 Detail, Node002, Notification: ValueAdded
1322020-01-25 15:27:31.009 Detail, Node002, Notification: ValueAdded
1332020-01-25 15:27:31.010 Detail, Node002, Notification: ValueAdded
1342020-01-25 15:27:31.011 Detail, Node002, Notification: ValueAdded
1352020-01-25 15:27:31.011 Detail, Node002, Notification: ValueAdded
1362020-01-25 15:27:31.012 Detail, Node002, Notification: ValueAdded
1372020-01-25 15:27:31.013 Detail, Node002, Notification: ValueAdded
1382020-01-25 15:27:31.014 Detail, Node002, Notification: ValueAdded
1392020-01-25 15:27:31.015 Detail, Node002, Notification: ValueAdded
1402020-01-25 15:27:31.016 Detail, Node002, Notification: ValueAdded
1412020-01-25 15:27:31.016 Detail, Node002, Notification: ValueAdded
1422020-01-25 15:27:31.018 Detail, Node002, Notification: ValueAdded
1432020-01-25 15:27:31.021 Detail, Node002, Notification: ValueAdded
1442020-01-25 15:27:31.022 Detail, Node002, Notification: ValueAdded
1452020-01-25 15:27:31.023 Detail, Node002, Notification: ValueAdded
1462020-01-25 15:27:31.024 Detail, Node002, Notification: ValueAdded
1472020-01-25 15:27:31.024 Detail, Node002, Notification: ValueAdded
1482020-01-25 15:27:31.025 Detail, Node002, Notification: ValueAdded
1492020-01-25 15:27:31.026 Detail, Node002, Notification: ValueAdded
1502020-01-25 15:27:31.026 Detail, Node002, Notification: ValueAdded
1512020-01-25 15:27:31.027 Detail, Node002, Notification: ValueAdded
1522020-01-25 15:27:31.028 Detail, Node002, Notification: ValueAdded
1532020-01-25 15:27:31.028 Detail, Node002, Notification: ValueAdded
1542020-01-25 15:27:31.029 Detail, Node002, Notification: ValueAdded
1552020-01-25 15:27:31.030 Detail, Node002, Notification: ValueAdded
1562020-01-25 15:27:31.030 Detail, Node002, Notification: ValueAdded
1572020-01-25 15:27:31.036 Detail, Node002, Notification: ValueAdded
1582020-01-25 15:27:31.042 Detail, Node002, Notification: ValueAdded
1592020-01-25 15:27:31.047 Detail, Node002, Notification: ValueAdded
1602020-01-25 15:27:31.053 Detail, Node002, Notification: ValueAdded
1612020-01-25 15:27:31.066 Detail, Node002, Notification: ValueAdded
1622020-01-25 15:27:31.080 Detail, Node002, Notification: ValueAdded
1632020-01-25 15:27:31.081 Detail, Node002, Notification: ValueAdded
1642020-01-25 15:27:31.081 Detail, Node002, Notification: ValueAdded
1652020-01-25 15:27:31.082 Detail, Node002, Notification: ValueAdded
1662020-01-25 15:27:31.083 Detail, Node002, Notification: ValueAdded
1672020-01-25 15:27:31.084 Detail, Node002, Notification: ValueAdded
1682020-01-25 15:27:31.084 Detail, Node002, Notification: ValueAdded
1692020-01-25 15:27:31.085 Detail, Node002, Notification: ValueAdded
1702020-01-25 15:27:31.086 Detail, Node002, Notification: ValueAdded
1712020-01-25 15:27:31.087 Detail, Node002, Notification: ValueAdded
1722020-01-25 15:27:31.090 Detail, Node002, Notification: Group
1732020-01-25 15:27:31.096 Detail, Node002, Notification: Group
1742020-01-25 15:27:31.096 Detail, Node002, Notification: ValueAdded
1752020-01-25 15:27:31.097 Detail, Node002, Notification: ValueAdded
1762020-01-25 15:27:31.097 Detail, Node002, Notification: ValueAdded
1772020-01-25 15:27:31.098 Detail, Node002, Notification: ValueAdded
1782020-01-25 15:27:31.099 Detail, Node002, Notification: NodeNaming
1792020-01-25 15:27:31.100 Detail,
1802020-01-25 15:27:31.100 Info, contrlr, Sending (Command) message (Callback ID=0x00, Expected Reply=0x06) - FUNC_ID_SERIAL_API_SET_TIMEOUTS: 0x01, 0x05, 0x00, 0x06, 0x64, 0x0f, 0x97
1812020-01-25 15:27:31.102 Detail, contrlr, Received: 0x01, 0x05, 0x01, 0x06, 0x64, 0x0f, 0x96
1822020-01-25 15:27:31.102 Detail,
1832020-01-25 15:27:31.102 Info, contrlr, Received reply to FUNC_ID_SERIAL_API_SET_TIMEOUTS
1842020-01-25 15:27:31.102 Detail, Node015, Expected reply was received
1852020-01-25 15:27:31.102 Detail, Node015, Message transaction complete
1862020-01-25 15:27:31.102 Detail,
1872020-01-25 15:27:31.102 Detail, contrlr, Removing current message
1882020-01-25 15:27:31.102 Detail,
1892020-01-25 15:27:31.102 Info, contrlr, Sending (Command) message (Callback ID=0x00, Expected Reply=0x00) - FUNC_ID_SERIAL_API_APPL_NODE_INFORMATION: 0x01, 0x07, 0x00, 0x03, 0x01, 0x02, 0x01, 0x00, 0xf9
1902020-01-25 15:27:31.104 Detail, contrlr, Removing current message
1912020-01-25 15:27:31.104 Detail,
1922020-01-25 15:27:31.104 Info, Node001, Sending (Command) message (Callback ID=0x00, Expected Reply=0x80) - Get Routing Info (Node=1): 0x01, 0x07, 0x00, 0x80, 0x01, 0x00, 0x00, 0x03, 0x7a
1932020-01-25 15:27:31.109 Detail, Node001, Received: 0x01, 0x20, 0x01, 0x80, 0x02, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x5c
1942020-01-25 15:27:31.109 Detail,
1952020-01-25 15:27:31.109 Info, Node001, Received reply to FUNC_ID_ZW_GET_ROUTING_INFO
1962020-01-25 15:27:31.109 Info, Node001, Neighbors of this node are:
1972020-01-25 15:27:31.109 Info, Node001, Node 2
1982020-01-25 15:27:31.109 Detail, Expected reply was received
1992020-01-25 15:27:31.109 Detail, Message transaction complete
2002020-01-25 15:27:31.110 Detail,
2012020-01-25 15:27:31.110 Detail, Node001, Removing current message
2022020-01-25 15:27:31.110 Detail,
2032020-01-25 15:27:31.110 Info, Node002, Sending (NoOp) message (Callback ID=0x0a, Expected Reply=0x13) - NoOperation_Set (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x00, 0x00, 0x25, 0x0a, 0xca
2042020-01-25 15:27:31.115 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
2052020-01-25 15:27:31.132 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
2062020-01-25 15:27:32.332 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x0a, 0x00, 0xe3
2072020-01-25 15:27:32.332 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x0a received (expected 0x0a)
2082020-01-25 15:27:32.332 Info, Node002, Request RTT 1222 Average Request RTT 1222
2092020-01-25 15:27:32.332 Detail, Expected callbackId was received
2102020-01-25 15:27:32.332 Detail, Expected reply was received
2112020-01-25 15:27:32.332 Detail, Message transaction complete
2122020-01-25 15:27:32.332 Detail,
2132020-01-25 15:27:32.332 Detail, Node002, Removing current message
2142020-01-25 15:27:32.332 Detail, Node002, Notification: Notification - NoOperation
2152020-01-25 15:27:32.336 Info, Deleting all return routes from node 2
2162020-01-25 15:27:32.336 Detail, Node002, Queuing (Command) ControllerCommand_DeleteAllReturnRoutess (Node=2): 0x01, 0x05, 0x00, 0x47, 0x02, 0x0b, 0xb4
2172020-01-25 15:27:32.336 Detail, Notification: ControllerCommand - Starting
2182020-01-25 15:27:32.336 Detail,
2192020-01-25 15:27:32.336 Info, Node002, Sending (Command) message (Callback ID=0x0b, Expected Reply=0x47) - ControllerCommand_DeleteAllReturnRoutess (Node=2): 0x01, 0x05, 0x00, 0x47, 0x02, 0x0b, 0xb4
2202020-01-25 15:27:32.341 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x47, 0x01, 0xbc
2212020-01-25 15:27:32.348 Detail,
2222020-01-25 15:27:32.348 Info, Node002, Received reply to FUNC_ID_ZW_DELETE_RETURN_ROUTE - command in progress
2232020-01-25 15:27:32.348 Detail, Notification: ControllerCommand - InProgress
2242020-01-25 15:27:32.454 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x47, 0x0b, 0x00, 0xb6
2252020-01-25 15:27:32.454 Detail,
2262020-01-25 15:27:32.454 Info, Node002, Received reply to FUNC_ID_ZW_DELETE_RETURN_ROUTE for node 2 - SUCCESS
2272020-01-25 15:27:32.454 Detail, Expected callbackId was received
2282020-01-25 15:27:32.454 Detail, Expected reply was received
2292020-01-25 15:27:32.454 Detail, Message transaction complete
2302020-01-25 15:27:32.454 Detail,
2312020-01-25 15:27:32.454 Detail, Node002, Removing current message
2322020-01-25 15:27:32.454 Detail, Notification: ControllerCommand - Completed
2332020-01-25 15:27:32.459 Info, Assigning return route from node 2 to node 1
2342020-01-25 15:27:32.459 Detail, Node002, Queuing (Command) ControllerCommand_AssignReturnRoute (Node=2): 0x01, 0x06, 0x00, 0x46, 0x02, 0x01, 0x0c, 0xb0
2352020-01-25 15:27:32.459 Detail, Notification: ControllerCommand - Starting
2362020-01-25 15:27:32.459 Detail,
2372020-01-25 15:27:32.459 Info, Node002, Sending (Command) message (Callback ID=0x0c, Expected Reply=0x46) - ControllerCommand_AssignReturnRoute (Node=2): 0x01, 0x06, 0x00, 0x46, 0x02, 0x01, 0x0c, 0xb0
2382020-01-25 15:27:32.466 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x46, 0x01, 0xbd
2392020-01-25 15:27:32.466 Detail,
2402020-01-25 15:27:32.466 Info, Node002, Received reply to FUNC_ID_ZW_ASSIGN_RETURN_ROUTE - command in progress
2412020-01-25 15:27:32.466 Detail, Notification: ControllerCommand - InProgress
2422020-01-25 15:27:32.624 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x46, 0x0c, 0x00, 0xb0
2432020-01-25 15:27:32.624 Detail,
2442020-01-25 15:27:32.624 Info, Node002, Received reply to FUNC_ID_ZW_ASSIGN_RETURN_ROUTE for node 2 - SUCCESS
2452020-01-25 15:27:32.624 Detail, Expected callbackId was received
2462020-01-25 15:27:32.624 Detail, Expected reply was received
2472020-01-25 15:27:32.624 Detail, Message transaction complete
2482020-01-25 15:27:32.624 Detail,
2492020-01-25 15:27:32.624 Detail, Node002, Removing current message
2502020-01-25 15:27:32.625 Detail, Notification: ControllerCommand - Completed
2512020-01-25 15:27:32.625 Detail, Node001, Query Stage Complete (Neighbors)
2522020-01-25 15:27:32.625 Detail, Node001, AdvanceQueries queryPending=0 queryRetries=0 queryStage=Session live=1
2532020-01-25 15:27:32.625 Detail, Node001, QueryStage_Session
2542020-01-25 15:27:32.625 Detail, Node001, QueryStage_Dynamic
2552020-01-25 15:27:32.625 Detail, Node001, QueryStage_Configuration
2562020-01-25 15:27:32.625 Detail, Node001, QueryStage_Complete
2572020-01-25 15:27:32.625 Warning, CheckCompletedNodeQueries m_allNodesQueried=0 m_awakeNodesQueried=0
2582020-01-25 15:27:32.625 Warning, CheckCompletedNodeQueries all=0, deadFound=0 sleepingOnly=1
2592020-01-25 15:27:32.625 Info, Node query processing complete except for sleeping nodes.
2602020-01-25 15:27:32.625 Detail, Node001, Notification: NodeQueriesComplete
2612020-01-25 15:27:32.626 Detail, contrlr, Notification: AwakeNodesQueried
2622020-01-25 15:27:32.628 Detail, Node002, Query Stage Complete (CacheLoad)
2632020-01-25 15:27:32.628 Detail, Node002, AdvanceQueries queryPending=0 queryRetries=0 queryStage=Associations live=1
2642020-01-25 15:27:32.628 Detail, Node002, QueryStage_Associations
2652020-01-25 15:27:32.628 Info, Node002, Number of association groups reported for node 2 is 2.
2662020-01-25 15:27:32.628 Info, Node002, Get Associations for group 1 of node 2
2672020-01-25 15:27:32.628 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_ASSOCIATION
2682020-01-25 15:27:32.628 Detail, Node002, Queuing (Send) AssociationCmd_Get (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x85, 0x02, 0x01, 0x25, 0x0d, 0x49
2692020-01-25 15:27:32.629 Detail, Node002, Queuing (Query) Query Stage Complete (Associations)
2702020-01-25 15:27:32.629 Detail,
2712020-01-25 15:27:32.629 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x0d, Expected Reply=0x04)
2722020-01-25 15:27:32.629 Info, Node002, Sending (Send) message (Callback ID=0x0d, Expected Reply=0x04) - Nonce_Get(AssociationCmd_Get) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
2732020-01-25 15:27:32.634 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
2742020-01-25 15:27:32.634 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
2752020-01-25 15:27:32.653 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
2762020-01-25 15:27:32.653 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
2772020-01-25 15:27:32.653 Info, Node002, Request RTT 24 Average Request RTT 623
2782020-01-25 15:27:32.668 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0xf3, 0x50, 0xe3, 0x1a, 0x10, 0x26, 0xb7, 0x82, 0xa2
2792020-01-25 15:27:32.668 Info, Node002, Received SecurityCmd_NonceReport from node 2
2802020-01-25 15:27:32.668 Info, Node002, Sending (Send) message (Callback ID=0x0e, Expected Reply=0x04) - AssociationCmd_Get (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x85, 0x02, 0x01, 0x25, 0x0e, 0x4a
2812020-01-25 15:27:32.676 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
2822020-01-25 15:27:32.677 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
2832020-01-25 15:27:32.700 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x0e, 0x00, 0xe7
2842020-01-25 15:27:32.703 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x0e received (expected 0x0e)
2852020-01-25 15:27:32.703 Info, Node002, Request RTT 74 Average Request RTT 348
2862020-01-25 15:27:32.703 Detail, Expected callbackId was received
2872020-01-25 15:27:42.629 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
2882020-01-25 15:27:42.629 Detail, Node002, Removing current message
2892020-01-25 15:27:42.629 Detail, Node002, Notification: Notification - TimeOut
2902020-01-25 15:27:42.631 Detail, Node002, Query Stage Complete (Associations)
2912020-01-25 15:27:42.631 Detail, Node002, AdvanceQueries queryPending=0 queryRetries=0 queryStage=Neighbors live=1
2922020-01-25 15:27:42.631 Detail, Node002, QueryStage_Neighbors
2932020-01-25 15:27:42.631 Detail, Requesting routing info (neighbor list) for Node 2
2942020-01-25 15:27:42.631 Detail, Node002, Queuing (Command) Get Routing Info (Node=2): 0x01, 0x07, 0x00, 0x80, 0x02, 0x00, 0x00, 0x03, 0x79
2952020-01-25 15:27:42.631 Detail, Node002, Queuing (Query) Query Stage Complete (Neighbors)
2962020-01-25 15:27:42.631 Detail,
2972020-01-25 15:27:42.631 Info, Node002, Sending (Command) message (Callback ID=0x00, Expected Reply=0x80) - Get Routing Info (Node=2): 0x01, 0x07, 0x00, 0x80, 0x02, 0x00, 0x00, 0x03, 0x79
2982020-01-25 15:27:42.636 Detail, Node002, Received: 0x01, 0x20, 0x01, 0x80, 0x01, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x5f
2992020-01-25 15:27:42.656 Detail,
3002020-01-25 15:27:42.656 Info, Node002, Received reply to FUNC_ID_ZW_GET_ROUTING_INFO
3012020-01-25 15:27:42.656 Info, Node002, Neighbors of this node are:
3022020-01-25 15:27:42.656 Info, Node002, Node 1
3032020-01-25 15:27:42.656 Detail, Expected reply was received
3042020-01-25 15:27:42.656 Detail, Message transaction complete
3052020-01-25 15:27:42.656 Detail,
3062020-01-25 15:27:42.656 Detail, Node002, Removing current message
3072020-01-25 15:27:42.656 Detail, Node002, Query Stage Complete (Neighbors)
3082020-01-25 15:27:42.656 Detail, Node002, AdvanceQueries queryPending=0 queryRetries=0 queryStage=Session live=1
3092020-01-25 15:27:42.656 Detail, Node002, QueryStage_Session
3102020-01-25 15:27:42.656 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_USER_CODE
3112020-01-25 15:27:42.656 Detail, Node002, Queuing (Query) UserCodeCmd_Get (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x63, 0x02, 0x01, 0x25, 0x0f, 0xad
3122020-01-25 15:27:42.656 Detail, Node002, Queuing (Query) PowerlevelCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x73, 0x02, 0x25, 0x10, 0xa1
3132020-01-25 15:27:42.656 Detail, Node002, Queuing (Query) Query Stage Complete (Session)
3142020-01-25 15:27:42.656 Detail,
3152020-01-25 15:27:42.656 Info, Node002, Processing (Query) Nonce Request message (Callback ID=0x0f, Expected Reply=0x04)
3162020-01-25 15:27:42.656 Info, Node002, Sending (Query) message (Callback ID=0x0f, Expected Reply=0x04) - Nonce_Get(UserCodeCmd_Get) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
3172020-01-25 15:27:42.662 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
3182020-01-25 15:27:42.662 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
3192020-01-25 15:27:43.906 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
3202020-01-25 15:27:43.906 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
3212020-01-25 15:27:43.907 Info, Node002, Request RTT 1250 Average Request RTT 799
3222020-01-25 15:27:43.921 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0xff, 0x72, 0x05, 0xf7, 0x0b, 0xe5, 0xd8, 0xe1, 0x53
3232020-01-25 15:27:43.921 Info, Node002, Received SecurityCmd_NonceReport from node 2
3242020-01-25 15:27:43.921 Info, Node002, Sending (Query) message (Callback ID=0x11, Expected Reply=0x04) - UserCodeCmd_Get (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x63, 0x02, 0x01, 0x25, 0x11, 0xb3
3252020-01-25 15:27:43.930 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
3262020-01-25 15:27:43.930 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
3272020-01-25 15:27:43.953 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x11, 0x00, 0xf8
3282020-01-25 15:27:44.289 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x11 received (expected 0x11)
3292020-01-25 15:27:44.289 Info, Node002, Request RTT 1633 Average Request RTT 1216
3302020-01-25 15:27:44.289 Detail, Expected callbackId was received
3312020-01-25 15:27:52.656 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
3322020-01-25 15:27:52.656 Detail, Node002, Removing current message
3332020-01-25 15:27:52.656 Detail, Node002, Notification: Notification - TimeOut
3342020-01-25 15:27:52.658 Detail,
3352020-01-25 15:27:52.658 Info, Node002, Sending (Query) message (Callback ID=0x10, Expected Reply=0x04) - PowerlevelCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x73, 0x02, 0x25, 0x10, 0xa1
3362020-01-25 15:27:52.664 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
3372020-01-25 15:27:52.664 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
3382020-01-25 15:27:53.924 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x10, 0x00, 0xf9
3392020-01-25 15:27:53.924 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x10 received (expected 0x10)
3402020-01-25 15:27:53.924 Info, Node002, Request RTT 1266 Average Request RTT 1241
3412020-01-25 15:27:53.924 Detail, Expected callbackId was received
3422020-01-25 15:27:53.936 Detail, Node002, Received: 0x01, 0x0a, 0x00, 0x04, 0x00, 0x02, 0x04, 0x73, 0x03, 0x00, 0x00, 0x87
3432020-01-25 15:27:53.936 Detail,
3442020-01-25 15:27:53.936 Info, Node002, Response RTT 1278 Average Response RTT 1278
3452020-01-25 15:27:53.936 Info, Node002, Received a PowerLevel report: PowerLevel=Normal, Timeout=0
3462020-01-25 15:27:53.936 Detail, Node002, Initial read of value
3472020-01-25 15:27:53.937 Detail, Node002, Initial read of value
3482020-01-25 15:27:53.937 Detail, Node002, Expected reply and command class was received
3492020-01-25 15:27:53.937 Detail, Node002, Message transaction complete
3502020-01-25 15:27:53.937 Detail,
3512020-01-25 15:27:53.937 Detail, Node002, Removing current message
3522020-01-25 15:27:53.937 Detail, Node002, Notification: ValueChanged
3532020-01-25 15:27:53.940 Detail, Node002, Notification: ValueChanged
3542020-01-25 15:27:53.944 Detail, Node002, Query Stage Complete (Session)
3552020-01-25 15:27:53.945 Detail, Node002, AdvanceQueries queryPending=0 queryRetries=0 queryStage=Dynamic live=1
3562020-01-25 15:27:53.945 Detail, Node002, QueryStage_Dynamic
3572020-01-25 15:27:53.945 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_DOOR_LOCK
3582020-01-25 15:27:53.945 Detail, Node002, Queuing (Send) DoorLockCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x62, 0x02, 0x25, 0x12, 0xb2
3592020-01-25 15:27:53.945 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_ALARM
3602020-01-25 15:27:53.945 Detail, Node002, Queuing (Send) AlarmCmd_Get (Node=2): 0x01, 0x0c, 0x00, 0x13, 0x02, 0x05, 0x71, 0x04, 0x00, 0x06, 0x01, 0x25, 0x13, 0xa3
3612020-01-25 15:27:53.945 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_ALARM
3622020-01-25 15:27:53.945 Detail, Node002, Queuing (Send) AlarmCmd_Get (Node=2): 0x01, 0x0c, 0x00, 0x13, 0x02, 0x05, 0x71, 0x04, 0x00, 0x08, 0x01, 0x25, 0x14, 0xaa
3632020-01-25 15:27:53.945 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_BATTERY
3642020-01-25 15:27:53.945 Detail, Node002, Queuing (Send) BatteryCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x80, 0x02, 0x25, 0x15, 0x57
3652020-01-25 15:27:53.945 Detail, Node002, Queuing (Query) Query Stage Complete (Dynamic)
3662020-01-25 15:27:53.945 Detail,
3672020-01-25 15:27:53.946 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x12, Expected Reply=0x04)
3682020-01-25 15:27:53.946 Info, Node002, Sending (Send) message (Callback ID=0x12, Expected Reply=0x04) - Nonce_Get(DoorLockCmd_Get) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
3692020-01-25 15:27:53.951 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
3702020-01-25 15:27:53.951 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
3712020-01-25 15:27:53.970 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
3722020-01-25 15:27:53.970 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
3732020-01-25 15:27:53.970 Info, Node002, Request RTT 24 Average Request RTT 632
3742020-01-25 15:27:53.985 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0x9b, 0xd0, 0x5f, 0x00, 0xbb, 0xbd, 0xc7, 0x73, 0x5d
3752020-01-25 15:27:53.985 Info, Node002, Received SecurityCmd_NonceReport from node 2
3762020-01-25 15:27:53.985 Info, Node002, Sending (Send) message (Callback ID=0x16, Expected Reply=0x04) - DoorLockCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x62, 0x02, 0x25, 0x16, 0xb6
3772020-01-25 15:27:53.994 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
3782020-01-25 15:27:53.994 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
3792020-01-25 15:27:54.017 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x16, 0x00, 0xff
3802020-01-25 15:27:54.017 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x16 received (expected 0x16)
3812020-01-25 15:27:54.017 Info, Node002, Request RTT 72 Average Request RTT 352
3822020-01-25 15:27:54.017 Detail, Expected callbackId was received
3832020-01-25 15:28:03.945 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
3842020-01-25 15:28:03.945 Detail, Node002, Removing current message
3852020-01-25 15:28:03.946 Detail, Node002, Notification: Notification - TimeOut
3862020-01-25 15:28:03.948 Detail,
3872020-01-25 15:28:03.948 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x13, Expected Reply=0x04)
3882020-01-25 15:28:03.949 Info, Node002, Sending (Send) message (Callback ID=0x13, Expected Reply=0x04) - Nonce_Get(AlarmCmd_Get) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
3892020-01-25 15:28:03.954 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
3902020-01-25 15:28:03.954 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
3912020-01-25 15:28:05.259 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
3922020-01-25 15:28:05.259 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
3932020-01-25 15:28:05.259 Info, Node002, Request RTT 1311 Average Request RTT 831
3942020-01-25 15:28:05.273 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0x33, 0xee, 0x44, 0x0c, 0x3a, 0xd9, 0xc7, 0x14, 0x5e
3952020-01-25 15:28:05.292 Info, Node002, Received SecurityCmd_NonceReport from node 2
3962020-01-25 15:28:05.292 Info, Node002, Sending (Send) message (Callback ID=0x17, Expected Reply=0x04) - AlarmCmd_Get (Node=2): 0x01, 0x0c, 0x00, 0x13, 0x02, 0x05, 0x71, 0x04, 0x00, 0x06, 0x01, 0x25, 0x17, 0xa7
3972020-01-25 15:28:05.300 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
3982020-01-25 15:28:05.300 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
3992020-01-25 15:28:05.324 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x17, 0x00, 0xfe
4002020-01-25 15:28:05.324 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x17 received (expected 0x17)
4012020-01-25 15:28:05.324 Info, Node002, Request RTT 1376 Average Request RTT 1103
4022020-01-25 15:28:05.324 Detail, Expected callbackId was received
4032020-01-25 15:28:13.948 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
4042020-01-25 15:28:13.948 Detail, Node002, Removing current message
4052020-01-25 15:28:13.948 Detail, Node002, Notification: Notification - TimeOut
4062020-01-25 15:28:13.950 Detail,
4072020-01-25 15:28:13.950 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x14, Expected Reply=0x04)
4082020-01-25 15:28:13.950 Info, Node002, Sending (Send) message (Callback ID=0x14, Expected Reply=0x04) - Nonce_Get(AlarmCmd_Get) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
4092020-01-25 15:28:13.955 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
4102020-01-25 15:28:13.955 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
4112020-01-25 15:28:15.170 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
4122020-01-25 15:28:15.170 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
4132020-01-25 15:28:15.170 Info, Node002, Request RTT 1221 Average Request RTT 1162
4142020-01-25 15:28:15.185 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0xb6, 0x23, 0x8d, 0x4f, 0xee, 0x52, 0x34, 0x03, 0x27
4152020-01-25 15:28:15.185 Info, Node002, Received SecurityCmd_NonceReport from node 2
4162020-01-25 15:28:15.185 Info, Node002, Sending (Send) message (Callback ID=0x18, Expected Reply=0x04) - AlarmCmd_Get (Node=2): 0x01, 0x0c, 0x00, 0x13, 0x02, 0x05, 0x71, 0x04, 0x00, 0x08, 0x01, 0x25, 0x18, 0xa6
4172020-01-25 15:28:15.193 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
4182020-01-25 15:28:15.208 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
4192020-01-25 15:28:15.220 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x18, 0x00, 0xf1
4202020-01-25 15:28:15.229 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x18 received (expected 0x18)
4212020-01-25 15:28:15.229 Info, Node002, Request RTT 1279 Average Request RTT 1220
4222020-01-25 15:28:15.229 Detail, Expected callbackId was received
4232020-01-25 15:28:23.950 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
4242020-01-25 15:28:24.293 Detail, Node002, Removing current message
4252020-01-25 15:28:24.293 Detail, Node002, Notification: Notification - TimeOut
4262020-01-25 15:28:24.295 Detail,
4272020-01-25 15:28:24.295 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x15, Expected Reply=0x04)
4282020-01-25 15:28:24.295 Info, Node002, Sending (Send) message (Callback ID=0x15, Expected Reply=0x04) - Nonce_Get(BatteryCmd_Get) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
4292020-01-25 15:28:24.300 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
4302020-01-25 15:28:24.300 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
4312020-01-25 15:28:25.575 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
4322020-01-25 15:28:25.575 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
4332020-01-25 15:28:25.575 Info, Node002, Request RTT 1280 Average Request RTT 1250
4342020-01-25 15:28:25.590 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0xaa, 0x8b, 0x77, 0x43, 0x6d, 0xbe, 0x65, 0xc2, 0x9a
4352020-01-25 15:28:25.590 Info, Node002, Received SecurityCmd_NonceReport from node 2
4362020-01-25 15:28:25.590 Info, Node002, Sending (Send) message (Callback ID=0x19, Expected Reply=0x04) - BatteryCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x80, 0x02, 0x25, 0x19, 0x5b
4372020-01-25 15:28:25.598 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
4382020-01-25 15:28:25.598 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
4392020-01-25 15:28:25.622 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x19, 0x00, 0xf0
4402020-01-25 15:28:25.622 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x19 received (expected 0x19)
4412020-01-25 15:28:25.622 Info, Node002, Request RTT 1327 Average Request RTT 1288
4422020-01-25 15:28:25.622 Detail, Expected callbackId was received
4432020-01-25 15:28:34.295 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
4442020-01-25 15:28:34.295 Detail, Node002, Removing current message
4452020-01-25 15:28:34.295 Detail, Node002, Notification: Notification - TimeOut
4462020-01-25 15:28:34.297 Detail, Node002, Query Stage Complete (Dynamic)
4472020-01-25 15:28:34.297 Detail, Node002, AdvanceQueries queryPending=0 queryRetries=0 queryStage=Configuration live=1
4482020-01-25 15:28:34.297 Detail, Node002, QueryStage_Configuration
4492020-01-25 15:28:34.297 Detail, Node002, QueryStage_Complete
4502020-01-25 15:28:34.297 Warning, CheckCompletedNodeQueries m_allNodesQueried=0 m_awakeNodesQueried=1
4512020-01-25 15:28:34.297 Warning, CheckCompletedNodeQueries all=1, deadFound=0 sleepingOnly=1
4522020-01-25 15:28:34.297 Info, Node query processing complete.
4532020-01-25 15:28:34.297 Detail, Node002, Notification: NodeQueriesComplete
4542020-01-25 15:28:34.298 Detail, contrlr, Notification: AllNodesQueried
4552020-01-25 16:30:31.271 Detail, Node002, Received: 0x01, 0x08, 0x00, 0x04, 0x00, 0x02, 0x02, 0x98, 0x40, 0x2b
4562020-01-25 16:30:31.271 Info, Node002, Received SecurityCmd_NonceGet from node 2
4572020-01-25 16:30:31.271 Info, NONCES: 0xfd, 0xf1, 0xc5, 0x6e, 0xba, 0x66, 0x6f, 0xe9
4582020-01-25 16:30:31.271 Info, NONCES: 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00
4592020-01-25 16:30:31.271 Info, NONCES: 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00
4602020-01-25 16:30:31.271 Info, NONCES: 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00
4612020-01-25 16:30:31.271 Info, NONCES: 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00
4622020-01-25 16:30:31.271 Info, NONCES: 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00
4632020-01-25 16:30:31.272 Info, NONCES: 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00
4642020-01-25 16:30:31.272 Info, NONCES: 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00
4652020-01-25 16:30:31.272 Info, Node002, Sending (Send) message (Callback ID=0x01, Expected Reply=0x00) - Nonce_Report - 0x01, 0x11, 0x00, 0x13, 0x02, 0x0a, 0x98, 0x80, 0xfd, 0xf1, 0xc5, 0x6e, 0xba, 0x66, 0x6f, 0xe9, 0x05, 0x01, 0x14:
4662020-01-25 16:30:31.279 Detail, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
4672020-01-25 16:30:31.279 Detail, ZW_SEND_DATA delivered to Z-Wave stack
4682020-01-25 16:30:32.530 Detail, Received: 0x01, 0x05, 0x00, 0x13, 0x01, 0x00, 0xe8
4692020-01-25 16:30:32.530 Detail, ZW_SEND_DATA Request with callback ID 0x01 received (expected 0x01)
4702020-01-25 16:30:32.550 Detail, Node002, Received: 0x01, 0x24, 0x00, 0x04, 0x00, 0x02, 0x1e, 0x98, 0x81, 0xe5, 0x49, 0x35, 0xc2, 0x84, 0x2f, 0xbd, 0x35, 0xab, 0x2b, 0x25, 0x7d, 0x29, 0x1b, 0xa2, 0x43, 0xac, 0xf7, 0x19, 0xfd, 0xd1, 0x1a, 0xa7, 0x73, 0xda, 0x6f, 0x6d, 0x59, 0x88
4712020-01-25 16:30:32.551 Info, Raw: 0x98, 0x81, 0xe5, 0x49, 0x35, 0xc2, 0x84, 0x2f, 0xbd, 0x35, 0xab, 0x2b, 0x25, 0x7d, 0x29, 0x1b, 0xa2, 0x43, 0xac, 0xf7, 0x19, 0xfd, 0xd1, 0x1a, 0xa7, 0x73, 0xda, 0x6f, 0x6d, 0x59, 0x88
4722020-01-25 16:30:32.551 Detail, Node002, Decrypted Packet: 0xc5, 0x74, 0xbb, 0x1d, 0x5d, 0xe2, 0xf1, 0xa3, 0xe9, 0x54, 0x63
4732020-01-25 16:30:32.551 Warning, Node002, MAC Authentication of Packet Failed. Dropping
4742020-01-25 16:30:32.551 Detail, Removing current message
4752020-01-25 20:13:26.312 Info, Node002, Value::Set - COMMAND_CLASS_DOOR_LOCK - Locked - 0 - 1 - False
4762020-01-25 20:13:26.312 Info, Node002, Value_Lock::Set - Requesting lock to be Unlocked
4772020-01-25 20:13:26.312 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_DOOR_LOCK
4782020-01-25 20:13:26.312 Detail, Node002, Queuing (Send) DoorLockCmd_Set (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x62, 0x01, 0x00, 0x25, 0x1a, 0xbb
4792020-01-25 20:13:26.312 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_DOOR_LOCK
4802020-01-25 20:13:26.312 Detail, Node002, Queuing (Send) DoorLockCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x62, 0x02, 0x25, 0x1b, 0xbb
4812020-01-25 20:13:26.312 Detail,
4822020-01-25 20:13:26.312 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x1a, Expected Reply=0x04)
4832020-01-25 20:13:26.312 Info, Node002, Sending (Send) message (Callback ID=0x1a, Expected Reply=0x04) - Nonce_Get(DoorLockCmd_Set) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
4842020-01-25 20:13:26.318 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
4852020-01-25 20:13:26.328 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
4862020-01-25 20:13:27.563 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
4872020-01-25 20:13:27.563 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
4882020-01-25 20:13:27.563 Info, Node002, Request RTT 1250 Average Request RTT 1269
4892020-01-25 20:13:27.577 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0x3c, 0x9a, 0xc0, 0xe6, 0x02, 0xd2, 0x91, 0x79, 0x43
4902020-01-25 20:13:27.577 Info, Node002, Received SecurityCmd_NonceReport from node 2
4912020-01-25 20:13:27.577 Info, Node002, Sending (Send) message (Callback ID=0x1c, Expected Reply=0x04) - DoorLockCmd_Set (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x62, 0x01, 0x00, 0x25, 0x1c, 0xbd
4922020-01-25 20:13:27.586 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
4932020-01-25 20:13:27.586 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
4942020-01-25 20:13:27.609 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x1c, 0x00, 0xf5
4952020-01-25 20:13:27.609 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x1c received (expected 0x1c)
4962020-01-25 20:13:27.609 Info, Node002, Request RTT 1296 Average Request RTT 1282
4972020-01-25 20:13:27.609 Detail, Expected callbackId was received
4982020-01-25 20:13:36.313 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
4992020-01-25 20:13:36.314 Detail, Node002, Removing current message
5002020-01-25 20:13:36.314 Detail, Node002, Notification: Notification - TimeOut
5012020-01-25 20:13:36.315 Detail,
5022020-01-25 20:13:36.315 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x1b, Expected Reply=0x04)
5032020-01-25 20:13:36.315 Info, Node002, Sending (Send) message (Callback ID=0x1b, Expected Reply=0x04) - Nonce_Get(DoorLockCmd_Get) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
5042020-01-25 20:13:36.321 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
5052020-01-25 20:13:36.321 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
5062020-01-25 20:13:37.595 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
5072020-01-25 20:13:37.595 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
5082020-01-25 20:13:37.596 Info, Node002, Request RTT 1280 Average Request RTT 1281
5092020-01-25 20:13:37.610 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0xba, 0x96, 0xbd, 0xda, 0xd6, 0x46, 0x54, 0x2a, 0x5e
5102020-01-25 20:13:37.610 Info, Node002, Received SecurityCmd_NonceReport from node 2
5112020-01-25 20:13:37.610 Info, Node002, Sending (Send) message (Callback ID=0x1d, Expected Reply=0x04) - DoorLockCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x62, 0x02, 0x25, 0x1d, 0xbd
5122020-01-25 20:13:37.619 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
5132020-01-25 20:13:37.619 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
5142020-01-25 20:13:37.642 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x1d, 0x00, 0xf4
5152020-01-25 20:13:37.642 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x1d received (expected 0x1d)
5162020-01-25 20:13:37.642 Info, Node002, Request RTT 1326 Average Request RTT 1303
5172020-01-25 20:13:37.642 Detail, Expected callbackId was received
5182020-01-25 20:13:46.316 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
5192020-01-25 20:13:46.316 Detail, Node002, Removing current message
5202020-01-25 20:13:46.316 Detail, Node002, Notification: Notification - TimeOut
5212020-01-25 20:14:06.047 Info, Node002, Value::Set - COMMAND_CLASS_DOOR_LOCK - Locked - 0 - 1 - False
5222020-01-25 20:14:06.048 Info, Node002, Value_Lock::Set - Requesting lock to be Unlocked
5232020-01-25 20:14:06.048 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_DOOR_LOCK
5242020-01-25 20:14:06.048 Detail, Node002, Queuing (Send) DoorLockCmd_Set (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x62, 0x01, 0x00, 0x25, 0x1e, 0xbf
5252020-01-25 20:14:06.048 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_DOOR_LOCK
5262020-01-25 20:14:06.048 Detail, Node002, Queuing (Send) DoorLockCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x62, 0x02, 0x25, 0x1f, 0xbf
5272020-01-25 20:14:06.048 Detail,
5282020-01-25 20:14:06.048 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x1e, Expected Reply=0x04)
5292020-01-25 20:14:06.048 Info, Node002, Sending (Send) message (Callback ID=0x1e, Expected Reply=0x04) - Nonce_Get(DoorLockCmd_Set) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
5302020-01-25 20:14:06.053 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
5312020-01-25 20:14:06.053 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
5322020-01-25 20:14:07.328 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
5332020-01-25 20:14:07.328 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
5342020-01-25 20:14:07.328 Info, Node002, Request RTT 1280 Average Request RTT 1291
5352020-01-25 20:14:07.343 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0xbf, 0x37, 0x23, 0x06, 0xd1, 0x0b, 0x72, 0x41, 0xbf
5362020-01-25 20:14:07.343 Info, Node002, Received SecurityCmd_NonceReport from node 2
5372020-01-25 20:14:07.343 Info, Node002, Sending (Send) message (Callback ID=0x20, Expected Reply=0x04) - DoorLockCmd_Set (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x62, 0x01, 0x00, 0x25, 0x20, 0x81
5382020-01-25 20:14:07.352 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
5392020-01-25 20:14:07.352 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
5402020-01-25 20:14:07.375 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x20, 0x00, 0xc9
5412020-01-25 20:14:07.375 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x20 received (expected 0x20)
5422020-01-25 20:14:07.375 Info, Node002, Request RTT 1327 Average Request RTT 1309
5432020-01-25 20:14:07.376 Detail, Expected callbackId was received
5442020-01-25 20:14:16.049 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
5452020-01-25 20:14:16.049 Detail, Node002, Removing current message
5462020-01-25 20:14:16.049 Detail, Node002, Notification: Notification - TimeOut
5472020-01-25 20:14:16.050 Detail,
5482020-01-25 20:14:16.050 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x1f, Expected Reply=0x04)
5492020-01-25 20:14:16.050 Info, Node002, Sending (Send) message (Callback ID=0x1f, Expected Reply=0x04) - Nonce_Get(DoorLockCmd_Get) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
5502020-01-25 20:14:16.056 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
5512020-01-25 20:14:16.056 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
5522020-01-25 20:14:17.330 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
5532020-01-25 20:14:17.331 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
5542020-01-25 20:14:17.331 Info, Node002, Request RTT 1280 Average Request RTT 1294
5552020-01-25 20:14:17.345 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0xc1, 0x8b, 0x86, 0xfb, 0x8c, 0x14, 0xd4, 0x91, 0x11
5562020-01-25 20:14:17.345 Info, Node002, Received SecurityCmd_NonceReport from node 2
5572020-01-25 20:14:17.345 Info, Node002, Sending (Send) message (Callback ID=0x21, Expected Reply=0x04) - DoorLockCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x62, 0x02, 0x25, 0x21, 0x81
5582020-01-25 20:14:17.354 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
5592020-01-25 20:14:17.354 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
5602020-01-25 20:14:17.377 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x21, 0x00, 0xc8
5612020-01-25 20:14:17.377 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x21 received (expected 0x21)
5622020-01-25 20:14:17.377 Info, Node002, Request RTT 1326 Average Request RTT 1310
5632020-01-25 20:14:17.377 Detail, Expected callbackId was received
5642020-01-25 20:14:26.051 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
5652020-01-25 20:14:26.051 Detail, Node002, Removing current message
5662020-01-25 20:14:26.052 Detail, Node002, Notification: Notification - TimeOut
5672020-01-25 20:15:11.136 Info, Node002, Value::Set - COMMAND_CLASS_DOOR_LOCK - Locked - 0 - 1 - False
5682020-01-25 20:15:11.136 Info, Node002, Value_Lock::Set - Requesting lock to be Unlocked
5692020-01-25 20:15:11.136 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_DOOR_LOCK
5702020-01-25 20:15:11.136 Detail, Node002, Queuing (Send) DoorLockCmd_Set (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x62, 0x01, 0x00, 0x25, 0x22, 0x83
5712020-01-25 20:15:11.136 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_DOOR_LOCK
5722020-01-25 20:15:11.136 Detail, Node002, Queuing (Send) DoorLockCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x62, 0x02, 0x25, 0x23, 0x83
5732020-01-25 20:15:11.137 Detail,
5742020-01-25 20:15:11.137 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x22, Expected Reply=0x04)
5752020-01-25 20:15:11.137 Info, Node002, Sending (Send) message (Callback ID=0x22, Expected Reply=0x04) - Nonce_Get(DoorLockCmd_Set) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
5762020-01-25 20:15:11.142 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
5772020-01-25 20:15:11.142 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
5782020-01-25 20:15:12.372 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
5792020-01-25 20:15:12.372 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
5802020-01-25 20:15:12.372 Info, Node002, Request RTT 1235 Average Request RTT 1272
5812020-01-25 20:15:12.386 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0x20, 0xb1, 0xf6, 0x34, 0x01, 0xee, 0x18, 0xe3, 0xbc
5822020-01-25 20:15:12.387 Info, Node002, Received SecurityCmd_NonceReport from node 2
5832020-01-25 20:15:12.387 Info, Node002, Sending (Send) message (Callback ID=0x24, Expected Reply=0x04) - DoorLockCmd_Set (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x62, 0x01, 0x00, 0x25, 0x24, 0x85
5842020-01-25 20:15:12.395 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
5852020-01-25 20:15:12.395 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
5862020-01-25 20:15:12.418 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x24, 0x00, 0xcd
5872020-01-25 20:15:12.419 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x24 received (expected 0x24)
5882020-01-25 20:15:12.419 Info, Node002, Request RTT 1281 Average Request RTT 1276
5892020-01-25 20:15:12.419 Detail, Expected callbackId was received
5902020-01-25 20:15:21.138 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
5912020-01-25 20:15:21.138 Detail, Node002, Removing current message
5922020-01-25 20:15:21.138 Detail, Node002, Notification: Notification - TimeOut
5932020-01-25 20:15:21.139 Detail,
5942020-01-25 20:15:21.139 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x23, Expected Reply=0x04)
5952020-01-25 20:15:21.140 Info, Node002, Sending (Send) message (Callback ID=0x23, Expected Reply=0x04) - Nonce_Get(DoorLockCmd_Get) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
5962020-01-25 20:15:21.145 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
5972020-01-25 20:15:21.145 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
5982020-01-25 20:15:22.435 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
5992020-01-25 20:15:22.435 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
6002020-01-25 20:15:22.435 Info, Node002, Request RTT 1295 Average Request RTT 1285
6012020-01-25 20:15:22.449 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0x10, 0x54, 0xea, 0x2e, 0xe1, 0x46, 0x1b, 0x5a, 0x9d
6022020-01-25 20:15:22.450 Info, Node002, Received SecurityCmd_NonceReport from node 2
6032020-01-25 20:15:22.450 Info, Node002, Sending (Send) message (Callback ID=0x25, Expected Reply=0x04) - DoorLockCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x62, 0x02, 0x25, 0x25, 0x85
6042020-01-25 20:15:22.458 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
6052020-01-25 20:15:22.458 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
6062020-01-25 20:15:22.481 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x25, 0x00, 0xcc
6072020-01-25 20:15:22.482 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x25 received (expected 0x25)
6082020-01-25 20:15:22.482 Info, Node002, Request RTT 1342 Average Request RTT 1313
6092020-01-25 20:15:22.482 Detail, Expected callbackId was received
6102020-01-25 20:15:31.140 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
6112020-01-25 20:15:31.140 Detail, Node002, Removing current message
6122020-01-25 20:15:31.140 Detail, Node002, Notification: Notification - TimeOut
6132020-01-25 20:15:33.689 Detail, Node001, Queuing (Controller) Request Node Neighbor Update
6142020-01-25 20:15:33.689 Detail, Node002, Queuing (Controller) Request Node Neighbor Update
6152020-01-25 20:15:33.689 Info, Requesting Neighbor Update for node 1
6162020-01-25 20:15:33.689 Detail, Node001, Queuing (Command) ControllerCommand_RequestNodeNeighborUpdate (Node=1): 0x01, 0x05, 0x00, 0x48, 0x01, 0x26, 0x95
6172020-01-25 20:15:33.689 Detail, Notification: ControllerCommand - Starting
6182020-01-25 20:15:33.690 Detail,
6192020-01-25 20:15:33.690 Info, Node001, Sending (Command) message (Callback ID=0x26, Expected Reply=0x48) - ControllerCommand_RequestNodeNeighborUpdate (Node=1): 0x01, 0x05, 0x00, 0x48, 0x01, 0x26, 0x95
6202020-01-25 20:15:33.708 Detail, Node001, Received: 0x01, 0x05, 0x00, 0x48, 0x26, 0x21, 0xb5
6212020-01-25 20:15:33.711 Detail,
6222020-01-25 20:15:33.711 Info, Node001, REQUEST_NEIGHBOR_UPDATE_STARTED
6232020-01-25 20:15:33.711 Detail, Node033, Expected callbackId was received
6242020-01-25 20:15:33.711 Detail, Node033, Expected reply was received
6252020-01-25 20:15:33.711 Detail, Node033, Message transaction complete
6262020-01-25 20:15:33.711 Detail,
6272020-01-25 20:15:33.711 Detail, Node001, Removing current message
6282020-01-25 20:15:33.711 Detail, Notification: ControllerCommand - InProgress
6292020-01-25 20:15:33.711 Info, WriteNextMsg Controller nothing to do
6302020-01-25 20:15:36.551 Info, Node002, NoOperation::Set - Routing=true
6312020-01-25 20:15:36.551 Detail, Node002, Queuing (NoOp) NoOperation_Set (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x00, 0x00, 0x25, 0x27, 0xe7
6322020-01-25 20:15:36.552 Detail,
6332020-01-25 20:15:36.552 Info, Node002, Sending (NoOp) message (Callback ID=0x27, Expected Reply=0x13) - NoOperation_Set (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x00, 0x00, 0x25, 0x27, 0xe7
6342020-01-25 20:15:36.557 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
6352020-01-25 20:15:36.569 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
6362020-01-25 20:15:37.832 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x27, 0x00, 0xce
6372020-01-25 20:15:37.832 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x27 received (expected 0x27)
6382020-01-25 20:15:37.832 Info, Node002, Request RTT 1280 Average Request RTT 1296
6392020-01-25 20:15:37.832 Detail, Expected callbackId was received
6402020-01-25 20:15:37.832 Detail, Expected reply was received
6412020-01-25 20:15:37.832 Detail, Message transaction complete
6422020-01-25 20:15:37.833 Detail,
6432020-01-25 20:15:37.833 Detail, Node002, Removing current message
6442020-01-25 20:15:37.833 Detail, Node002, Notification: Notification - NoOperation
6452020-01-25 20:15:56.226 Detail, Received: 0x01, 0x05, 0x00, 0x48, 0x26, 0x23, 0xb7
6462020-01-25 20:15:56.226 Detail,
6472020-01-25 20:15:56.226 Warning, WARNING: REQUEST_NEIGHBOR_UPDATE_FAILED
6482020-01-25 20:15:56.226 Detail, Notification: ControllerCommand - Failed
6492020-01-25 20:15:56.226 Info, Requesting Neighbor Update for node 2
6502020-01-25 20:15:56.226 Detail, Node002, Queuing (Command) ControllerCommand_RequestNodeNeighborUpdate (Node=2): 0x01, 0x05, 0x00, 0x48, 0x02, 0x28, 0x98
6512020-01-25 20:15:56.226 Detail, Notification: ControllerCommand - Starting
6522020-01-25 20:15:56.227 Detail,
6532020-01-25 20:15:56.227 Info, Node002, Sending (Command) message (Callback ID=0x28, Expected Reply=0x48) - ControllerCommand_RequestNodeNeighborUpdate (Node=2): 0x01, 0x05, 0x00, 0x48, 0x02, 0x28, 0x98
6542020-01-25 20:15:56.240 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x48, 0x28, 0x21, 0xbb
6552020-01-25 20:15:56.240 Detail,
6562020-01-25 20:15:56.240 Info, Node002, REQUEST_NEIGHBOR_UPDATE_STARTED
6572020-01-25 20:15:56.240 Detail, Node033, Expected callbackId was received
6582020-01-25 20:15:56.240 Detail, Node033, Expected reply was received
6592020-01-25 20:15:56.240 Detail, Node033, Message transaction complete
6602020-01-25 20:15:56.240 Detail,
6612020-01-25 20:15:56.240 Detail, Node002, Removing current message
6622020-01-25 20:15:56.240 Detail, Notification: ControllerCommand - InProgress
6632020-01-25 20:15:56.240 Info, WriteNextMsg Controller nothing to do
6642020-01-25 20:15:56.357 Detail, Node002, AdvanceQueries queryPending=0 queryRetries=0 queryStage=ProtocolInfo live=1
6652020-01-25 20:15:56.357 Detail, Node002, QueryStage_Probe
6662020-01-25 20:15:56.357 Info, Node002, NoOperation::Set - Routing=true
6672020-01-25 20:15:56.357 Detail, Node002, Queuing (NoOp) NoOperation_Set (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x00, 0x00, 0x25, 0x29, 0xe9
6682020-01-25 20:15:56.357 Detail, Node002, Queuing (Query) Query Stage Complete (Probe)
6692020-01-25 20:15:56.357 Detail,
6702020-01-25 20:15:56.357 Info, Node002, Sending (NoOp) message (Callback ID=0x29, Expected Reply=0x13) - NoOperation_Set (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x00, 0x00, 0x25, 0x29, 0xe9
6712020-01-25 20:15:56.363 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
6722020-01-25 20:15:56.363 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
6732020-01-25 20:15:57.614 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x29, 0x00, 0xc0
6742020-01-25 20:15:57.614 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x29 received (expected 0x29)
6752020-01-25 20:15:57.614 Info, Node002, Request RTT 1257 Average Request RTT 1276
6762020-01-25 20:15:57.614 Detail, Expected callbackId was received
6772020-01-25 20:15:57.614 Detail, Expected reply was received
6782020-01-25 20:15:57.614 Detail, Message transaction complete
6792020-01-25 20:15:57.614 Detail,
6802020-01-25 20:15:57.614 Detail, Node002, Removing current message
6812020-01-25 20:15:57.614 Detail, Node002, Notification: Notification - NoOperation
6822020-01-25 20:15:57.842 Detail, Received: 0x01, 0x05, 0x00, 0x48, 0x28, 0x22, 0xb8
6832020-01-25 20:15:57.842 Detail,
6842020-01-25 20:15:57.842 Info, REQUEST_NEIGHBOR_UPDATE_DONE
6852020-01-25 20:15:57.842 Detail, Requesting routing info (neighbor list) for Node 2
6862020-01-25 20:15:57.842 Detail, Node002, Queuing (Command) Get Routing Info (Node=2): 0x01, 0x07, 0x00, 0x80, 0x02, 0x00, 0x00, 0x03, 0x79
6872020-01-25 20:15:57.842 Detail, Notification: ControllerCommand - Completed
6882020-01-25 20:15:57.843 Detail,
6892020-01-25 20:15:57.843 Info, Node002, Sending (Command) message (Callback ID=0x00, Expected Reply=0x80) - Get Routing Info (Node=2): 0x01, 0x07, 0x00, 0x80, 0x02, 0x00, 0x00, 0x03, 0x79
6902020-01-25 20:15:57.848 Detail, Node002, Received: 0x01, 0x20, 0x01, 0x80, 0x01, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x5f
6912020-01-25 20:15:57.848 Detail,
6922020-01-25 20:15:57.848 Info, Node002, Received reply to FUNC_ID_ZW_GET_ROUTING_INFO
6932020-01-25 20:15:57.848 Info, Node002, Neighbors of this node are:
6942020-01-25 20:15:57.848 Info, Node002, Node 1
6952020-01-25 20:15:57.848 Detail, Expected reply was received
6962020-01-25 20:15:57.848 Detail, Message transaction complete
6972020-01-25 20:15:57.848 Detail,
6982020-01-25 20:15:57.849 Detail, Node002, Removing current message
6992020-01-25 20:15:57.849 Detail, Node002, Query Stage Complete (Probe)
7002020-01-25 20:15:57.849 Detail, Node002, AdvanceQueries queryPending=0 queryRetries=0 queryStage=WakeUp live=1
7012020-01-25 20:15:57.849 Detail, Node002, QueryStage_WakeUp
7022020-01-25 20:15:57.849 Detail, Node002, QueryStage_ManufacturerSpecific1
7032020-01-25 20:15:57.849 Detail, Node002, Checking for ManufacturerSpecific CC and Requesting values if present on this node
7042020-01-25 20:15:57.849 Detail, Node002, QueryStage_NodePlusInfo
7052020-01-25 20:15:57.849 Detail, Node002, QueryStage_SecurityReport
7062020-01-25 20:15:57.849 Detail, Node002, Queuing (Security) SecurityCmd_SupportedGet (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x02, 0x25, 0x2a, 0x70
7072020-01-25 20:15:57.849 Detail, Node002, Queuing (Query) Query Stage Complete (SecurityReport)
7082020-01-25 20:15:57.849 Detail,
7092020-01-25 20:15:57.849 Info, Node002, Processing (Security) Nonce Request message (Callback ID=0x2a, Expected Reply=0x04)
7102020-01-25 20:15:57.849 Info, Node002, Sending (Security) message (Callback ID=0x2a, Expected Reply=0x04) - Nonce_Get(SecurityCmd_SupportedGet) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
7112020-01-25 20:15:57.855 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
7122020-01-25 20:15:57.856 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
7132020-01-25 20:15:58.978 Detail, Node002, Queuing (Controller) Request Node Neighbor Update
7142020-01-25 20:15:58.978 Detail, Node002, Queuing (Controller) Delete All Return Routes
7152020-01-25 20:15:58.978 Detail, Node002, Queuing (Controller) Assign Return Route
7162020-01-25 20:15:58.999 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
7172020-01-25 20:15:58.999 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
7182020-01-25 20:15:58.999 Info, Node002, Request RTT 1150 Average Request RTT 1213
7192020-01-25 20:15:59.013 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0x35, 0x5d, 0x1c, 0x06, 0x29, 0x54, 0x6a, 0x43, 0xdd
7202020-01-25 20:15:59.013 Info, Node002, Received SecurityCmd_NonceReport from node 2
7212020-01-25 20:15:59.013 Info, Node002, Sending (Security) message (Callback ID=0x2b, Expected Reply=0x04) - SecurityCmd_SupportedGet (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x02, 0x25, 0x2b, 0x71
7222020-01-25 20:15:59.022 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
7232020-01-25 20:15:59.022 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
7242020-01-25 20:15:59.045 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x2b, 0x00, 0xc2
7252020-01-25 20:15:59.045 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x2b received (expected 0x2b)
7262020-01-25 20:15:59.045 Info, Node002, Request RTT 1197 Average Request RTT 1205
7272020-01-25 20:15:59.045 Detail, Expected callbackId was received
7282020-01-25 20:16:01.421 Info, Node002, NoOperation::Set - Routing=true
7292020-01-25 20:16:01.421 Detail, Node002, Queuing (NoOp) NoOperation_Set (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x00, 0x00, 0x25, 0x2c, 0xec
7302020-01-25 20:16:07.848 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
7312020-01-25 20:16:07.849 Detail, Node002, Removing current message
7322020-01-25 20:16:07.849 Detail, Node002, Notification: Notification - TimeOut
7332020-01-25 20:16:07.850 Detail,
7342020-01-25 20:16:07.850 Info, Node002, Sending (NoOp) message (Callback ID=0x2c, Expected Reply=0x13) - NoOperation_Set (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x00, 0x00, 0x25, 0x2c, 0xec
7352020-01-25 20:16:07.856 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
7362020-01-25 20:16:07.856 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
7372020-01-25 20:16:09.146 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x2c, 0x00, 0xc5
7382020-01-25 20:16:09.146 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x2c received (expected 0x2c)
7392020-01-25 20:16:09.146 Info, Node002, Request RTT 1297 Average Request RTT 1251
7402020-01-25 20:16:09.146 Detail, Expected callbackId was received
7412020-01-25 20:16:09.146 Detail, Expected reply was received
7422020-01-25 20:16:09.146 Detail, Message transaction complete
7432020-01-25 20:16:09.146 Detail,
7442020-01-25 20:16:09.147 Detail, Node002, Removing current message
7452020-01-25 20:16:09.147 Detail, Node002, Notification: Notification - NoOperation
7462020-01-25 20:16:09.149 Info, Requesting Neighbor Update for node 2
7472020-01-25 20:16:09.149 Detail, Node002, Queuing (Command) ControllerCommand_RequestNodeNeighborUpdate (Node=2): 0x01, 0x05, 0x00, 0x48, 0x02, 0x2d, 0x9d
7482020-01-25 20:16:09.150 Detail, Notification: ControllerCommand - Starting
7492020-01-25 20:16:09.150 Detail,
7502020-01-25 20:16:09.150 Info, Node002, Sending (Command) message (Callback ID=0x2d, Expected Reply=0x48) - ControllerCommand_RequestNodeNeighborUpdate (Node=2): 0x01, 0x05, 0x00, 0x48, 0x02, 0x2d, 0x9d
7512020-01-25 20:16:09.163 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x48, 0x2d, 0x21, 0xbe
7522020-01-25 20:16:09.163 Detail,
7532020-01-25 20:16:09.164 Info, Node002, REQUEST_NEIGHBOR_UPDATE_STARTED
7542020-01-25 20:16:09.164 Detail, Node033, Expected callbackId was received
7552020-01-25 20:16:09.164 Detail, Node033, Expected reply was received
7562020-01-25 20:16:09.164 Detail, Node033, Message transaction complete
7572020-01-25 20:16:09.164 Detail,
7582020-01-25 20:16:09.164 Detail, Node002, Removing current message
7592020-01-25 20:16:09.164 Detail, Notification: ControllerCommand - InProgress
7602020-01-25 20:16:09.164 Info, WriteNextMsg Controller nothing to do
7612020-01-25 20:16:09.447 Detail, Received: 0x01, 0x05, 0x00, 0x48, 0x2d, 0x22, 0xbd
7622020-01-25 20:16:09.448 Detail,
7632020-01-25 20:16:09.448 Info, REQUEST_NEIGHBOR_UPDATE_DONE
7642020-01-25 20:16:09.448 Detail, Requesting routing info (neighbor list) for Node 2
7652020-01-25 20:16:09.448 Detail, Node002, Queuing (Command) Get Routing Info (Node=2): 0x01, 0x07, 0x00, 0x80, 0x02, 0x00, 0x00, 0x03, 0x79
7662020-01-25 20:16:09.448 Detail, Notification: ControllerCommand - Completed
7672020-01-25 20:16:09.449 Detail,
7682020-01-25 20:16:09.449 Info, Node002, Sending (Command) message (Callback ID=0x00, Expected Reply=0x80) - Get Routing Info (Node=2): 0x01, 0x07, 0x00, 0x80, 0x02, 0x00, 0x00, 0x03, 0x79
7692020-01-25 20:16:09.454 Detail, Node002, Received: 0x01, 0x20, 0x01, 0x80, 0x01, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x5f
7702020-01-25 20:16:09.454 Detail,
7712020-01-25 20:16:09.454 Info, Node002, Received reply to FUNC_ID_ZW_GET_ROUTING_INFO
7722020-01-25 20:16:09.455 Info, Node002, Neighbors of this node are:
7732020-01-25 20:16:09.455 Info, Node002, Node 1
7742020-01-25 20:16:09.455 Detail, Expected reply was received
7752020-01-25 20:16:09.455 Detail, Message transaction complete
7762020-01-25 20:16:09.455 Detail,
7772020-01-25 20:16:09.455 Detail, Node002, Removing current message
7782020-01-25 20:16:09.455 Info, Deleting all return routes from node 2
7792020-01-25 20:16:09.455 Detail, Node002, Queuing (Command) ControllerCommand_DeleteAllReturnRoutess (Node=2): 0x01, 0x05, 0x00, 0x47, 0x02, 0x2e, 0x91
7802020-01-25 20:16:09.455 Detail, Notification: ControllerCommand - Starting
7812020-01-25 20:16:09.455 Detail,
7822020-01-25 20:16:09.456 Info, Node002, Sending (Command) message (Callback ID=0x2e, Expected Reply=0x47) - ControllerCommand_DeleteAllReturnRoutess (Node=2): 0x01, 0x05, 0x00, 0x47, 0x02, 0x2e, 0x91
7832020-01-25 20:16:09.462 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x47, 0x01, 0xbc
7842020-01-25 20:16:09.462 Detail,
7852020-01-25 20:16:09.462 Info, Node002, Received reply to FUNC_ID_ZW_DELETE_RETURN_ROUTE - command in progress
7862020-01-25 20:16:09.462 Detail, Notification: ControllerCommand - InProgress
7872020-01-25 20:16:10.699 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x47, 0x2e, 0x00, 0x93
7882020-01-25 20:16:10.699 Detail,
7892020-01-25 20:16:10.699 Info, Node002, Received reply to FUNC_ID_ZW_DELETE_RETURN_ROUTE for node 2 - SUCCESS
7902020-01-25 20:16:10.700 Detail, Expected callbackId was received
7912020-01-25 20:16:10.700 Detail, Expected reply was received
7922020-01-25 20:16:10.700 Detail, Message transaction complete
7932020-01-25 20:16:10.700 Detail,
7942020-01-25 20:16:10.700 Detail, Node002, Removing current message
7952020-01-25 20:16:10.700 Detail, Notification: ControllerCommand - Completed
7962020-01-25 20:16:10.700 Info, Assigning return route from node 2 to node 1
7972020-01-25 20:16:10.701 Detail, Node002, Queuing (Command) ControllerCommand_AssignReturnRoute (Node=2): 0x01, 0x06, 0x00, 0x46, 0x02, 0x01, 0x2f, 0x93
7982020-01-25 20:16:10.701 Detail, Notification: ControllerCommand - Starting
7992020-01-25 20:16:10.701 Detail,
8002020-01-25 20:16:10.701 Info, Node002, Sending (Command) message (Callback ID=0x2f, Expected Reply=0x46) - ControllerCommand_AssignReturnRoute (Node=2): 0x01, 0x06, 0x00, 0x46, 0x02, 0x01, 0x2f, 0x93
8012020-01-25 20:16:10.708 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x46, 0x01, 0xbd
8022020-01-25 20:16:10.708 Detail,
8032020-01-25 20:16:10.708 Info, Node002, Received reply to FUNC_ID_ZW_ASSIGN_RETURN_ROUTE - command in progress
8042020-01-25 20:16:10.708 Detail, Notification: ControllerCommand - InProgress
8052020-01-25 20:16:10.866 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x46, 0x2f, 0x00, 0x93
8062020-01-25 20:16:10.866 Detail,
8072020-01-25 20:16:10.866 Info, Node002, Received reply to FUNC_ID_ZW_ASSIGN_RETURN_ROUTE for node 2 - SUCCESS
8082020-01-25 20:16:10.866 Detail, Expected callbackId was received
8092020-01-25 20:16:10.866 Detail, Expected reply was received
8102020-01-25 20:16:10.866 Detail, Message transaction complete
8112020-01-25 20:16:10.867 Detail,
8122020-01-25 20:16:10.867 Detail, Node002, Removing current message
8132020-01-25 20:16:10.867 Detail, Notification: ControllerCommand - Completed
8142020-01-25 20:16:10.867 Detail, Node002, Query Stage Complete (SecurityReport)
8152020-01-25 20:16:10.867 Detail, Node002, AdvanceQueries queryPending=0 queryRetries=0 queryStage=ManufacturerSpecific2 live=1
8162020-01-25 20:16:10.867 Detail, Node002, QueryStage_ManufacturerSpecific2
8172020-01-25 20:16:10.867 Detail, Node002, QueryStage_Versions
8182020-01-25 20:16:10.868 Info, Node002, Requesting Versions
8192020-01-25 20:16:10.868 Info, Node002, Requesting Versions for COMMAND_CLASS_NO_OPERATION
8202020-01-25 20:16:10.868 Info, Node002, Requesting Versions for COMMAND_CLASS_BASIC
8212020-01-25 20:16:10.868 Info, Node002, Requesting Versions for COMMAND_CLASS_DEVICE_RESET_LOCALLY
8222020-01-25 20:16:10.868 Info, Node002, Requesting Versions for COMMAND_CLASS_ZWAVEPLUS_INFO
8232020-01-25 20:16:10.868 Info, Node002, Requesting Versions for COMMAND_CLASS_DOOR_LOCK
8242020-01-25 20:16:10.868 Info, Node002, Requesting Versions for COMMAND_CLASS_USER_CODE
8252020-01-25 20:16:10.868 Info, Node002, Requesting Versions for COMMAND_CLASS_CONFIGURATION
8262020-01-25 20:16:10.868 Info, Node002, Requesting Versions for COMMAND_CLASS_ALARM
8272020-01-25 20:16:10.868 Info, Node002, ok
8282020-01-25 20:16:10.868 Info, Node002, Requesting Versions for COMMAND_CLASS_MANUFACTURER_SPECIFIC
8292020-01-25 20:16:10.868 Info, Node002, Requesting Versions for COMMAND_CLASS_POWERLEVEL
8302020-01-25 20:16:10.868 Info, Node002, Requesting Versions for COMMAND_CLASS_BATTERY
8312020-01-25 20:16:10.868 Info, Node002, Requesting Versions for COMMAND_CLASS_ASSOCIATION
8322020-01-25 20:16:10.868 Info, Node002, Requesting Versions for COMMAND_CLASS_VERSION
8332020-01-25 20:16:10.868 Info, Node002, Requesting Versions for COMMAND_CLASS_SECURITY
8342020-01-25 20:16:10.868 Detail, Node002, QueryStage_Instances
8352020-01-25 20:16:10.869 Info, Node002, Essential node queries are complete
8362020-01-25 20:16:10.869 Detail, Node002, QueryStage_Static
8372020-01-25 20:16:10.869 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_ALARM
8382020-01-25 20:16:10.869 Detail, Node002, Queuing (Query) AlarmCmd_SupportedGet (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x71, 0x07, 0x25, 0x30, 0x86
8392020-01-25 20:16:10.869 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_ASSOCIATION
8402020-01-25 20:16:10.869 Detail, Node002, Queuing (Query) AssociationCmd_GroupingsGet (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x85, 0x05, 0x25, 0x31, 0x71
8412020-01-25 20:16:10.869 Detail, Node002, Queuing (Query) Query Stage Complete (Static)
8422020-01-25 20:16:10.869 Detail, Node002, Notification: EssentialNodeQueriesComplete
8432020-01-25 20:16:10.869 Detail,
8442020-01-25 20:16:10.869 Info, Node002, Processing (Query) Nonce Request message (Callback ID=0x30, Expected Reply=0x04)
8452020-01-25 20:16:10.870 Info, Node002, Sending (Query) message (Callback ID=0x30, Expected Reply=0x04) - Nonce_Get(AlarmCmd_SupportedGet) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
8462020-01-25 20:16:10.875 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
8472020-01-25 20:16:10.875 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
8482020-01-25 20:16:10.894 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
8492020-01-25 20:16:10.894 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
8502020-01-25 20:16:10.894 Info, Node002, Request RTT 24 Average Request RTT 637
8512020-01-25 20:16:10.909 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0x86, 0x69, 0x91, 0x76, 0xa7, 0x5f, 0x70, 0xa8, 0xd3
8522020-01-25 20:16:10.909 Info, Node002, Received SecurityCmd_NonceReport from node 2
8532020-01-25 20:16:10.909 Info, Node002, Sending (Query) message (Callback ID=0x32, Expected Reply=0x04) - AlarmCmd_SupportedGet (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x71, 0x07, 0x25, 0x32, 0x84
8542020-01-25 20:16:10.918 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
8552020-01-25 20:16:10.918 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
8562020-01-25 20:16:10.941 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x32, 0x00, 0xdb
8572020-01-25 20:16:10.941 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x32 received (expected 0x32)
8582020-01-25 20:16:10.941 Info, Node002, Request RTT 71 Average Request RTT 354
8592020-01-25 20:16:10.941 Detail, Expected callbackId was received
8602020-01-25 20:16:20.870 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
8612020-01-25 20:16:20.870 Detail, Node002, Removing current message
8622020-01-25 20:16:20.870 Detail, Node002, Notification: Notification - TimeOut
8632020-01-25 20:16:20.872 Detail,
8642020-01-25 20:16:20.872 Info, Node002, Processing (Query) Nonce Request message (Callback ID=0x31, Expected Reply=0x04)
8652020-01-25 20:16:20.872 Info, Node002, Sending (Query) message (Callback ID=0x31, Expected Reply=0x04) - Nonce_Get(AssociationCmd_GroupingsGet) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
8662020-01-25 20:16:20.877 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
8672020-01-25 20:16:20.877 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
8682020-01-25 20:16:22.167 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
8692020-01-25 20:16:22.168 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
8702020-01-25 20:16:22.168 Info, Node002, Request RTT 1296 Average Request RTT 825
8712020-01-25 20:16:22.182 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0x61, 0x41, 0x90, 0xa2, 0x0b, 0xe2, 0x75, 0x5b, 0x2e
8722020-01-25 20:16:22.182 Info, Node002, Received SecurityCmd_NonceReport from node 2
8732020-01-25 20:16:22.182 Info, Node002, Sending (Query) message (Callback ID=0x33, Expected Reply=0x04) - AssociationCmd_GroupingsGet (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x85, 0x05, 0x25, 0x33, 0x73
8742020-01-25 20:16:22.191 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
8752020-01-25 20:16:22.191 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
8762020-01-25 20:16:22.214 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x33, 0x00, 0xda
8772020-01-25 20:16:22.214 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x33 received (expected 0x33)
8782020-01-25 20:16:22.214 Info, Node002, Request RTT 1343 Average Request RTT 1084
8792020-01-25 20:16:22.214 Detail, Expected callbackId was received
8802020-01-25 20:16:29.701 Info, Node002, Value::Set - COMMAND_CLASS_DOOR_LOCK - Locked - 0 - 1 - False
8812020-01-25 20:16:29.701 Info, Node002, Value_Lock::Set - Requesting lock to be Unlocked
8822020-01-25 20:16:29.701 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_DOOR_LOCK
8832020-01-25 20:16:29.701 Detail, Node002, Queuing (Send) DoorLockCmd_Set (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x62, 0x01, 0x00, 0x25, 0x34, 0x95
8842020-01-25 20:16:29.701 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_DOOR_LOCK
8852020-01-25 20:16:29.701 Detail, Node002, Queuing (Send) DoorLockCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x62, 0x02, 0x25, 0x35, 0x95
8862020-01-25 20:16:30.871 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
8872020-01-25 20:16:30.872 Detail, Node002, Removing current message
8882020-01-25 20:16:30.872 Detail, Node002, Notification: Notification - TimeOut
8892020-01-25 20:16:30.873 Detail,
8902020-01-25 20:16:30.873 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x34, Expected Reply=0x04)
8912020-01-25 20:16:30.873 Info, Node002, Sending (Send) message (Callback ID=0x34, Expected Reply=0x04) - Nonce_Get(DoorLockCmd_Set) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
8922020-01-25 20:16:30.879 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
8932020-01-25 20:16:30.879 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
8942020-01-25 20:16:32.109 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
8952020-01-25 20:16:32.109 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
8962020-01-25 20:16:32.109 Info, Node002, Request RTT 1236 Average Request RTT 1160
8972020-01-25 20:16:32.123 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0x3e, 0x53, 0xc3, 0x4f, 0x1a, 0x45, 0x06, 0xb4, 0xf7
8982020-01-25 20:16:32.123 Info, Node002, Received SecurityCmd_NonceReport from node 2
8992020-01-25 20:16:32.123 Info, Node002, Sending (Send) message (Callback ID=0x36, Expected Reply=0x04) - DoorLockCmd_Set (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x62, 0x01, 0x00, 0x25, 0x36, 0x97
9002020-01-25 20:16:32.132 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
9012020-01-25 20:16:32.132 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
9022020-01-25 20:16:32.155 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x36, 0x00, 0xdf
9032020-01-25 20:16:32.155 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x36 received (expected 0x36)
9042020-01-25 20:16:32.155 Info, Node002, Request RTT 1283 Average Request RTT 1221
9052020-01-25 20:16:32.155 Detail, Expected callbackId was received
9062020-01-25 20:16:40.872 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
9072020-01-25 20:16:40.873 Detail, Node002, Removing current message
9082020-01-25 20:16:40.873 Detail, Node002, Notification: Notification - TimeOut
9092020-01-25 20:16:40.874 Detail,
9102020-01-25 20:16:40.874 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x35, Expected Reply=0x04)
9112020-01-25 20:16:40.874 Info, Node002, Sending (Send) message (Callback ID=0x35, Expected Reply=0x04) - Nonce_Get(DoorLockCmd_Get) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
9122020-01-25 20:16:40.880 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
9132020-01-25 20:16:40.880 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
9142020-01-25 20:16:42.124 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
9152020-01-25 20:16:42.124 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
9162020-01-25 20:16:42.124 Info, Node002, Request RTT 1251 Average Request RTT 1236
9172020-01-25 20:16:42.139 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0xa5, 0xcc, 0x2a, 0x06, 0x2a, 0x59, 0xc7, 0xcc, 0xc6
9182020-01-25 20:16:42.139 Info, Node002, Received SecurityCmd_NonceReport from node 2
9192020-01-25 20:16:42.139 Info, Node002, Sending (Send) message (Callback ID=0x37, Expected Reply=0x04) - DoorLockCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x62, 0x02, 0x25, 0x37, 0x97
9202020-01-25 20:16:42.148 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
9212020-01-25 20:16:42.148 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
9222020-01-25 20:16:42.171 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x37, 0x00, 0xde
9232020-01-25 20:16:42.171 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x37 received (expected 0x37)
9242020-01-25 20:16:42.171 Info, Node002, Request RTT 1297 Average Request RTT 1266
9252020-01-25 20:16:42.171 Detail, Expected callbackId was received
9262020-01-25 20:16:50.874 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
9272020-01-25 20:16:50.874 Detail, Node002, Removing current message
9282020-01-25 20:16:50.874 Detail, Node002, Notification: Notification - TimeOut
9292020-01-25 20:16:50.876 Detail, Node002, Query Stage Complete (Static)
9302020-01-25 20:16:50.876 Detail, Node002, AdvanceQueries queryPending=0 queryRetries=0 queryStage=Associations live=1
9312020-01-25 20:16:50.876 Detail, Node002, QueryStage_Associations
9322020-01-25 20:16:50.876 Info, Node002, Number of association groups reported for node 2 is 2.
9332020-01-25 20:16:50.876 Info, Node002, Get Associations for group 1 of node 2
9342020-01-25 20:16:50.876 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_ASSOCIATION
9352020-01-25 20:16:50.876 Detail, Node002, Queuing (Send) AssociationCmd_Get (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x85, 0x02, 0x01, 0x25, 0x38, 0x7c
9362020-01-25 20:16:50.876 Detail, Node002, Queuing (Query) Query Stage Complete (Associations)
9372020-01-25 20:16:50.876 Detail,
9382020-01-25 20:16:50.876 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x38, Expected Reply=0x04)
9392020-01-25 20:16:50.876 Info, Node002, Sending (Send) message (Callback ID=0x38, Expected Reply=0x04) - Nonce_Get(AssociationCmd_Get) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
9402020-01-25 20:16:50.882 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
9412020-01-25 20:16:50.882 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
9422020-01-25 20:16:52.127 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
9432020-01-25 20:16:52.127 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
9442020-01-25 20:16:52.127 Info, Node002, Request RTT 1251 Average Request RTT 1258
9452020-01-25 20:16:52.141 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0x4e, 0x86, 0xb0, 0x0c, 0x3f, 0x5c, 0xaa, 0x31, 0x77
9462020-01-25 20:16:52.141 Info, Node002, Received SecurityCmd_NonceReport from node 2
9472020-01-25 20:16:52.141 Info, Node002, Sending (Send) message (Callback ID=0x39, Expected Reply=0x04) - AssociationCmd_Get (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x85, 0x02, 0x01, 0x25, 0x39, 0x7d
9482020-01-25 20:16:52.150 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
9492020-01-25 20:16:52.150 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
9502020-01-25 20:16:52.173 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x39, 0x00, 0xd0
9512020-01-25 20:16:52.173 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x39 received (expected 0x39)
9522020-01-25 20:16:52.173 Info, Node002, Request RTT 1297 Average Request RTT 1277
9532020-01-25 20:16:52.173 Detail, Expected callbackId was received
9542020-01-25 20:17:00.876 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
9552020-01-25 20:17:00.877 Detail, Node002, Removing current message
9562020-01-25 20:17:00.877 Detail, Node002, Notification: Notification - TimeOut
9572020-01-25 20:17:00.878 Detail, Node002, Query Stage Complete (Associations)
9582020-01-25 20:17:00.878 Detail, Node002, AdvanceQueries queryPending=0 queryRetries=0 queryStage=Neighbors live=1
9592020-01-25 20:17:00.878 Detail, Node002, QueryStage_Neighbors
9602020-01-25 20:17:00.878 Detail, Requesting routing info (neighbor list) for Node 2
9612020-01-25 20:17:00.878 Detail, Node002, Queuing (Command) Get Routing Info (Node=2): 0x01, 0x07, 0x00, 0x80, 0x02, 0x00, 0x00, 0x03, 0x79
9622020-01-25 20:17:00.878 Detail, Node002, Queuing (Query) Query Stage Complete (Neighbors)
9632020-01-25 20:17:00.878 Detail,
9642020-01-25 20:17:00.878 Info, Node002, Sending (Command) message (Callback ID=0x00, Expected Reply=0x80) - Get Routing Info (Node=2): 0x01, 0x07, 0x00, 0x80, 0x02, 0x00, 0x00, 0x03, 0x79
9652020-01-25 20:17:00.884 Detail, Node002, Received: 0x01, 0x20, 0x01, 0x80, 0x01, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x5f
9662020-01-25 20:17:00.884 Detail,
9672020-01-25 20:17:00.884 Info, Node002, Received reply to FUNC_ID_ZW_GET_ROUTING_INFO
9682020-01-25 20:17:00.884 Info, Node002, Neighbors of this node are:
9692020-01-25 20:17:00.884 Info, Node002, Node 1
9702020-01-25 20:17:00.884 Detail, Expected reply was received
9712020-01-25 20:17:00.884 Detail, Message transaction complete
9722020-01-25 20:17:00.884 Detail,
9732020-01-25 20:17:00.884 Detail, Node002, Removing current message
9742020-01-25 20:17:00.884 Detail, Node002, Query Stage Complete (Neighbors)
9752020-01-25 20:17:00.884 Detail, Node002, AdvanceQueries queryPending=0 queryRetries=0 queryStage=Session live=1
9762020-01-25 20:17:00.884 Detail, Node002, QueryStage_Session
9772020-01-25 20:17:00.884 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_USER_CODE
9782020-01-25 20:17:00.884 Detail, Node002, Queuing (Query) UserCodeCmd_Get (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x63, 0x02, 0x01, 0x25, 0x3a, 0x98
9792020-01-25 20:17:00.884 Detail, Node002, Queuing (Query) PowerlevelCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x73, 0x02, 0x25, 0x3b, 0x8a
9802020-01-25 20:17:00.884 Detail, Node002, Queuing (Query) Query Stage Complete (Session)
9812020-01-25 20:17:00.884 Detail,
9822020-01-25 20:17:00.884 Info, Node002, Processing (Query) Nonce Request message (Callback ID=0x3a, Expected Reply=0x04)
9832020-01-25 20:17:00.884 Info, Node002, Sending (Query) message (Callback ID=0x3a, Expected Reply=0x04) - Nonce_Get(UserCodeCmd_Get) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
9842020-01-25 20:17:00.890 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
9852020-01-25 20:17:00.890 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
9862020-01-25 20:17:02.164 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
9872020-01-25 20:17:02.165 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
9882020-01-25 20:17:02.165 Info, Node002, Request RTT 1281 Average Request RTT 1279
9892020-01-25 20:17:02.179 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0x98, 0x3f, 0xdc, 0xd6, 0xad, 0xa0, 0x5f, 0xfb, 0xff
9902020-01-25 20:17:02.179 Info, Node002, Received SecurityCmd_NonceReport from node 2
9912020-01-25 20:17:02.179 Info, Node002, Sending (Query) message (Callback ID=0x3c, Expected Reply=0x04) - UserCodeCmd_Get (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x63, 0x02, 0x01, 0x25, 0x3c, 0x9e
9922020-01-25 20:17:02.188 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
9932020-01-25 20:17:02.188 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
9942020-01-25 20:17:02.211 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x3c, 0x00, 0xd5
9952020-01-25 20:17:02.211 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x3c received (expected 0x3c)
9962020-01-25 20:17:02.211 Info, Node002, Request RTT 1327 Average Request RTT 1303
9972020-01-25 20:17:02.211 Detail, Expected callbackId was received
9982020-01-25 20:17:10.885 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
9992020-01-25 20:17:10.885 Detail, Node002, Removing current message
10002020-01-25 20:17:10.885 Detail, Node002, Notification: Notification - TimeOut
10012020-01-25 20:17:10.886 Detail,
10022020-01-25 20:17:10.886 Info, Node002, Sending (Query) message (Callback ID=0x3b, Expected Reply=0x04) - PowerlevelCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x73, 0x02, 0x25, 0x3b, 0x8a
10032020-01-25 20:17:10.892 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
10042020-01-25 20:17:10.892 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
10052020-01-25 20:17:12.167 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x3b, 0x00, 0xd2
10062020-01-25 20:17:12.167 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x3b received (expected 0x3b)
10072020-01-25 20:17:12.167 Info, Node002, Request RTT 1281 Average Request RTT 1292
10082020-01-25 20:17:12.167 Detail, Expected callbackId was received
10092020-01-25 20:17:12.179 Detail, Node002, Received: 0x01, 0x0a, 0x00, 0x04, 0x00, 0x02, 0x04, 0x73, 0x03, 0x00, 0x00, 0x87
10102020-01-25 20:17:12.180 Detail,
10112020-01-25 20:17:12.180 Info, Node002, Response RTT 1294 Average Response RTT 1286
10122020-01-25 20:17:12.180 Info, Node002, Received a PowerLevel report: PowerLevel=Normal, Timeout=0
10132020-01-25 20:17:12.180 Detail, Node002, Refreshed Value: old value=0, new value=0, type=list
10142020-01-25 20:17:12.180 Detail, Node002, Changes to this value are not verified
10152020-01-25 20:17:12.180 Detail, Node002, Refreshed Value: old value=0, new value=0, type=byte
10162020-01-25 20:17:12.180 Detail, Node002, Changes to this value are not verified
10172020-01-25 20:17:12.180 Detail, Node002, Expected reply and command class was received
10182020-01-25 20:17:12.180 Detail, Node002, Message transaction complete
10192020-01-25 20:17:12.180 Detail,
10202020-01-25 20:17:12.180 Detail, Node002, Removing current message
10212020-01-25 20:17:12.180 Detail, Node002, Notification: ValueChanged
10222020-01-25 20:17:12.182 Detail, Node002, Notification: ValueChanged
10232020-01-25 20:17:12.183 Detail, Node002, Query Stage Complete (Session)
10242020-01-25 20:17:12.183 Detail, Node002, AdvanceQueries queryPending=0 queryRetries=0 queryStage=Dynamic live=1
10252020-01-25 20:17:12.183 Detail, Node002, QueryStage_Dynamic
10262020-01-25 20:17:12.184 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_DOOR_LOCK
10272020-01-25 20:17:12.184 Detail, Node002, Queuing (Send) DoorLockCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x62, 0x02, 0x25, 0x3d, 0x9d
10282020-01-25 20:17:12.184 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_ALARM
10292020-01-25 20:17:12.184 Detail, Node002, Queuing (Send) AlarmCmd_Get (Node=2): 0x01, 0x0c, 0x00, 0x13, 0x02, 0x05, 0x71, 0x04, 0x00, 0x06, 0x01, 0x25, 0x3e, 0x8e
10302020-01-25 20:17:12.184 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_ALARM
10312020-01-25 20:17:12.184 Detail, Node002, Queuing (Send) AlarmCmd_Get (Node=2): 0x01, 0x0c, 0x00, 0x13, 0x02, 0x05, 0x71, 0x04, 0x00, 0x08, 0x01, 0x25, 0x3f, 0x81
10322020-01-25 20:17:12.184 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_BATTERY
10332020-01-25 20:17:12.184 Detail, Node002, Queuing (Send) BatteryCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x80, 0x02, 0x25, 0x40, 0x02
10342020-01-25 20:17:12.184 Detail, Node002, Queuing (Query) Query Stage Complete (Dynamic)
10352020-01-25 20:17:12.184 Detail,
10362020-01-25 20:17:12.184 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x3d, Expected Reply=0x04)
10372020-01-25 20:17:12.184 Info, Node002, Sending (Send) message (Callback ID=0x3d, Expected Reply=0x04) - Nonce_Get(DoorLockCmd_Get) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
10382020-01-25 20:17:12.189 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
10392020-01-25 20:17:12.189 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
10402020-01-25 20:17:12.208 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
10412020-01-25 20:17:12.208 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
10422020-01-25 20:17:12.209 Info, Node002, Request RTT 24 Average Request RTT 658
10432020-01-25 20:17:12.223 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0x48, 0x2b, 0x0d, 0x67, 0x23, 0xd9, 0x80, 0x20, 0xa8
10442020-01-25 20:17:12.223 Info, Node002, Received SecurityCmd_NonceReport from node 2
10452020-01-25 20:17:12.223 Info, Node002, Sending (Send) message (Callback ID=0x41, Expected Reply=0x04) - DoorLockCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x62, 0x02, 0x25, 0x41, 0xe1
10462020-01-25 20:17:12.232 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
10472020-01-25 20:17:12.232 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
10482020-01-25 20:17:12.255 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x41, 0x00, 0xa8
10492020-01-25 20:17:12.255 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x41 received (expected 0x41)
10502020-01-25 20:17:12.255 Info, Node002, Request RTT 70 Average Request RTT 364
10512020-01-25 20:17:12.255 Detail, Expected callbackId was received
10522020-01-25 20:17:22.184 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
10532020-01-25 20:17:22.184 Detail, Node002, Removing current message
10542020-01-25 20:17:22.184 Detail, Node002, Notification: Notification - TimeOut
10552020-01-25 20:17:22.186 Detail,
10562020-01-25 20:17:22.186 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x3e, Expected Reply=0x04)
10572020-01-25 20:17:22.186 Info, Node002, Sending (Send) message (Callback ID=0x3e, Expected Reply=0x04) - Nonce_Get(AlarmCmd_Get) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
10582020-01-25 20:17:22.191 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
10592020-01-25 20:17:22.191 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
10602020-01-25 20:17:23.466 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
10612020-01-25 20:17:23.466 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
10622020-01-25 20:17:23.466 Info, Node002, Request RTT 1280 Average Request RTT 822
10632020-01-25 20:17:23.481 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0xab, 0x22, 0xd8, 0xa7, 0x07, 0x4f, 0x4d, 0xf5, 0xfd
10642020-01-25 20:17:23.481 Info, Node002, Received SecurityCmd_NonceReport from node 2
10652020-01-25 20:17:23.481 Info, Node002, Sending (Send) message (Callback ID=0x42, Expected Reply=0x04) - AlarmCmd_Get (Node=2): 0x01, 0x0c, 0x00, 0x13, 0x02, 0x05, 0x71, 0x04, 0x00, 0x06, 0x01, 0x25, 0x42, 0xf2
10662020-01-25 20:17:23.489 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
10672020-01-25 20:17:23.490 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
10682020-01-25 20:17:23.513 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x42, 0x00, 0xab
10692020-01-25 20:17:23.513 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x42 received (expected 0x42)
10702020-01-25 20:17:23.513 Info, Node002, Request RTT 1327 Average Request RTT 1074
10712020-01-25 20:17:23.513 Detail, Expected callbackId was received
10722020-01-25 20:17:32.186 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
10732020-01-25 20:17:32.186 Detail, Node002, Removing current message
10742020-01-25 20:17:32.187 Detail, Node002, Notification: Notification - TimeOut
10752020-01-25 20:17:32.188 Detail,
10762020-01-25 20:17:32.188 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x3f, Expected Reply=0x04)
10772020-01-25 20:17:32.188 Info, Node002, Sending (Send) message (Callback ID=0x3f, Expected Reply=0x04) - Nonce_Get(AlarmCmd_Get) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
10782020-01-25 20:17:32.193 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
10792020-01-25 20:17:32.194 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
10802020-01-25 20:17:33.408 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
10812020-01-25 20:17:33.409 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
10822020-01-25 20:17:33.409 Info, Node002, Request RTT 1220 Average Request RTT 1147
10832020-01-25 20:17:33.423 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0x3d, 0x80, 0x2c, 0xb9, 0xc3, 0x64, 0xc2, 0x5f, 0xe9
10842020-01-25 20:17:33.423 Info, Node002, Received SecurityCmd_NonceReport from node 2
10852020-01-25 20:17:33.423 Info, Node002, Sending (Send) message (Callback ID=0x43, Expected Reply=0x04) - AlarmCmd_Get (Node=2): 0x01, 0x0c, 0x00, 0x13, 0x02, 0x05, 0x71, 0x04, 0x00, 0x08, 0x01, 0x25, 0x43, 0xfd
10862020-01-25 20:17:33.432 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
10872020-01-25 20:17:33.432 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
10882020-01-25 20:17:33.456 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x43, 0x00, 0xaa
10892020-01-25 20:17:33.456 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x43 received (expected 0x43)
10902020-01-25 20:17:33.456 Info, Node002, Request RTT 1267 Average Request RTT 1207
10912020-01-25 20:17:33.456 Detail, Expected callbackId was received
10922020-01-25 20:17:42.188 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
10932020-01-25 20:17:42.188 Detail, Node002, Removing current message
10942020-01-25 20:17:42.188 Detail, Node002, Notification: Notification - TimeOut
10952020-01-25 20:17:42.190 Detail,
10962020-01-25 20:17:42.190 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x40, Expected Reply=0x04)
10972020-01-25 20:17:42.190 Info, Node002, Sending (Send) message (Callback ID=0x40, Expected Reply=0x04) - Nonce_Get(BatteryCmd_Get) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
10982020-01-25 20:17:42.195 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
10992020-01-25 20:17:42.195 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
11002020-01-25 20:17:43.500 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
11012020-01-25 20:17:43.500 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
11022020-01-25 20:17:43.500 Info, Node002, Request RTT 1310 Average Request RTT 1258
11032020-01-25 20:17:43.514 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0xcd, 0x3e, 0x1b, 0xae, 0x23, 0xfd, 0xa1, 0xa1, 0x63
11042020-01-25 20:17:43.515 Info, Node002, Received SecurityCmd_NonceReport from node 2
11052020-01-25 20:17:43.515 Info, Node002, Sending (Send) message (Callback ID=0x44, Expected Reply=0x04) - BatteryCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x80, 0x02, 0x25, 0x44, 0x06
11062020-01-25 20:17:43.523 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
11072020-01-25 20:17:43.523 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
11082020-01-25 20:17:43.546 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x44, 0x00, 0xad
11092020-01-25 20:17:43.546 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x44 received (expected 0x44)
11102020-01-25 20:17:43.546 Info, Node002, Request RTT 1356 Average Request RTT 1307
11112020-01-25 20:17:43.546 Detail, Expected callbackId was received
11122020-01-25 20:17:51.399 Info, Soft-resetting the Z-Wave controller chip
11132020-01-25 20:17:51.399 Detail, contrlr, Queuing (Command) Soft-resetting the Z-Wave controller chip: 0x01, 0x03, 0x00, 0x08, 0xf4
11142020-01-25 20:17:52.190 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
11152020-01-25 20:17:52.191 Detail, Node002, Removing current message
11162020-01-25 20:17:52.191 Detail, Node002, Notification: Notification - TimeOut
11172020-01-25 20:17:52.192 Detail,
11182020-01-25 20:17:52.192 Info, contrlr, Sending (Command) message (Callback ID=0x00, Expected Reply=0x00) - Soft-resetting the Z-Wave controller chip: 0x01, 0x03, 0x00, 0x08, 0xf4
11192020-01-25 20:17:52.193 Detail, contrlr, Removing current message
11202020-01-25 20:17:52.193 Detail, Node002, Query Stage Complete (Dynamic)
11212020-01-25 20:17:52.193 Detail, Node002, AdvanceQueries queryPending=0 queryRetries=0 queryStage=Configuration live=1
11222020-01-25 20:17:52.193 Detail, Node002, QueryStage_Configuration
11232020-01-25 20:17:52.194 Detail, Node002, QueryStage_Complete
11242020-01-25 20:17:52.194 Warning, CheckCompletedNodeQueries m_allNodesQueried=1 m_awakeNodesQueried=1
11252020-01-25 20:17:52.194 Detail, Node002, Notification: NodeQueriesComplete
11262020-01-25 20:18:09.505 Detail, Node001, Queuing (Controller) Request Node Neighbor Update
11272020-01-25 20:18:09.506 Detail, Node002, Queuing (Controller) Request Node Neighbor Update
11282020-01-25 20:18:09.506 Info, Requesting Neighbor Update for node 1
11292020-01-25 20:18:09.506 Detail, Node001, Queuing (Command) ControllerCommand_RequestNodeNeighborUpdate (Node=1): 0x01, 0x05, 0x00, 0x48, 0x01, 0x45, 0xf6
11302020-01-25 20:18:09.506 Detail, Notification: ControllerCommand - Starting
11312020-01-25 20:18:09.506 Detail,
11322020-01-25 20:18:09.506 Info, Node001, Sending (Command) message (Callback ID=0x45, Expected Reply=0x48) - ControllerCommand_RequestNodeNeighborUpdate (Node=1): 0x01, 0x05, 0x00, 0x48, 0x01, 0x45, 0xf6
11332020-01-25 20:18:09.525 Detail, Node001, Received: 0x01, 0x05, 0x00, 0x48, 0x45, 0x21, 0xd6
11342020-01-25 20:18:09.525 Detail,
11352020-01-25 20:18:09.525 Info, Node001, REQUEST_NEIGHBOR_UPDATE_STARTED
11362020-01-25 20:18:09.525 Detail, Node033, Expected callbackId was received
11372020-01-25 20:18:09.525 Detail, Node033, Expected reply was received
11382020-01-25 20:18:09.525 Detail, Node033, Message transaction complete
11392020-01-25 20:18:09.525 Detail,
11402020-01-25 20:18:09.525 Detail, Node001, Removing current message
11412020-01-25 20:18:09.525 Detail, Notification: ControllerCommand - InProgress
11422020-01-25 20:18:09.525 Info, WriteNextMsg Controller nothing to do
11432020-01-25 20:18:15.481 Info, Node002, NoOperation::Set - Routing=true
11442020-01-25 20:18:15.481 Detail, Node002, Queuing (NoOp) NoOperation_Set (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x00, 0x00, 0x25, 0x46, 0x86
11452020-01-25 20:18:15.483 Detail,
11462020-01-25 20:18:15.483 Info, Node002, Sending (NoOp) message (Callback ID=0x46, Expected Reply=0x13) - NoOperation_Set (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x00, 0x00, 0x25, 0x46, 0x86
11472020-01-25 20:18:15.489 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
11482020-01-25 20:18:15.489 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
11492020-01-25 20:18:16.749 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x46, 0x00, 0xaf
11502020-01-25 20:18:16.749 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x46 received (expected 0x46)
11512020-01-25 20:18:16.749 Info, Node002, Request RTT 1265 Average Request RTT 1286
11522020-01-25 20:18:16.749 Detail, Expected callbackId was received
11532020-01-25 20:18:16.749 Detail, Expected reply was received
11542020-01-25 20:18:16.749 Detail, Message transaction complete
11552020-01-25 20:18:16.749 Detail,
11562020-01-25 20:18:16.749 Detail, Node002, Removing current message
11572020-01-25 20:18:16.749 Detail, Node002, Notification: Notification - NoOperation
11582020-01-25 20:18:32.222 Detail, Received: 0x01, 0x05, 0x00, 0x48, 0x45, 0x23, 0xd4
11592020-01-25 20:18:32.222 Detail,
11602020-01-25 20:18:32.222 Warning, WARNING: REQUEST_NEIGHBOR_UPDATE_FAILED
11612020-01-25 20:18:32.222 Detail, Notification: ControllerCommand - Failed
11622020-01-25 20:18:32.223 Info, Requesting Neighbor Update for node 2
11632020-01-25 20:18:32.223 Detail, Node002, Queuing (Command) ControllerCommand_RequestNodeNeighborUpdate (Node=2): 0x01, 0x05, 0x00, 0x48, 0x02, 0x47, 0xf7
11642020-01-25 20:18:32.223 Detail, Notification: ControllerCommand - Starting
11652020-01-25 20:18:32.223 Detail,
11662020-01-25 20:18:32.223 Info, Node002, Sending (Command) message (Callback ID=0x47, Expected Reply=0x48) - ControllerCommand_RequestNodeNeighborUpdate (Node=2): 0x01, 0x05, 0x00, 0x48, 0x02, 0x47, 0xf7
11672020-01-25 20:18:32.236 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x48, 0x47, 0x21, 0xd4
11682020-01-25 20:18:32.236 Detail,
11692020-01-25 20:18:32.236 Info, Node002, REQUEST_NEIGHBOR_UPDATE_STARTED
11702020-01-25 20:18:32.236 Detail, Node033, Expected callbackId was received
11712020-01-25 20:18:32.236 Detail, Node033, Expected reply was received
11722020-01-25 20:18:32.236 Detail, Node033, Message transaction complete
11732020-01-25 20:18:32.236 Detail,
11742020-01-25 20:18:32.236 Detail, Node002, Removing current message
11752020-01-25 20:18:32.236 Detail, Notification: ControllerCommand - InProgress
11762020-01-25 20:18:32.237 Info, WriteNextMsg Controller nothing to do
11772020-01-25 20:18:33.749 Detail, Received: 0x01, 0x05, 0x00, 0x48, 0x47, 0x22, 0xd7
11782020-01-25 20:18:33.749 Detail,
11792020-01-25 20:18:33.749 Info, REQUEST_NEIGHBOR_UPDATE_DONE
11802020-01-25 20:18:33.749 Detail, Requesting routing info (neighbor list) for Node 2
11812020-01-25 20:18:33.749 Detail, Node002, Queuing (Command) Get Routing Info (Node=2): 0x01, 0x07, 0x00, 0x80, 0x02, 0x00, 0x00, 0x03, 0x79
11822020-01-25 20:18:33.749 Detail, Notification: ControllerCommand - Completed
11832020-01-25 20:18:33.750 Detail,
11842020-01-25 20:18:33.750 Info, Node002, Sending (Command) message (Callback ID=0x00, Expected Reply=0x80) - Get Routing Info (Node=2): 0x01, 0x07, 0x00, 0x80, 0x02, 0x00, 0x00, 0x03, 0x79
11852020-01-25 20:18:33.755 Detail, Node002, Received: 0x01, 0x20, 0x01, 0x80, 0x01, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x5f
11862020-01-25 20:18:33.755 Detail,
11872020-01-25 20:18:33.756 Info, Node002, Received reply to FUNC_ID_ZW_GET_ROUTING_INFO
11882020-01-25 20:18:33.756 Info, Node002, Neighbors of this node are:
11892020-01-25 20:18:33.756 Info, Node002, Node 1
11902020-01-25 20:18:33.756 Detail, Expected reply was received
11912020-01-25 20:18:33.756 Detail, Message transaction complete
11922020-01-25 20:18:33.756 Detail,
11932020-01-25 20:18:33.756 Detail, Node002, Removing current message
11942020-01-25 20:19:10.891 Info, Node002, Value::Set - COMMAND_CLASS_DOOR_LOCK - Locked - 0 - 1 - False
11952020-01-25 20:19:10.891 Info, Node002, Value_Lock::Set - Requesting lock to be Unlocked
11962020-01-25 20:19:10.891 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_DOOR_LOCK
11972020-01-25 20:19:10.891 Detail, Node002, Queuing (Send) DoorLockCmd_Set (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x62, 0x01, 0x00, 0x25, 0x48, 0xe9
11982020-01-25 20:19:10.891 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_DOOR_LOCK
11992020-01-25 20:19:10.891 Detail, Node002, Queuing (Send) DoorLockCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x62, 0x02, 0x25, 0x49, 0xe9
12002020-01-25 20:19:10.891 Detail,
12012020-01-25 20:19:10.892 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x48, Expected Reply=0x04)
12022020-01-25 20:19:10.892 Info, Node002, Sending (Send) message (Callback ID=0x48, Expected Reply=0x04) - Nonce_Get(DoorLockCmd_Set) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
12032020-01-25 20:19:10.898 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
12042020-01-25 20:19:10.898 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
12052020-01-25 20:19:12.042 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
12062020-01-25 20:19:12.042 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
12072020-01-25 20:19:12.042 Info, Node002, Request RTT 1151 Average Request RTT 1218
12082020-01-25 20:19:12.056 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0x2c, 0xfc, 0x86, 0x50, 0xef, 0xd5, 0xe7, 0x2c, 0x0c
12092020-01-25 20:19:12.056 Info, Node002, Received SecurityCmd_NonceReport from node 2
12102020-01-25 20:19:12.056 Info, Node002, Sending (Send) message (Callback ID=0x4a, Expected Reply=0x04) - DoorLockCmd_Set (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x62, 0x01, 0x00, 0x25, 0x4a, 0xeb
12112020-01-25 20:19:12.065 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
12122020-01-25 20:19:12.065 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
12132020-01-25 20:19:12.088 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x4a, 0x00, 0xa3
12142020-01-25 20:19:12.088 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x4a received (expected 0x4a)
12152020-01-25 20:19:12.088 Info, Node002, Request RTT 1197 Average Request RTT 1207
12162020-01-25 20:19:12.089 Detail, Expected callbackId was received
12172020-01-25 20:19:19.941 Detail, Node002, Received: 0x01, 0x08, 0x00, 0x04, 0x00, 0x02, 0x02, 0x98, 0x40, 0x2b
12182020-01-25 20:19:19.941 Info, Node002, Received SecurityCmd_NonceGet from node 2
12192020-01-25 20:19:19.941 Info, NONCES: 0xfd, 0xf1, 0xc5, 0x6e, 0xba, 0x66, 0x6f, 0xe9
12202020-01-25 20:19:19.941 Info, NONCES: 0x47, 0x3e, 0x66, 0x80, 0x77, 0x05, 0x0d, 0xdf
12212020-01-25 20:19:19.941 Info, NONCES: 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00
12222020-01-25 20:19:19.941 Info, NONCES: 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00
12232020-01-25 20:19:19.941 Info, NONCES: 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00
12242020-01-25 20:19:19.941 Info, NONCES: 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00
12252020-01-25 20:19:19.942 Info, NONCES: 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00
12262020-01-25 20:19:19.942 Info, NONCES: 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00
12272020-01-25 20:19:19.942 Info, Node002, Sending (Send) message (Callback ID=0x01, Expected Reply=0x04) - Nonce_Report - 0x01, 0x11, 0x00, 0x13, 0x02, 0x0a, 0x98, 0x80, 0x47, 0x3e, 0x66, 0x80, 0x77, 0x05, 0x0d, 0xdf, 0x05, 0x01, 0xd6:
12282020-01-25 20:19:19.948 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
12292020-01-25 20:19:19.948 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
12302020-01-25 20:19:19.969 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x01, 0x00, 0xe8
12312020-01-25 20:19:19.969 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x01 received (expected 0x01)
12322020-01-25 20:19:19.969 Info, Node002, Request RTT 9077 Average Request RTT 5142
12332020-01-25 20:19:19.993 Detail, Node002, Received: 0x01, 0x24, 0x00, 0x04, 0x00, 0x02, 0x1e, 0x98, 0x81, 0x52, 0x48, 0x26, 0xc3, 0x2b, 0xa1, 0x73, 0x9a, 0x21, 0x6f, 0x80, 0x26, 0xa3, 0xbf, 0xaf, 0xce, 0xba, 0x0e, 0xa2, 0x47, 0xa0, 0x37, 0x41, 0xc8, 0x72, 0xe4, 0xee, 0x52, 0xb6
12342020-01-25 20:19:19.993 Info, Raw: 0x98, 0x81, 0x52, 0x48, 0x26, 0xc3, 0x2b, 0xa1, 0x73, 0x9a, 0x21, 0x6f, 0x80, 0x26, 0xa3, 0xbf, 0xaf, 0xce, 0xba, 0x0e, 0xa2, 0x47, 0xa0, 0x37, 0x41, 0xc8, 0x72, 0xe4, 0xee, 0x52, 0xb6
12352020-01-25 20:19:19.993 Detail, Node002, Decrypted Packet: 0x6c, 0x61, 0x83, 0xf1, 0x4f, 0x26, 0x59, 0xe3, 0xf3, 0xe3, 0x4a
12362020-01-25 20:19:19.993 Warning, Node002, MAC Authentication of Packet Failed. Dropping
12372020-01-25 20:19:19.993 Detail, Node002, Removing current message
12382020-01-25 20:19:19.993 Detail,
12392020-01-25 20:19:19.993 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x49, Expected Reply=0x04)
12402020-01-25 20:19:19.993 Info, Node002, Sending (Send) message (Callback ID=0x49, Expected Reply=0x04) - Nonce_Get(DoorLockCmd_Get) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
12412020-01-25 20:19:19.999 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
12422020-01-25 20:19:19.999 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
12432020-01-25 20:19:20.018 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
12442020-01-25 20:19:20.018 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
12452020-01-25 20:19:20.018 Info, Node002, Request RTT 25 Average Request RTT 2583
12462020-01-25 20:19:20.032 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0xd6, 0x7f, 0xeb, 0xef, 0xaa, 0xde, 0xd9, 0x05, 0xfe
12472020-01-25 20:19:20.032 Info, Node002, Received SecurityCmd_NonceReport from node 2
12482020-01-25 20:19:20.032 Info, Node002, Sending (Send) message (Callback ID=0x4b, Expected Reply=0x04) - DoorLockCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x62, 0x02, 0x25, 0x4b, 0xeb
12492020-01-25 20:19:20.041 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
12502020-01-25 20:19:20.041 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
12512020-01-25 20:19:20.064 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x4b, 0x00, 0xa2
12522020-01-25 20:19:20.064 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x4b received (expected 0x4b)
12532020-01-25 20:19:20.064 Info, Node002, Request RTT 71 Average Request RTT 1327
12542020-01-25 20:19:20.064 Detail, Expected callbackId was received
12552020-01-25 20:19:21.382 Detail, Node002, Received: 0x01, 0x08, 0x00, 0x04, 0x00, 0x02, 0x02, 0x98, 0x40, 0x2b
12562020-01-25 20:19:21.382 Info, Node002, Received SecurityCmd_NonceGet from node 2
12572020-01-25 20:19:21.382 Info, NONCES: 0xfd, 0xf1, 0xc5, 0x6e, 0xba, 0x66, 0x6f, 0xe9
12582020-01-25 20:19:21.382 Info, NONCES: 0x47, 0x3e, 0x66, 0x80, 0x77, 0x05, 0x0d, 0xdf
12592020-01-25 20:19:21.382 Info, NONCES: 0x48, 0x97, 0x09, 0xcc, 0x77, 0xb5, 0x14, 0xb7
12602020-01-25 20:19:21.382 Info, NONCES: 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00
12612020-01-25 20:19:21.382 Info, NONCES: 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00
12622020-01-25 20:19:21.382 Info, NONCES: 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00
12632020-01-25 20:19:21.382 Info, NONCES: 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00
12642020-01-25 20:19:21.382 Info, NONCES: 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00
12652020-01-25 20:19:21.382 Info, Node002, Sending (Send) message (Callback ID=0x01, Expected Reply=0x04) - Nonce_Report - 0x01, 0x11, 0x00, 0x13, 0x02, 0x0a, 0x98, 0x80, 0x48, 0x97, 0x09, 0xcc, 0x77, 0xb5, 0x14, 0xb7, 0x05, 0x01, 0x92:
12662020-01-25 20:19:21.389 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
12672020-01-25 20:19:21.389 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
12682020-01-25 20:19:21.410 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x01, 0x00, 0xe8
12692020-01-25 20:19:21.410 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x01 received (expected 0x01)
12702020-01-25 20:19:21.410 Info, Node002, Request RTT 1418 Average Request RTT 1372
12712020-01-25 20:19:21.433 Detail, Node002, Received: 0x01, 0x24, 0x00, 0x04, 0x00, 0x02, 0x1e, 0x98, 0x81, 0x97, 0x45, 0xc9, 0xe1, 0x85, 0xb6, 0xc0, 0x21, 0xa7, 0x60, 0xf4, 0xa1, 0xba, 0x75, 0x7a, 0x16, 0x59, 0xdd, 0xdb, 0x48, 0x5d, 0x67, 0xc8, 0x85, 0x53, 0x09, 0x3f, 0xf3, 0x35
12722020-01-25 20:19:21.433 Info, Raw: 0x98, 0x81, 0x97, 0x45, 0xc9, 0xe1, 0x85, 0xb6, 0xc0, 0x21, 0xa7, 0x60, 0xf4, 0xa1, 0xba, 0x75, 0x7a, 0x16, 0x59, 0xdd, 0xdb, 0x48, 0x5d, 0x67, 0xc8, 0x85, 0x53, 0x09, 0x3f, 0xf3, 0x35
12732020-01-25 20:19:21.434 Detail, Node002, Decrypted Packet: 0x35, 0xcf, 0x5a, 0x98, 0xce, 0x28, 0x77, 0x67, 0xc9, 0xda, 0x35
12742020-01-25 20:19:21.434 Warning, Node002, MAC Authentication of Packet Failed. Dropping
12752020-01-25 20:19:21.434 Detail, Node002, Removing current message
12762020-01-25 20:19:22.086 Detail, Node002, Received: 0x01, 0x08, 0x00, 0x04, 0x00, 0x02, 0x02, 0x98, 0x40, 0x2b
12772020-01-25 20:19:22.086 Info, Node002, Received SecurityCmd_NonceGet from node 2
12782020-01-25 20:19:22.086 Info, NONCES: 0xfd, 0xf1, 0xc5, 0x6e, 0xba, 0x66, 0x6f, 0xe9
12792020-01-25 20:19:22.086 Info, NONCES: 0x47, 0x3e, 0x66, 0x80, 0x77, 0x05, 0x0d, 0xdf
12802020-01-25 20:19:22.086 Info, NONCES: 0x48, 0x97, 0x09, 0xcc, 0x77, 0xb5, 0x14, 0xb7
12812020-01-25 20:19:22.086 Info, NONCES: 0xc5, 0x47, 0xfb, 0x3b, 0x0c, 0x26, 0xc6, 0x8c
12822020-01-25 20:19:22.086 Info, NONCES: 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00
12832020-01-25 20:19:22.086 Info, NONCES: 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00
12842020-01-25 20:19:22.086 Info, NONCES: 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00
12852020-01-25 20:19:22.087 Info, NONCES: 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00, 0x00
12862020-01-25 20:19:22.087 Info, Node002, Sending (Send) message (Callback ID=0x01, Expected Reply=0x00) - Nonce_Report - 0x01, 0x11, 0x00, 0x13, 0x02, 0x0a, 0x98, 0x80, 0xc5, 0x47, 0xfb, 0x3b, 0x0c, 0x26, 0xc6, 0x8c, 0x05, 0x01, 0xcb:
12872020-01-25 20:19:22.093 Detail, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
12882020-01-25 20:19:22.093 Detail, ZW_SEND_DATA delivered to Z-Wave stack
12892020-01-25 20:19:22.114 Detail, Received: 0x01, 0x05, 0x00, 0x13, 0x01, 0x00, 0xe8
12902020-01-25 20:19:22.114 Detail, ZW_SEND_DATA Request with callback ID 0x01 received (expected 0x01)
12912020-01-25 20:19:22.138 Detail, Node002, Received: 0x01, 0x24, 0x00, 0x04, 0x00, 0x02, 0x1e, 0x98, 0x81, 0x29, 0x0b, 0x8f, 0x38, 0x68, 0xe8, 0xce, 0xf0, 0xba, 0x13, 0xa9, 0x60, 0x82, 0x55, 0xfd, 0x6e, 0x5b, 0x35, 0xb8, 0xc5, 0x1b, 0xec, 0x7c, 0xc7, 0xf4, 0xa3, 0x14, 0xf0, 0x39
12922020-01-25 20:19:22.138 Info, Raw: 0x98, 0x81, 0x29, 0x0b, 0x8f, 0x38, 0x68, 0xe8, 0xce, 0xf0, 0xba, 0x13, 0xa9, 0x60, 0x82, 0x55, 0xfd, 0x6e, 0x5b, 0x35, 0xb8, 0xc5, 0x1b, 0xec, 0x7c, 0xc7, 0xf4, 0xa3, 0x14, 0xf0, 0x39
12932020-01-25 20:19:22.138 Detail, Node002, Decrypted Packet: 0x50, 0x7e, 0xf4, 0x4e, 0xdd, 0x4e, 0xa4, 0x4e, 0x79, 0x7e, 0xb7
12942020-01-25 20:19:22.138 Warning, Node002, MAC Authentication of Packet Failed. Dropping
12952020-01-25 20:19:22.138 Detail, Removing current message
12962020-01-25 20:19:23.948 Info, Node002, Value::Set - COMMAND_CLASS_DOOR_LOCK - Locked - 0 - 1 - False
12972020-01-25 20:19:23.948 Info, Node002, Value_Lock::Set - Requesting lock to be Unlocked
12982020-01-25 20:19:23.948 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_DOOR_LOCK
12992020-01-25 20:19:23.948 Detail, Node002, Queuing (Send) DoorLockCmd_Set (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x62, 0x01, 0x00, 0x25, 0x4c, 0xed
13002020-01-25 20:19:23.949 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_DOOR_LOCK
13012020-01-25 20:19:23.949 Detail, Node002, Queuing (Send) DoorLockCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x62, 0x02, 0x25, 0x4d, 0xed
13022020-01-25 20:19:23.949 Detail,
13032020-01-25 20:19:23.949 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x4c, Expected Reply=0x04)
13042020-01-25 20:19:23.949 Info, Node002, Sending (Send) message (Callback ID=0x4c, Expected Reply=0x04) - Nonce_Get(DoorLockCmd_Set) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
13052020-01-25 20:19:23.954 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
13062020-01-25 20:19:23.954 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
13072020-01-25 20:19:23.973 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
13082020-01-25 20:19:23.973 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
13092020-01-25 20:19:23.973 Info, Node002, Request RTT 24 Average Request RTT 698
13102020-01-25 20:19:23.988 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0xa5, 0xb9, 0xbc, 0xfb, 0xb1, 0x0a, 0x69, 0x18, 0x6a
13112020-01-25 20:19:23.988 Info, Node002, Received SecurityCmd_NonceReport from node 2
13122020-01-25 20:19:23.988 Info, Node002, Sending (Send) message (Callback ID=0x4e, Expected Reply=0x04) - DoorLockCmd_Set (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x62, 0x01, 0x00, 0x25, 0x4e, 0xef
13132020-01-25 20:19:23.996 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
13142020-01-25 20:19:23.997 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
13152020-01-25 20:19:24.020 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x4e, 0x00, 0xa7
13162020-01-25 20:19:24.020 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x4e received (expected 0x4e)
13172020-01-25 20:19:24.020 Info, Node002, Request RTT 72 Average Request RTT 385
13182020-01-25 20:19:24.020 Detail, Expected callbackId was received
13192020-01-25 20:19:33.948 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
13202020-01-25 20:19:33.948 Detail, Node002, Removing current message
13212020-01-25 20:19:33.948 Detail, Node002, Notification: Notification - TimeOut
13222020-01-25 20:19:33.950 Detail,
13232020-01-25 20:19:33.950 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x4d, Expected Reply=0x04)
13242020-01-25 20:19:33.950 Info, Node002, Sending (Send) message (Callback ID=0x4d, Expected Reply=0x04) - Nonce_Get(DoorLockCmd_Get) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
13252020-01-25 20:19:33.955 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
13262020-01-25 20:19:33.955 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
13272020-01-25 20:19:35.230 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
13282020-01-25 20:19:35.230 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
13292020-01-25 20:19:35.230 Info, Node002, Request RTT 1281 Average Request RTT 833
13302020-01-25 20:19:35.244 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0xdf, 0xe2, 0x84, 0xc7, 0xd7, 0xc3, 0xef, 0xe3, 0x9d
13312020-01-25 20:19:35.245 Info, Node002, Received SecurityCmd_NonceReport from node 2
13322020-01-25 20:19:35.245 Info, Node002, Sending (Send) message (Callback ID=0x4f, Expected Reply=0x04) - DoorLockCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x62, 0x02, 0x25, 0x4f, 0xef
13332020-01-25 20:19:35.253 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
13342020-01-25 20:19:35.253 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
13352020-01-25 20:19:35.276 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x4f, 0x00, 0xa6
13362020-01-25 20:19:35.276 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x4f received (expected 0x4f)
13372020-01-25 20:19:35.276 Info, Node002, Request RTT 1327 Average Request RTT 1080
13382020-01-25 20:19:35.276 Detail, Expected callbackId was received
13392020-01-25 20:19:43.949 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
13402020-01-25 20:19:44.109 Detail, Node002, Removing current message
13412020-01-25 20:19:44.110 Detail, Node002, Notification: Notification - TimeOut
13422020-01-25 20:25:34.743 Info, Node002, Value::Set - COMMAND_CLASS_DOOR_LOCK - Locked - 0 - 1 - False
13432020-01-25 20:25:34.743 Info, Node002, Value_Lock::Set - Requesting lock to be Unlocked
13442020-01-25 20:25:34.743 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_DOOR_LOCK
13452020-01-25 20:25:34.743 Detail, Node002, Queuing (Send) DoorLockCmd_Set (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x62, 0x01, 0x00, 0x25, 0x50, 0xf1
13462020-01-25 20:25:34.743 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_DOOR_LOCK
13472020-01-25 20:25:34.743 Detail, Node002, Queuing (Send) DoorLockCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x62, 0x02, 0x25, 0x51, 0xf1
13482020-01-25 20:25:34.743 Detail,
13492020-01-25 20:25:34.744 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x50, Expected Reply=0x04)
13502020-01-25 20:25:34.744 Info, Node002, Sending (Send) message (Callback ID=0x50, Expected Reply=0x04) - Nonce_Get(DoorLockCmd_Set) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
13512020-01-25 20:25:34.749 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
13522020-01-25 20:25:34.749 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
13532020-01-25 20:25:36.024 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
13542020-01-25 20:25:36.024 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
13552020-01-25 20:25:36.024 Info, Node002, Request RTT 1281 Average Request RTT 1180
13562020-01-25 20:25:36.039 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0xe8, 0x60, 0xf1, 0x00, 0x8f, 0xd5, 0x31, 0x2e, 0xc7
13572020-01-25 20:25:36.039 Info, Node002, Received SecurityCmd_NonceReport from node 2
13582020-01-25 20:25:36.039 Info, Node002, Sending (Send) message (Callback ID=0x52, Expected Reply=0x04) - DoorLockCmd_Set (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x62, 0x01, 0x00, 0x25, 0x52, 0xf3
13592020-01-25 20:25:36.047 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
13602020-01-25 20:25:36.047 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
13612020-01-25 20:25:36.071 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x52, 0x00, 0xbb
13622020-01-25 20:25:36.071 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x52 received (expected 0x52)
13632020-01-25 20:25:36.071 Info, Node002, Request RTT 1327 Average Request RTT 1253
13642020-01-25 20:25:36.071 Detail, Expected callbackId was received
13652020-01-25 20:25:44.744 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
13662020-01-25 20:25:44.744 Detail, Node002, Removing current message
13672020-01-25 20:25:44.744 Detail, Node002, Notification: Notification - TimeOut
13682020-01-25 20:25:44.746 Detail,
13692020-01-25 20:25:44.746 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x51, Expected Reply=0x04)
13702020-01-25 20:25:44.746 Info, Node002, Sending (Send) message (Callback ID=0x51, Expected Reply=0x04) - Nonce_Get(DoorLockCmd_Get) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
13712020-01-25 20:25:44.751 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
13722020-01-25 20:25:44.751 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
13732020-01-25 20:25:45.996 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
13742020-01-25 20:25:45.996 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
13752020-01-25 20:25:45.996 Info, Node002, Request RTT 1250 Average Request RTT 1251
13762020-01-25 20:25:46.010 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0x9e, 0x34, 0xae, 0x0e, 0xa9, 0xea, 0x43, 0x32, 0xc3
13772020-01-25 20:25:46.010 Info, Node002, Received SecurityCmd_NonceReport from node 2
13782020-01-25 20:25:46.011 Info, Node002, Sending (Send) message (Callback ID=0x53, Expected Reply=0x04) - DoorLockCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x62, 0x02, 0x25, 0x53, 0xf3
13792020-01-25 20:25:46.019 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
13802020-01-25 20:25:46.019 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
13812020-01-25 20:25:46.043 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x53, 0x00, 0xba
13822020-01-25 20:25:46.043 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x53 received (expected 0x53)
13832020-01-25 20:25:46.043 Info, Node002, Request RTT 1297 Average Request RTT 1274
13842020-01-25 20:25:46.043 Detail, Expected callbackId was received
13852020-01-25 20:25:54.745 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
13862020-01-25 20:25:54.745 Detail, Node002, Removing current message
13872020-01-25 20:25:54.745 Detail, Node002, Notification: Notification - TimeOut
13882020-01-25 20:26:09.811 Info, Node002, Value::Set - COMMAND_CLASS_DOOR_LOCK - Locked - 0 - 1 - False
13892020-01-25 20:26:09.811 Info, Node002, Value_Lock::Set - Requesting lock to be Unlocked
13902020-01-25 20:26:09.811 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_DOOR_LOCK
13912020-01-25 20:26:09.811 Detail, Node002, Queuing (Send) DoorLockCmd_Set (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x62, 0x01, 0x00, 0x25, 0x54, 0xf5
13922020-01-25 20:26:09.811 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_DOOR_LOCK
13932020-01-25 20:26:09.811 Detail, Node002, Queuing (Send) DoorLockCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x62, 0x02, 0x25, 0x55, 0xf5
13942020-01-25 20:26:09.811 Detail,
13952020-01-25 20:26:09.812 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x54, Expected Reply=0x04)
13962020-01-25 20:26:09.812 Info, Node002, Sending (Send) message (Callback ID=0x54, Expected Reply=0x04) - Nonce_Get(DoorLockCmd_Set) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
13972020-01-25 20:26:09.817 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
13982020-01-25 20:26:09.817 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
13992020-01-25 20:26:11.077 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
14002020-01-25 20:26:11.077 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
14012020-01-25 20:26:11.077 Info, Node002, Request RTT 1266 Average Request RTT 1270
14022020-01-25 20:26:11.092 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0x07, 0x55, 0x06, 0xc4, 0xa8, 0x03, 0x1c, 0x9d, 0x41
14032020-01-25 20:26:11.092 Info, Node002, Received SecurityCmd_NonceReport from node 2
14042020-01-25 20:26:11.092 Info, Node002, Sending (Send) message (Callback ID=0x56, Expected Reply=0x04) - DoorLockCmd_Set (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x62, 0x01, 0x00, 0x25, 0x56, 0xf7
14052020-01-25 20:26:11.100 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
14062020-01-25 20:26:11.100 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
14072020-01-25 20:26:11.124 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x56, 0x00, 0xbf
14082020-01-25 20:26:11.124 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x56 received (expected 0x56)
14092020-01-25 20:26:11.124 Info, Node002, Request RTT 1313 Average Request RTT 1291
14102020-01-25 20:26:11.124 Detail, Expected callbackId was received
14112020-01-25 20:26:19.811 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
14122020-01-25 20:26:19.811 Detail, Node002, Removing current message
14132020-01-25 20:26:19.811 Detail, Node002, Notification: Notification - TimeOut
14142020-01-25 20:26:19.813 Detail,
14152020-01-25 20:26:19.813 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x55, Expected Reply=0x04)
14162020-01-25 20:26:19.813 Info, Node002, Sending (Send) message (Callback ID=0x55, Expected Reply=0x04) - Nonce_Get(DoorLockCmd_Get) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
14172020-01-25 20:26:19.818 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
14182020-01-25 20:26:19.818 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
14192020-01-25 20:26:21.093 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
14202020-01-25 20:26:21.093 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
14212020-01-25 20:26:21.093 Info, Node002, Request RTT 1281 Average Request RTT 1286
14222020-01-25 20:26:21.107 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0x61, 0xb8, 0x6d, 0x07, 0x93, 0xd5, 0xa5, 0xc4, 0x6f
14232020-01-25 20:26:21.108 Info, Node002, Received SecurityCmd_NonceReport from node 2
14242020-01-25 20:26:21.108 Info, Node002, Sending (Send) message (Callback ID=0x57, Expected Reply=0x04) - DoorLockCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x62, 0x02, 0x25, 0x57, 0xf7
14252020-01-25 20:26:21.116 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
14262020-01-25 20:26:21.116 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
14272020-01-25 20:26:21.139 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x57, 0x00, 0xbe
14282020-01-25 20:26:21.139 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x57 received (expected 0x57)
14292020-01-25 20:26:21.139 Info, Node002, Request RTT 1327 Average Request RTT 1306
14302020-01-25 20:26:21.139 Detail, Expected callbackId was received
14312020-01-25 20:26:29.813 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
14322020-01-25 20:26:29.813 Detail, Node002, Removing current message
14332020-01-25 20:26:29.813 Detail, Node002, Notification: Notification - TimeOut
14342020-01-25 20:26:32.653 Info, Node002, Value::Set - COMMAND_CLASS_DOOR_LOCK - Locked - 0 - 1 - False
14352020-01-25 20:26:32.653 Info, Node002, Value_Lock::Set - Requesting lock to be Unlocked
14362020-01-25 20:26:32.653 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_DOOR_LOCK
14372020-01-25 20:26:32.653 Detail, Node002, Queuing (Send) DoorLockCmd_Set (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x62, 0x01, 0x00, 0x25, 0x58, 0xf9
14382020-01-25 20:26:32.653 Detail, Node002, Setting Encryption Flag on Message For Command Class COMMAND_CLASS_DOOR_LOCK
14392020-01-25 20:26:32.654 Detail, Node002, Queuing (Send) DoorLockCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x62, 0x02, 0x25, 0x59, 0xf9
14402020-01-25 20:26:32.654 Detail,
14412020-01-25 20:26:32.654 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x58, Expected Reply=0x04)
14422020-01-25 20:26:32.654 Info, Node002, Sending (Send) message (Callback ID=0x58, Expected Reply=0x04) - Nonce_Get(DoorLockCmd_Set) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
14432020-01-25 20:26:32.660 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
14442020-01-25 20:26:32.660 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
14452020-01-25 20:26:33.919 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
14462020-01-25 20:26:33.919 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
14472020-01-25 20:26:33.919 Info, Node002, Request RTT 1265 Average Request RTT 1285
14482020-01-25 20:26:33.934 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0x82, 0x84, 0xbf, 0xe4, 0xb0, 0x2d, 0x12, 0xd8, 0xf1
14492020-01-25 20:26:33.934 Info, Node002, Received SecurityCmd_NonceReport from node 2
14502020-01-25 20:26:33.934 Info, Node002, Sending (Send) message (Callback ID=0x5a, Expected Reply=0x04) - DoorLockCmd_Set (Node=2): 0x01, 0x0a, 0x00, 0x13, 0x02, 0x03, 0x62, 0x01, 0x00, 0x25, 0x5a, 0xfb
14512020-01-25 20:26:33.942 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
14522020-01-25 20:26:33.943 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
14532020-01-25 20:26:33.966 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x5a, 0x00, 0xb3
14542020-01-25 20:26:33.966 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x5a received (expected 0x5a)
14552020-01-25 20:26:33.966 Info, Node002, Request RTT 1311 Average Request RTT 1298
14562020-01-25 20:26:33.966 Detail, Expected callbackId was received
14572020-01-25 20:26:42.655 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
14582020-01-25 20:26:42.655 Detail, Node002, Removing current message
14592020-01-25 20:26:42.655 Detail, Node002, Notification: Notification - TimeOut
14602020-01-25 20:26:42.657 Detail,
14612020-01-25 20:26:42.657 Info, Node002, Processing (Send) Nonce Request message (Callback ID=0x59, Expected Reply=0x04)
14622020-01-25 20:26:42.657 Info, Node002, Sending (Send) message (Callback ID=0x59, Expected Reply=0x04) - Nonce_Get(DoorLockCmd_Get) - 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x98, 0x40, 0x05, 0x02:
14632020-01-25 20:26:42.662 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
14642020-01-25 20:26:42.662 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
14652020-01-25 20:26:43.912 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x02, 0x00, 0xeb
14662020-01-25 20:26:43.913 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x02 received (expected 0x02)
14672020-01-25 20:26:43.913 Info, Node002, Request RTT 1255 Average Request RTT 1276
14682020-01-25 20:26:43.927 Detail, Node002, Received: 0x01, 0x10, 0x00, 0x04, 0x00, 0x02, 0x0a, 0x98, 0x80, 0x26, 0xbd, 0x46, 0xe2, 0x55, 0xde, 0xe5, 0xd7, 0x7d
14692020-01-25 20:26:43.927 Info, Node002, Received SecurityCmd_NonceReport from node 2
14702020-01-25 20:26:43.927 Info, Node002, Sending (Send) message (Callback ID=0x5b, Expected Reply=0x04) - DoorLockCmd_Get (Node=2): 0x01, 0x09, 0x00, 0x13, 0x02, 0x02, 0x62, 0x02, 0x25, 0x5b, 0xfb
14712020-01-25 20:26:43.936 Detail, Node002, Received: 0x01, 0x04, 0x01, 0x13, 0x01, 0xe8
14722020-01-25 20:26:43.936 Detail, Node002, ZW_SEND_DATA delivered to Z-Wave stack
14732020-01-25 20:26:43.959 Detail, Node002, Received: 0x01, 0x05, 0x00, 0x13, 0x5b, 0x00, 0xb2
14742020-01-25 20:26:43.962 Detail, Node002, ZW_SEND_DATA Request with callback ID 0x5b received (expected 0x5b)
14752020-01-25 20:26:43.962 Info, Node002, Request RTT 1305 Average Request RTT 1290
14762020-01-25 20:26:43.962 Detail, Expected callbackId was received
14772020-01-25 20:26:52.658 Error, Node002, ERROR: Dropping command, expected response not received after 1 attempt(s)
14782020-01-25 20:26:52.658 Detail, Node002, Removing current message
14792020-01-25 20:26:52.658 Detail, Node002, Notification: Notification - TimeOut