Hi
With our device, we are doing very long run to verify the robustness of our BT solution, based on TI CC2564B + third party BT stack (not BT Utopia stack).
We noticed that when the problems happens the TI CTS is raised for a very long time. We don't have the capture showing this.
This occurrence is difficult to reproduce but we have
- TI BT logger
- Coupled HCI trace / BPA600 trace
See our analysis based on the attached traces :
HCI trace
219,367 Command 9 00:00:00.006024 4/29/2016 11:15:25.596338 AM
219,368 ACL Data 624 00:00:00.000281 4/29/2016 11:15:25.596619 AM
219,369 ACL Data 855 00:00:00.011341 4/29/2016 11:15:25.607960 AM
219,370 Event 8 00:00:00.004904 4/29/2016 11:15:25.612863 AM
219,371 Command 9 00:00:00.002544 4/29/2016 11:15:25.615407 AM
219,372 Command 6 00:00:00.002412 4/29/2016 11:15:25.617819 AM
219,373 ACL Data 23 00:00:00.001374 4/29/2016 11:15:25.619193 AM
219,374 ACL Data 855 00:00:00.002474 4/29/2016 11:15:25.616719 AM --> Last received HCI packet before the issue
219,375 ACL Data 406 00:00:00.054838 4/29/2016 11:15:25.671558 AM --> Last sent HCI packet before the issue
Packet Data [406]: --> Incomplete packet on the HCI sniffer because CTS is raised in the middle of UART TX, and CTS is never de-asserted
02 01 00 91 01 8d 01 44 00 09 ef 10 03 ef be ad
de 4a 5b 02 13 80 00 01 c8 ad 00 00 56 44 32 11
21 b1 16 34 ae c2 42 dd 1f 1b 07 07 34 c9 d3 62
b2 9d 43 68 d9 a1 5c 31 b9 c8 b1 71 a5 0b 4f b0
73 56 1f 64 56 29 26 a9 62 36 aa 54 5b 08 54 61
98 a4 00 01 f8 ad 00 00 45 44 43 12 21 82 bb 53
55 0e d6 d0 d4 29 a1 4a 2d 76 65 44 53 10 70 d4
a7 35 d5 c6 99 25 89 82 32 64 65 4d 58 64 ba 15
b5 6b 12 4d 35 20 1b 56 ef 98 97 be 12 b4 00 01
08 ad 00 00 45 44 43 12 21 74 b5 5c 1a 94 d6 62
4a ca 38 eb 29 68 14 23 1a 4b 36 98 96 1b d5 c5
73 0e 79 6b 4a 9c 5e c9 17 15 c2 a6 40 24 ce 52
83 d3 49 11 14 d4 e7 99 a9 44 00 01 38 ad 00 00
16 44 42 22 20 6f 21 a7 19 57 00 00 00 00 00 00
00 00 00 00 00 00 00 00 00 00 00 00 00 00 00 00
00 00 00 00 00 00 00 00 00 00 00 00 00 00 00 00
00 00 00 00 00 00 00 00 00 00 00 c0 00 00 00 00
00 00 00 00 00 00 00 00 00 00 00 00 00 00 00 00
00 00 00 00 00 00 00 00 00 00 00 00 00 00 00 00
00 00 00 00 00 00 00 00 00 00 00 00 00 00 00 00
00 00 00 00 00 00 00 00 00 00 00 00 00 00 00 00
00 00 00 00 00 00 00 00 00 00 00 00 00 00 00 00
00 00 00 00 00 00 00 00 00 00 00 00 00 00 00 00
00 00 00 00 00 00 00 00 00 00 00 00 00 00 00 00
00 00 00 00 00 00 00 00 00 00 00 00 00 00 00 00
00 00 00 00 00 00
BPA600 traces
217,012 0x0310e504 65 M (0x3c-bb-fd-50-17-67) (#1) 1 3-DH5 OK D L2CAP Go Go 0 1 850 862 00:00:00.000624 4/29/2016 11:15:07.491116 AM
--> Last phone packet correctly received. Based on HCI traces and Sequence Number we confirm that this packet was correctly forwarded over HCI
217,013 0x0310e50e 65 S (0xca-fe-fa-de-01-d8) (#1) 1 NULL OK D N/A [0] Go N/A [0] 0 1 0 12 00:00:00.003126 4/29/2016 11:15:07.494242 AM
217,014 0x0310e55c 68 M (0x3c-bb-fd-50-17-67) (#1) 1 3-DH5 OK D L2CAP Go Go 1 0 731 743 00:00:00.024374 4/29/2016 11:15:07.518616 AM
217,015 0x0310e568 28 M (0x3c-bb-fd-50-17-67) (#1) 1 3-DH5 OK (Retransmitted packet) D L2CAP Go Go 1 0 731 743 00:00:00.003750 4/29/2016 11:15:07.522366 AM
217,016 0x0310e574 77 M (0x3c-bb-fd-50-17-67) (#1) 1 3-DH5 OK (Retransmitted packet) D L2CAP Go Go 1 0 731 743 00:00:00.003750 4/29/2016 11:15:07.526116 AM
217,017 0x0310e580 70 M (0x3c-bb-fd-50-17-67) (#1) 1 3-DH5 OK (Retransmitted packet) D L2CAP Go Go 1 0 731 743 00:00:00.003750 4/29/2016 11:15:07.529866 AM
217,018 0x0310e58c 68 M (0x3c-bb-fd-50-17-67) (#1) 1 3-DH5 OK (Retransmitted packet) D L2CAP Go Go 1 0 731 743 00:00:00.003750 4/29/2016 11:15:07.533616 AM
-> Packet not received by TI baseband controller. The phone is keep retransmitting the packet, but there is no response. The TI does not reply anymore with NULL packets.
TI Logger:
336479 11:15:07.349 +0:21:49.709 finish afh rssi scan pattern, scan valid = 1
336480 11:15:07.349 +0:21:49.709 last scan PHY grade: 0, 0, 0, 0
336481 11:15:07.349 +0:21:49.709 last scan PHY grade: 0, 0, 0, 0
336482 11:15:07.349 +0:21:49.709 last scan PHY grade: 0, 0, 0, 0
336483 11:15:07.349 +0:21:49.709 last scan PHY grade: 0, 0, 0, 0
336484 11:15:07.349 +0:21:49.709 last scan PHY grade: 0, 0, 0, 0
336485 11:15:07.349 +0:21:49.709 last scan PHY grade: 0, 0, 0, 0
336486 11:15:07.349 +0:21:49.709 last scan PHY grade: 0, 0, 0, 0
336487 11:15:07.349 +0:21:49.709 last scan PHY grade: 0, 0, 0, 0
336488 11:15:07.349 +0:21:49.709 last scan PHY grade: 0, 0, 0, 0
336489 11:15:07.349 +0:21:49.709 last scan PHY grade: 0, 0, 0, 0
336490 11:15:07.349 +0:21:49.709 last scan PHY grade: 0, 0, 0, 0
336491 11:15:07.349 +0:21:49.709 last scan PHY grade: 0, 0, 0, 0
336492 11:15:07.349 +0:21:49.709 last scan PHY grade: 0, 0, 0, 0
336493 11:15:07.349 +0:21:49.709 last scan PHY grade: 0, 0, 0, 0
336494 11:15:07.349 +0:21:49.709 last scan PHY grade: 0, 0, 0, 0
336495 11:15:07.349 +0:21:49.709 last scan PHY grade: 0, 0, 0, 0
336496 11:15:07.349 +0:21:49.709 last scan PHY grade: 0, 0, 0, 0
336497 11:15:07.349 +0:21:49.709 last scan PHY grade: 0, 0, 0, 0
336498 11:15:07.349 +0:21:49.709 last scan PHY grade: 0, 0, 0, 0
336499 11:15:07.349 +0:21:49.709 last scan PHY grade: 0, 0, 0, 255 --> Last TI log before reboot
BR,
Franck