11:55:05.699 Running procedure: 8.2.5.2.1
11:55:05.704 This procedure is enabled because the following options:
11:55:05.704 - supports.binaryOutput.status == true
11:55:05.704 step: 3
11:55:05.704 - DUT supports Latch On/NUL and Latch Off/NUL pair.
11:55:05.705 step: 4
11:55:05.705 - Direct Operate(0x05) fir: 1 fin: 1 con: 0 uns: 0 seq: 0x00
11:55:05.705 - g12v1, 1-Byte Count and Index, count: 1
11:55:05.705 - [2] - code: 3 count: 10 onTime: 500 offTime: 600 status: 0
11:55:05.706 --A-> Direct Operate(0x05) fir: 1 fin: 1 con: 0 uns: 0 seq: 0x00
11:55:05.706 g12v1, 1-Byte Count and Index, count: 1
11:55:05.706 [2] - code: 3 count: 10 onTime: 500 offTime: 600 status: 0
11:55:05.707 --T-> fir: 1 fin: 1 seq: 0
11:55:05.707 --L-> master: 1 pri: 1 fcb: 0 fcv: 0 func: UNCONFIRMED_USER_DATA(0x04) 0xC4 length: 24 dest: 1024 src: 1
11:55:05.708 --P-> 05 64 18 C4 00 04 01 00 5B 61
11:55:05.708 C0 C0 05 0C 01 17 01 02 03 0A F4 01 00 00 58 02 9D 05
11:55:05.708 00 00 00 FF FF
11:55:05.708 step: 5
11:55:05.708 - Check that binary control point 2 operate
11:55:05.709 step: 6
11:55:05.709 - Direct Operate(0x05) fir: 1 fin: 1 con: 0 uns: 0 seq: 0x00
11:55:05.709 - g12v1, 1-Byte Count and Index, count: 1
11:55:05.709 - [2] - code: 4 count: 10 onTime: 500 offTime: 600 status: 0
11:55:05.710 --A-> Direct Operate(0x05) fir: 1 fin: 1 con: 0 uns: 0 seq: 0x00
11:55:05.710 g12v1, 1-Byte Count and Index, count: 1
11:55:05.710 [2] - code: 4 count: 10 onTime: 500 offTime: 600 status: 0
11:55:05.710 --T-> fir: 1 fin: 1 seq: 0
11:55:05.710 --L-> master: 1 pri: 1 fcb: 0 fcv: 0 func: UNCONFIRMED_USER_DATA(0x04) 0xC4 length: 24 dest: 1024 src: 1
11:55:05.711 --P-> 05 64 18 C4 00 04 01 00 5B 61
11:55:05.711 C0 C0 05 0C 01 17 01 02 04 0A F4 01 00 00 58 02 E3 67
11:55:05.711 00 00 00 FF FF
11:55:05.712 step: 7
11:55:05.712 - Check that binary control point 2 operate
11:55:05.712 step: 8
11:55:05.712 - DUT supports Pulse On/Close and Pulse On/Trip pair.
11:55:05.713 step: 9
11:55:05.713 - Direct Operate(0x05) fir: 1 fin: 1 con: 0 uns: 0 seq: 0x00
11:55:05.713 - g12v1, 1-Byte Count and Index, count: 1
11:55:05.713 - [3] - code: 65 count: 15 onTime: 700 offTime: 800 status: 0
11:55:05.714 --A-> Direct Operate(0x05) fir: 1 fin: 1 con: 0 uns: 0 seq: 0x00
11:55:05.714 g12v1, 1-Byte Count and Index, count: 1
11:55:05.714 [3] - code: 65 count: 15 onTime: 700 offTime: 800 status: 0
11:55:05.714 --T-> fir: 1 fin: 1 seq: 0
11:55:05.715 --L-> master: 1 pri: 1 fcb: 0 fcv: 0 func: UNCONFIRMED_USER_DATA(0x04) 0xC4 length: 24 dest: 1024 src: 1
11:55:05.716 --P-> 05 64 18 C4 00 04 01 00 5B 61
11:55:05.716 C0 C0 05 0C 01 17 01 03 41 0F BC 02 00 00 20 03 C4 A6
11:55:05.716 00 00 00 FF FF
11:55:05.716 step: 10
11:55:05.716 - Check that binary control point 3 operate
11:55:05.717 step: 11
11:55:05.717 - Direct Operate(0x05) fir: 1 fin: 1 con: 0 uns: 0 seq: 0x00
11:55:05.717 - g12v1, 1-Byte Count and Index, count: 1
11:55:05.717 - [3] - code: 129 count: 15 onTime: 700 offTime: 800 status: 0
11:55:05.718 --A-> Direct Operate(0x05) fir: 1 fin: 1 con: 0 uns: 0 seq: 0x00
11:55:05.718 g12v1, 1-Byte Count and Index, count: 1
11:55:05.718 [3] - code: 129 count: 15 onTime: 700 offTime: 800 status: 0
11:55:05.718 --T-> fir: 1 fin: 1 seq: 0
11:55:05.718 --L-> master: 1 pri: 1 fcb: 0 fcv: 0 func: UNCONFIRMED_USER_DATA(0x04) 0xC4 length: 24 dest: 1024 src: 1
11:55:05.719 --P-> 05 64 18 C4 00 04 01 00 5B 61
11:55:05.719 C0 C0 05 0C 01 17 01 03 81 0F BC 02 00 00 20 03 11 38
11:55:05.719 00 00 00 FF FF
11:55:05.720 step: 12
11:55:05.720 - Check that binary control point 3 operate
11:55:05.720 step: 13
11:55:05.720 - DUT supports both Latch On/NUL and Latch Off/NUL pair and Pulse On/Close and Pulse On/Trip pair.
11:55:05.721 step: 14
11:55:05.721 - Direct Operate(0x05) fir: 1 fin: 1 con: 0 uns: 0 seq: 0x00
11:55:05.721 - g12v1, 1-Byte Count and Index, count: 1
11:55:05.721 - [4] - code: 3 count: 20 onTime: 900 offTime: 1000 status: 0
11:55:05.722 --A-> Direct Operate(0x05) fir: 1 fin: 1 con: 0 uns: 0 seq: 0x00
11:55:05.722 g12v1, 1-Byte Count and Index, count: 1
11:55:05.722 [4] - code: 3 count: 20 onTime: 900 offTime: 1000 status: 0
11:55:05.722 --T-> fir: 1 fin: 1 seq: 0
11:55:05.723 --L-> master: 1 pri: 1 fcb: 0 fcv: 0 func: UNCONFIRMED_USER_DATA(0x04) 0xC4 length: 24 dest: 1024 src: 1
11:55:05.723 --P-> 05 64 18 C4 00 04 01 00 5B 61
11:55:05.723 C0 C0 05 0C 01 17 01 04 03 14 84 03 00 00 E8 03 B8 15
11:55:05.723 00 00 00 FF FF
11:55:05.724 step: 15
11:55:05.724 - Check that binary control point 4 operate
11:55:05.725 step: 16
11:55:05.725 - Direct Operate(0x05) fir: 1 fin: 1 con: 0 uns: 0 seq: 0x00
11:55:05.725 - g12v1, 1-Byte Count and Index, count: 1
11:55:05.725 - [4] - code: 129 count: 20 onTime: 900 offTime: 1000 status: 0
11:55:05.726 --A-> Direct Operate(0x05) fir: 1 fin: 1 con: 0 uns: 0 seq: 0x00
11:55:05.726 g12v1, 1-Byte Count and Index, count: 1
11:55:05.726 [4] - code: 129 count: 20 onTime: 900 offTime: 1000 status: 0
11:55:05.726 --T-> fir: 1 fin: 1 seq: 0
11:55:05.727 --L-> master: 1 pri: 1 fcb: 0 fcv: 0 func: UNCONFIRMED_USER_DATA(0x04) 0xC4 length: 24 dest: 1024 src: 1
11:55:05.728 --P-> 05 64 18 C4 00 04 01 00 5B 61
11:55:05.728 C0 C0 05 0C 01 17 01 04 81 14 84 03 00 00 E8 03 2D 16
11:55:05.728 00 00 00 FF FF
11:55:05.728 step: 17
11:55:05.728 - Check that binary control point 4 operate
11:55:05.734 step: 18
11:55:05.734 - Direct Operate(0x05) fir: 1 fin: 1 con: 0 uns: 0 seq: 0x00
11:55:05.734 - g12v1, 1-Byte Count and Index, count: 1
11:55:05.734 - [4] - code: 65 count: 20 onTime: 900 offTime: 1000 status: 0
11:55:05.736 --A-> Direct Operate(0x05) fir: 1 fin: 1 con: 0 uns: 0 seq: 0x00
11:55:05.736 g12v1, 1-Byte Count and Index, count: 1
11:55:05.736 [4] - code: 65 count: 20 onTime: 900 offTime: 1000 status: 0
11:55:05.737 --T-> fir: 1 fin: 1 seq: 0
11:55:05.738 --L-> master: 1 pri: 1 fcb: 0 fcv: 0 func: UNCONFIRMED_USER_DATA(0x04) 0xC4 length: 24 dest: 1024 src: 1
11:55:05.740 --P-> 05 64 18 C4 00 04 01 00 5B 61
11:55:05.740 C0 C0 05 0C 01 17 01 04 41 14 84 03 00 00 E8 03 F8 88
11:55:05.740 00 00 00 FF FF
11:55:05.741 step: 19
11:55:05.741 - Check that binary control point 4 operate
11:55:05.742 step: 20
11:55:05.742 - Direct Operate(0x05) fir: 1 fin: 1 con: 0 uns: 0 seq: 0x00
11:55:05.742 - g12v1, 1-Byte Count and Index, count: 1
11:55:05.742 - [4] - code: 4 count: 20 onTime: 900 offTime: 1000 status: 0
11:55:05.743 --A-> Direct Operate(0x05) fir: 1 fin: 1 con: 0 uns: 0 seq: 0x00
11:55:05.743 g12v1, 1-Byte Count and Index, count: 1
11:55:05.743 [4] - code: 4 count: 20 onTime: 900 offTime: 1000 status: 0
11:55:05.743 --T-> fir: 1 fin: 1 seq: 0
11:55:05.744 --L-> master: 1 pri: 1 fcb: 0 fcv: 0 func: UNCONFIRMED_USER_DATA(0x04) 0xC4 length: 24 dest: 1024 src: 1
11:55:05.745 --P-> 05 64 18 C4 00 04 01 00 5B 61
11:55:05.745 C0 C0 05 0C 01 17 01 04 04 14 84 03 00 00 E8 03 C6 77
11:55:05.745 00 00 00 FF FF
11:55:05.745 step: 21
11:55:05.745 - Check that binary control point 4 operate
11:55:05.745 Passed procedure: 8.2.5.2.1