espressif / esp-iot-solution

Espressif IoT Library. IoT Device Drivers, Documentations And Solutions.
Apache License 2.0
1.9k stars 760 forks source link

用USB CDC 4G Module时,卡在了Modem state STAGE_WAIT_IP步骤 (AEGHB-586) #341

Closed tyrael-cui closed 6 months ago

tyrael-cui commented 6 months ago

Answers checklist.

General issue report

我的硬件是ESP32-S2连接EC600M-CN模块,直接用了USB_CDC_MODULE中的例程。IDF版本 5.1.2。开机log如下:

ESP-ROM:esp32s2-rc4-20191025 Build:Oct 25 2019 rst:0x1 (POWERON),boot:0x8 (SPI_FAST_FLASH_BOOT) SPIWP:0xee mode:DIO, clock div:1
load:0x3ffe6110,len:0x19c8 load:0x4004b000,len:0x4
load:0x4004b004,len:0xc34 load:0x4004f000,len:0x3428 entry 0x4004b1ec I (23) boot: ESP-IDF v5.1.2-dirty 2nd stage bootloader I (24) boot: compile time Mar 7 2024 15:01:58
I (24) boot: chip revision: v0.0 I (28) qio_mode: Enabling default flash chip QIO I (33) boot.esp32s2: SPI Speed : 80MHz I (38) boot.esp32s2: SPI Mode : QIO I (42) boot.esp32s2: SPI Flash Size : 4MB I (47) boot: Enabling RNG early entropy source... I (53) boot: Partition Table: I (56) boot: ## Label Usage Type ST Offset Length I (63) boot: 0 nvs WiFi data 01 02 00009000 00006000 I (71) boot: 1 phy_init RF data 01 01 0000f000 00001000 I (78) boot: 2 factory factory app 00 00 00010000 00100000 I (86) boot: 3 storage Unknown data 01 82 00110000 00100000 I (93) boot: End of partition table I (98) esp_image: segment 0: paddr=00010020 vaddr=3f000020 size=2c848h (182344) map I (137) esp_image: segment 1: paddr=0003c870 vaddr=3ffcbed0 size=03520h ( 13600) load I (140) esp_image: segment 2: paddr=0003fd98 vaddr=40024000 size=00280h ( 640) load I (143) esp_image: segment 3: paddr=00040020 vaddr=40080020 size=9f53ch (652604) map I (263) esp_image: segment 4: paddr=000df564 vaddr=40024280 size=17c50h ( 97360) load I (298) boot: Loaded app from partition at offset 0x10000 I (298) boot: Disabling RNG early entropy source... I (309) cpu_start: Unicore app I (309) cache: Instruction cache : size 8KB, 4Ways, cache line size 32Byte I (309) cache: Data cache : size 8KB, 4Ways, cache line size 32Byte I (316) cpu_start: Pro cpu up. I (339) cpu_start: Pro cpu start user code I (339) cpu_start: cpu freq: 240000000 Hz I (339) cpu_start: Application information: I (342) cpu_start: Project name: usb_cat1 I (347) cpu_start: App version: 1 I (351) cpu_start: Compile time: Mar 12 2024 13:50:53 I (357) cpu_start: ELF file SHA256: e4141d4cdf55fffb... I (363) cpu_start: ESP-IDF: v5.1.2-dirty I (369) cpu_start: Min chip rev: v0.0 I (373) cpu_start: Max chip rev: v1.99 I (378) cpu_start: Chip rev: v0.0 I (383) heap_init: Initializing. RAM available for dynamic allocation: I (390) heap_init: At 3FFD3200 len 00028E00 (163 KiB): DRAM I (396) heap_init: At 3FFFC000 len 00003A10 (14 KiB): DRAM I (402) heap_init: At 3FF9E000 len 00001FE8 (7 KiB): RTCRAM I (409) spi_flash: detected chip: generic I (413) spi_flash: flash io: qio I (418) app_start: Starting scheduler on CPU0 I (422) main_task: Started on CPU0 I (426) main_task: Calling app_main() I (430) led_indicator: LED Indicator Version: 0.3.0 I (436) gpio: GPIO[5]| InputEn: 0| OutputEn: 1| OpenDrain: 0| Pullup: 0| Pulldown: 0| Intr:0 I (445) led_indicator: blink_lists is null, use default blink list W (452) led_indicator: ./managed_components/espressif__led_indicator/src/led_indicator.c:280 (_led_indicator_create_com):LED indicator does not have the hal_indicator_set_brightness function I (469) led_indicator: Indicator create successfully. type:GPIO mode, hardware_data:0x5, is_active_level_high:1, blink_lists:default I (485) 4g_main: ==================================== I (488) 4g_main: ESP 4G Cat.1 Wi-Fi Router I (493) 4g_main: ==================================== I (498) modem_board: iot_usbh_modem, version: 0.2.1 I (504) modem_board: Power the module first.... I (509) gpio: GPIO[9]| InputEn: 0| OutputEn: 1| OpenDrain: 0| Pullup: 0| Pulldown: 0| Intr:0 I (518) gpio: GPIO[10]| InputEn: 0| OutputEn: 1| OpenDrain: 0| Pullup: 0| Pulldown: 0| Intr:0 I (528) modem_board: Power modem using io=10, level=1 I (833) modem_board: Force reset modem board.... I (833) modem_board: Resetting modem using io=9, level=1 I (1633) modem_board: Waiting for modem initialize ready I (2633) modem_board: Waiting for modem 11 seconds left..... I (3633) modem_board: Waiting for modem 10 seconds left..... I (4633) modem_board: Waiting for modem 9 seconds left..... I (5633) modem_board: Waiting for modem 8 seconds left..... I (6633) modem_board: Waiting for modem 7 seconds left..... I (7633) modem_board: Waiting for modem 6 seconds left..... I (8633) modem_board: Waiting for modem 5 seconds left..... I (9633) modem_board: Waiting for modem 4 seconds left..... I (10633) modem_board: Waiting for modem 3 seconds left..... I (11633) modem_board: Waiting for modem 2 seconds left..... I (12633) modem_board: Waiting for modem 1 seconds left..... I (12633) USB_HCDC: iot_usbh_cdc, version: 0.2.2 I (12633) IOT_USBH: iot_usbh, version: 0.2.1 I (12668) IOT_USBH: USB Port=1 init succeed, fifo strategy=0 I (12668) IOT_USBH: USB Processing Start I (12668) IOT_USBH: Waiting USB Connection I (12672) IOT_USBH: Port power: ON Succeed I (12677) IOT_USBH: usb port start succeed I (12682) USB_HCDC: usbh cdc driver install succeed I (12687) USB_HCDC: Waiting CDC Device Connection I (12693) USB_HCDC: CDC task start I (12927) IOT_USBH: line 131 PORT_EVENT_CONNECTION I (13027) IOT_USBH: Resetting Port I (13087) IOT_USBH: Port reset succeed I (13087) IOT_USBH: Getting Port Speed I (13087) IOT_USBH: USB Speed: full-speed I (13089) IOT_USBH: Pipe init succeed, addr: 00 I (13094) IOT_USBH: Set Device Addr = 1 I (13099) IOT_USBH: Set Device Addr Done I (13103) IOT_USBH: get device desc I (13108) IOT_USBH: get device desc, actual_num_bytes:26 Device descriptor bLength 18 bDescriptorType 1 bcdUSB 2.00 bDeviceClass 0xef bDeviceSubClass 0x2 bDeviceProtocol 0x1 bMaxPacketSize0 64 idVendor 0x2c7c idProduct 0x6002 bcdDevice 3.10 iManufacturer 1 iProduct 2 iSerialNumber 3 bNumConfigurations 1 I (13137) IOT_USBH: get short config desc I (13142) IOT_USBH: get config desc, actual_num_bytes:16 I (13148) IOT_USBH: get full config desc I (13153) IOT_USBH: get full config desc, actual_num_bytes:217 Configuration descriptor bLength 9 bDescriptorType 2 wTotalLength 209 bNumInterfaces 5 bConfigurationValue 1 iConfiguration 0 bmAttributes 0xe0 bMaxPower 500mA Interface Association Descriptor bLength 8 bDescriptorType 11 bFirstInterface 0 bInterfaceCount 2 bFunctionClass 0x2 bFunctionSubClass 0x6 bFunctionProtocol 0x0 iFunction 5 Interface descriptor bLength 9 bDescriptorType 4 bInterfaceNumber 0 bAlternateSetting 0 bNumEndpoints 1 bInterfaceClass 0x2 bInterfaceSubClass 0x6 bInterfaceProtocol 0x0 iInterface 5 Endpoint descriptor bLength 7 bDescriptorType 5 bEndpointAddress 0x87 EP 7 IN bmAttributes 0x3 INT wMaxPacketSize 64 bInterval 16 Interface descriptor bLength 9 bDescriptorType 4 bInterfaceNumber 1 bAlternateSetting 0 bNumEndpoints 0 bInterfaceClass 0xa bInterfaceSubClass 0x0 bInterfaceProtocol 0x0 iInterface 5 Interface descriptor bLength 9 bDescriptorType 4 bInterfaceNumber 1 bAlternateSetting 1 bNumEndpoints 2 bInterfaceClass 0xa bInterfaceSubClass 0x0 bInterfaceProtocol 0x0 iInterface 0 Endpoint descriptor bLength 7 bDescriptorType 5 bEndpointAddress 0x83 EP 3 IN bmAttributes 0x2 BULK wMaxPacketSize 512 bInterval 0 Endpoint descriptor bLength 7 bDescriptorType 5 bEndpointAddress 0xc EP 12 OUT bmAttributes 0x2 BULK wMaxPacketSize 512 bInterval 0 Interface descriptor bLength 9 bDescriptorType 4 bInterfaceNumber 2 bAlternateSetting 0 bNumEndpoints 2 bInterfaceClass 0xff bInterfaceSubClass 0x0 bInterfaceProtocol 0x0 iInterface 8 Endpoint descriptor bLength 7 bDescriptorType 5 bEndpointAddress 0x82 EP 2 IN bmAttributes 0x2 BULK wMaxPacketSize 64 bInterval 0 Endpoint descriptor bLength 7 bDescriptorType 5 bEndpointAddress 0xb EP 11 OUT bmAttributes 0x2 BULK wMaxPacketSize 64 bInterval 0 Interface descriptor bLength 9 bDescriptorType 4 bInterfaceNumber 3 bAlternateSetting 0 bNumEndpoints 3 bInterfaceClass 0xff bInterfaceSubClass 0x0 bInterfaceProtocol 0x0 iInterface 11 Endpoint descriptor bLength 7 bDescriptorType 5 bEndpointAddress 0x89 EP 9 IN bmAttributes 0x3 INT wMaxPacketSize 64 bInterval 16 Endpoint descriptor bLength 7 bDescriptorType 5 bEndpointAddress 0x86 EP 6 IN bmAttributes 0x2 BULK wMaxPacketSize 64 bInterval 0 Endpoint descriptor bLength 7 bDescriptorType 5 bEndpointAddress 0xf EP 15 OUT bmAttributes 0x2 BULK wMaxPacketSize 64 bInterval 0 Interface descriptor bLength 9 bDescriptorType 4 bInterfaceNumber 4 bAlternateSetting 0 bNumEndpoints 3 bInterfaceClass 0xff bInterfaceSubClass 0x0 bInterfaceProtocol 0x0 iInterface 11 Endpoint descriptor bLength 7 bDescriptorType 5 bEndpointAddress 0x88 EP 8 IN bmAttributes 0x3 INT wMaxPacketSize 64 bInterval 16 Endpoint descriptor bLength 7 bDescriptorType 5 bEndpointAddress 0x81 EP 1 IN bmAttributes 0x2 BULK wMaxPacketSize 64 bInterval 0 Endpoint descriptor bLength 7 bDescriptorType 5 bEndpointAddress 0xa EP 10 OUT bmAttributes 0x2 BULK wMaxPacketSize 64 bInterval 0 I (13453) IOT_USBH: Set Device Configuration = 1 I (13459) IOT_USBH: Set Device Configuration Done I (13464) IOT_USBH: Pipe init succeed, addr: 81 I (13469) IOT_USBH: Pipe init succeed, addr: 0A I (13474) USB_HCDC: CDC Device Connected I (13479) esp-modem: --------- Modem PreDefined Info ------------------ I (13486) esp-modem: Model: EC600NCNLC-N06 I (13491) esp-modem: Modem itf: IN Addr:0x81, OUT Addr:0x0A I (13497) esp-modem: ---------------------------------------------------- I (13505) gpio: GPIO[10]| InputEn: 0| OutputEn: 1| OpenDrain: 0| Pullup: 0| Pulldown: 0| Intr:0 I (13514) gpio: GPIO[9]| InputEn: 0| OutputEn: 1| OpenDrain: 0| Pullup: 0| Pulldown: 0| Intr:0 I (13524) modem_board: DTE reconnect, reconnecting ...

I (13525) USB_HCDC: rx0 flush -0 = 0 I (14530) modem_board: reconnect after 5s... I (15530) modem_board: reconnect after 4s... I (16530) modem_board: reconnect after 3s... I (17530) modem_board: reconnect after 2s... I (18530) modem_board: reconnect after 1s... I (18530) modem_board: Modem state STAGE_SYNC, Start I (18544) modem_board: Network Auto reconnecting ... W (18544) 4g_main: Modem Board Event: Network disconnected E (18544) led_indicator: ./managed_components/espressifled_indicator/src/led_indicator.c:461 (led_indicator_stop):invalid p_handle I (18557) modem_board: Modem state STAGE_SYNC, Success! I (18663) modem_board: Modem state STAGE_CHECK_SIM, Start I (18666) modem_board: SIM Card Ready I (18666) 4g_main: Modem Board Event: SIM Card Connected I (18668) modem_board: Modem state STAGE_CHECK_SIM, Success! I (18774) modem_board: Modem state STAGE_CHECK_SIGNAL, Start I (18776) modem_board: Signal quality: rssi=28, ber=99 I (18776) modem_board: Modem state STAGE_CHECK_SIGNAL, Success! I (18881) modem_board: Modem state STAGE_CHECK_REGIST, Start I (18883) modem_board: Network registed, Operator: "CHINA MOBILE" I (18883) modem_board: Modem state STAGE_CHECK_REGIST, Success! I (18989) modem_board: Modem state STAGE_START_PPP, Start I (18996) modem_board: Modem state STAGE_START_PPP, Success! W (18997) modem_board: Modem event! 0 I (19096) modem_board: Modem state STAGE_WAIT_IP, Start I (78997) esp-netif_lwip-ppp: Connection lost I (78997) modem_board: IP event! 7 I (78997) modem_board: Modem Disconnect from PPP Server W (79096) modem_board: Modem Got IP timeout, retry from start! E (79096) modem_board: Modem state STAGE_WAIT_IP, retry 5, timeout ! W (79098) modem_board: Retry From Start ! I (79103) modem_board: Modem state STAGE_SYNC, Start W (79118) esp-modem-dte: Not support sending command in ppp mode, please exit ppp mode first response timeoutem_dce: esp_modem_dce_generic_command(26): Command:AT I (79136) modem_board: Current timeouts: 1 and errors: 0 W (79136) modem_board: Try to exit ppp mode........ E (89138) esp-modem-dte: esp_modem_dte_send_cmd(272): process command timeout W (89138) esp_modem_dce: esp_modem_dce_generic_command(26): Command:+++ response timeout I (89148) modem_board: Network Auto reconnecting ... W (89149) 4g_main: Modem Board Event: Network disconnected E (89155) led_indicator: ./managed_components/espressifled_indicator/src/led_indicator.c:461 (led_indicator_stop):invalid p_handle I (89168) modem_board: Modem state STAGE_SYNC, Success! I (89273) modem_board: Modem state STAGE_CHECK_SIM, Start I (89275) modem_board: SIM Card Ready I (89275) 4g_main: Modem Board Event: SIM Card Connected I (89278) modem_board: Modem state STAGE_CHECK_SIM, Success! I (89384) modem_board: Modem state STAGE_CHECK_SIGNAL, Start I (89386) modem_board: Signal quality: rssi=25, ber=99 I (89386) modem_board: Modem state STAGE_CHECK_SIGNAL, Success! I (89491) modem_board: Modem state STAGE_CHECK_REGIST, Start I (89493) modem_board: Network registed, Operator: "CHINA MOBILE" I (89493) modem_board: Modem state STAGE_CHECK_REGIST, Success! I (89599) modem_board: Modem state STAGE_START_PPP, Start I (89605) modem_board: Modem state STAGE_START_PPP, Success! W (89606) modem_board: Modem event! 0 I (89705) modem_board: Modem state STAGE_WAIT_IP, Start I (149606) esp-netif_lwip-ppp: Connection lost I (149606) modem_board: IP event! 7 I (149606) modem_board: Modem Disconnect from PPP Server W (149705) modem_board: Modem Got IP timeout, retry from start! E (149705) modem_board: Modem state STAGE_WAIT_IP, retry 5, timeout ! W (149707) modem_board: Retry From Start ! I (149712) modem_board: Modem state STAGE_SYNC, Start W (149728) esp-modem-dte: Not support sending command in ppp mode, please exit ppp mode first response timeoutdem_dce: esp_modem_dce_generic_command(26): Command:AT I (149746) modem_board: Current timeouts: 1 and errors: 0 W (149746) modem_board: Try to exit ppp mode........ E (159747) esp-modem-dte: esp_modem_dte_send_cmd(272): process command timeout W (159747) esp_modem_dce: esp_modem_dce_generic_command(26): Command:+++ response timeout I (159757) modem_board: Network Auto reconnecting ... W (159758) 4g_main: Modem Board Event: Network disconnected E (159764) led_indicator: ./managed_components/espressif__led_indicator/src/led_indicator.c:461 (led_indicator_stop):invalid p_handle I (159777) modem_board: Modem state STAGE_SYNC, Success! I (159883) modem_board: Modem state STAGE_CHECK_SIM, Start I (159885) modem_board: SIM Card Ready I (159885) 4g_main: Modem Board Event: SIM Card Connected I (159888) modem_board: Modem state STAGE_CHECK_SIM, Success! I (159995) modem_board: Modem state STAGE_CHECK_SIGNAL, Start I (159997) modem_board: Signal quality: rssi=25, ber=99 I (159997) modem_board: Modem state STAGE_CHECK_SIGNAL, Success! I (160103) modem_board: Modem state STAGE_CHECK_REGIST, Start I (160105) modem_board: Network registed, Operator: "CHINA MOBILE" I (160105) modem_board: Modem state STAGE_CHECK_REGIST, Success! I (160211) modem_board: Modem state STAGE_START_PPP, Start I (160217) modem_board: Modem state STAGE_START_PPP, Success! W (160218) modem_board: Modem event! 0 I (160317) modem_board: Modem state STAGE_WAIT_IP, Start

======================================================== 目前已经检查过EC600M模块,是正常工作的,SIM卡也可以注册上网,但就是无法获取IP。 请大家指教是什么原因造成的? 谢谢!

leeebo commented 6 months ago

@tyrael-cui Please try with other SIM Card or change the APN same as the operator suggest.

tyrael-cui commented 6 months ago

@leeebo 我设置了APN名字,打开了debug信息,发现已经连接成功了,但仍然无法获取IP。Log如下:

I (689) app_start: Starting scheduler on CPU0 I (694) main_task: Started on CPU0 D (698) heap_init: New heap initialised at 0x3fffc000 I (703) main_task: Calling app_main() I (707) led_indicator: LED Indicator Version: 0.3.0 I (713) gpio: GPIO[5]| InputEn: 0| OutputEn: 1| OpenDrain: 0| Pullup: 0| Pulldown: 0| Intr:0 I (722) led_indicator: blink_lists is null, use default blink list W (729) led_indicator: ./managed_components/espressif__led_indicator/src/led_indicator.c:280 (_led_indicator_create_com):LED indicator does not have the hal_indicator_set_brightness functionI (746) led_indicator: Indicator create successfully. type:GPIO mode, hardware_data:0x5, is_active_level_high:1, blink_lists:default D (762) esp_netif_lwip: LwIP stack has been initialized D (764) esp_netif_lwip: check: remote, if=0x0 fn=0x40119f78 0x40119f78: alloc_client_data_id at D:/Espressif/frameworks/esp-idf-v5.1.2/components/esp_netif/lwip/esp_netif_lwip.c:166 D (770) esp_netif_lwip: call api in lwip: ret=0x0, give sem D (776) esp_netif_lwip: esp-netif has been successfully initialized D (782) event: running task for loop 0x3ffd8fe8 D (787) event: created task for loop 0x3ffd8fe8 D (791) event: created event loop 0x3ffd8fe8 I (796) 4g_main: ==================================== I (801) 4g_main: ESP 4G Cat.1 Wi-Fi Router I (806) 4g_main: ==================================== I (812) modem_board: iot_usbh_modem, version: 0.2.1 s_modem_evt_hdl ptr= 0x3ffcfc84 I (821) modem_board: Power the module first.... I (826) gpio: GPIO[9]| InputEn: 0| OutputEn: 1| OpenDrain: 0| Pullup: 0| Pulldown: 0| Intr:0 I (835) gpio: GPIO[10]| InputEn: 0| OutputEn: 1| OpenDrain: 0| Pullup: 0| Pulldown: 0| Intr:0 I (844) modem_board: Power modem using io=10, level=1 I (1150) modem_board: Force reset modem board.... I (1150) modem_board: Resetting modem using io=9, level=1 I (1950) modem_board: Waiting for modem initialize ready I (2950) modem_board: Waiting for modem 11 seconds left..... I (3950) modem_board: Waiting for modem 10 seconds left..... I (4950) modem_board: Waiting for modem 9 seconds left..... I (5950) modem_board: Waiting for modem 8 seconds left..... I (6950) modem_board: Waiting for modem 7 seconds left..... I (7950) modem_board: Waiting for modem 6 seconds left..... I (8950) modem_board: Waiting for modem 5 seconds left..... I (9950) modem_board: Waiting for modem 4 seconds left..... I (10950) modem_board: Waiting for modem 3 seconds left..... I (11950) modem_board: Waiting for modem 2 seconds left..... I (12950) modem_board: Waiting for modem 1 seconds left..... D (12950) event: created event loop 0x3ffdba10 I (12950) USB_HCDC: iot_usbh_cdc, version: 0.2.2 I (12955) IOT_USBH: iot_usbh, version: 0.2.1 D (12960) intr_alloc: Connected src 48 to int 9 (cpu 0) I (12995) IOT_USBH: USB Port=1 init succeed, fifo strategy=0 I (12995) IOT_USBH: USB Processing Start I (12995) IOT_USBH: Waiting USB Connection I (12999) IOT_USBH: Port power: ON Succeed I (13004) IOT_USBH: usb port start succeed I (13009) USB_HCDC: usbh cdc driver install succeed I (13014) USB_HCDC: Waiting CDC Device Connection I (13020) USB_HCDC: CDC task start D (13024) IOT_USBH: urb alloced D (13027) IOT_USBH: urb alloced D (13030) IOT_USBH: urb alloced D (13034) IOT_USBH: urb alloced D (13037) IOT_USBH: urb alloced D (13040) IOT_USBH: urb alloced D (13043) IOT_USBH: urb alloced D (13046) IOT_USBH: urb alloced D (13050) IOT_USBH: urb alloced D (13053) IOT_USBH: urb alloced I (13254) IOT_USBH: line 131 PORT_EVENT_CONNECTION I (13354) IOT_USBH: Resetting Port I (13414) IOT_USBH: Port reset succeed I (13414) IOT_USBH: Getting Port Speed I (13414) IOT_USBH: USB Speed: full-speed I (13416) IOT_USBH: Pipe init succeed, addr: 00 D (13421) IOT_USBH: urb alloced I (13424) IOT_USBH: Set Device Addr = 1 D (13429) IOT_USBH: line 162 Pipe: default PIPE_EVENT_URB_DONE I (13435) IOT_USBH: Set Device Addr Done D (13439) IOT_USBH: urb free D (13442) IOT_USBH: urb alloced I (13446) IOT_USBH: get device desc D (13450) IOT_USBH: line 162 Pipe: default PIPE_EVENT_URB_DONE I (13456) IOT_USBH: get device desc, actual_num_bytes:26 Device descriptor bLength 18 bDescriptorType 1 bcdUSB 2.00 bDeviceClass 0xef bDeviceSubClass 0x2 bDeviceProtocol 0x1 bMaxPacketSize0 64 idVendor 0x2c7c idProduct 0x6002 bcdDevice 3.10 iManufacturer 1 iProduct 2 iSerialNumber 3 bNumConfigurations 1 D (13485) IOT_USBH: urb free D (13488) IOT_USBH: urb alloced I (13491) IOT_USBH: get short config desc D (13496) IOT_USBH: line 162 Pipe: default PIPE_EVENT_URB_DONE I (13502) IOT_USBH: get config desc, actual_num_bytes:16 I (13508) IOT_USBH: get full config desc D (13513) IOT_USBH: line 162 Pipe: default PIPE_EVENT_URB_DONE I (13518) IOT_USBH: get full config desc, actual_num_bytes:217 Configuration descriptor bLength 9 bDescriptorType 2 wTotalLength 209 bNumInterfaces 5 bConfigurationValue 1 iConfiguration 0 bmAttributes 0xe0 bMaxPower 500mA Interface Association Descriptor bLength 8 bDescriptorType 11 bFirstInterface 0 bInterfaceCount 2 bFunctionClass 0x2 bFunctionSubClass 0x6 bFunctionProtocol 0x0 iFunction 5 Interface descriptor bLength 9 bDescriptorType 4 bInterfaceNumber 0 bAlternateSetting 0 bNumEndpoints 1 bInterfaceClass 0x2 bInterfaceSubClass 0x6 bInterfaceProtocol 0x0 iInterface 5 Endpoint descriptor bLength 7 bDescriptorType 5 bEndpointAddress 0x87 EP 7 IN bmAttributes 0x3 INT wMaxPacketSize 64 bInterval 16 Interface descriptor bLength 9 bDescriptorType 4 bInterfaceNumber 1 bAlternateSetting 0 bNumEndpoints 0 bInterfaceClass 0xa bInterfaceSubClass 0x0 bInterfaceProtocol 0x0 iInterface 5 Interface descriptor bLength 9 bDescriptorType 4 bInterfaceNumber 1 bAlternateSetting 1 bNumEndpoints 2 bInterfaceClass 0xa bInterfaceSubClass 0x0 bInterfaceProtocol 0x0 iInterface 0 Endpoint descriptor bLength 7 bDescriptorType 5 bEndpointAddress 0x83 EP 3 IN bmAttributes 0x2 BULK wMaxPacketSize 512 bInterval 0 Endpoint descriptor bLength 7 bDescriptorType 5 bEndpointAddress 0xc EP 12 OUT bmAttributes 0x2 BULK wMaxPacketSize 512 bInterval 0 Interface descriptor bLength 9 bDescriptorType 4 bInterfaceNumber 2 bAlternateSetting 0 bNumEndpoints 2 bInterfaceClass 0xff bInterfaceSubClass 0x0 bInterfaceProtocol 0x0 iInterface 8 Endpoint descriptor bLength 7 bDescriptorType 5 bEndpointAddress 0x82 EP 2 IN bmAttributes 0x2 BULK wMaxPacketSize 64 bInterval 0 Endpoint descriptor bLength 7 bDescriptorType 5 bEndpointAddress 0xb EP 11 OUT bmAttributes 0x2 BULK wMaxPacketSize 64 bInterval 0 Interface descriptor bLength 9 bDescriptorType 4 bInterfaceNumber 3 bAlternateSetting 0 bNumEndpoints 3 bInterfaceClass 0xff bInterfaceSubClass 0x0 bInterfaceProtocol 0x0 iInterface 11 Endpoint descriptor bLength 7 bDescriptorType 5 bEndpointAddress 0x89 EP 9 IN bmAttributes 0x3 INT wMaxPacketSize 64 bInterval 16 Endpoint descriptor bLength 7 bDescriptorType 5 bEndpointAddress 0x86 EP 6 IN bmAttributes 0x2 BULK wMaxPacketSize 64 bInterval 0 Endpoint descriptor bLength 7 bDescriptorType 5 bEndpointAddress 0xf EP 15 OUT bmAttributes 0x2 BULK wMaxPacketSize 64 bInterval 0 Interface descriptor bLength 9 bDescriptorType 4 bInterfaceNumber 4 bAlternateSetting 0 bNumEndpoints 3 bInterfaceClass 0xff bInterfaceSubClass 0x0 bInterfaceProtocol 0x0 iInterface 11 Endpoint descriptor bLength 7 bDescriptorType 5 bEndpointAddress 0x88 EP 8 IN bmAttributes 0x3 INT wMaxPacketSize 64 bInterval 16 Endpoint descriptor bLength 7 bDescriptorType 5 bEndpointAddress 0x81 EP 1 IN bmAttributes 0x2 BULK wMaxPacketSize 64 bInterval 0 Endpoint descriptor bLength 7 bDescriptorType 5 bEndpointAddress 0xa EP 10 OUT bmAttributes 0x2 BULK wMaxPacketSize 64 bInterval 0 D (13819) IOT_USBH: urb free D (13822) IOT_USBH: urb alloced I (13826) IOT_USBH: Set Device Configuration = 1 D (13831) IOT_USBH: line 162 Pipe: default PIPE_EVENT_URB_DONE I (13837) IOT_USBH: Set Device Configuration Done D (13842) IOT_USBH: urb free D (13845) event: no handlers have been registered for event MODEM_BOARD_EVENT:0 posted to loop 0x3ffd8fe8 D (13855) USB_HCDC: Creating bulk in pipe itf = 0, ep = 0x81, I (13861) IOT_USBH: Pipe init succeed, addr: 81 D (13866) USB_HCDC: Creating bulk out pipe itf = 0, ep = 0x0A I (13872) IOT_USBH: Pipe init succeed, addr: 0A I (13877) USB_HCDC: CDC Device Connected I (13882) esp-modem: --------- Modem PreDefined Info ------------------ I (13889) esp-modem: Model: EC600NCNLC-N06 I (13894) esp-modem: Modem itf: IN Addr:0x81, OUT Addr:0x0A I (13900) esp-modem: ---------------------------------------------------- I (13907) gpio: GPIO[10]| InputEn: 0| OutputEn: 1| OpenDrain: 0| Pullup: 0| Pulldown: 0| Intr:0 I (13917) gpio: GPIO[9]| InputEn: 0| OutputEn: 1| OpenDrain: 0| Pullup: 0| Pulldown: 0| Intr:0 D (13926) esp_netif_objects: esp_netif_add_to_list 0x3ffeb4a8 D (13932) esp_netif_objects: esp_netif_add_to_list netif added successfully (total netifs: 1) D (13941) esp-netif_lwip-ppp: esp_netif_new_ppp: PPP connection created: 0x3ffec418 D (13948) esp-netif_lwip-ppp: Phase Dead D (13952) esp_netif_lwip: check: remote, if=0x0 fn=0x40119f8c 0x40119f8c: set_lwip_netif_callback at D:/Espressif/frameworks/esp-idf-v5.1.2/components/esp_netif/lwip/esp_netif_lwip.c:174

D (13958) esp_netif_lwip: call api in lwip: ret=0x0, give sem dte ptr = 0x3ffdacdc ,esp_dte ptr = 0x3ffdacc0 ,event_loop_hdl ptr = 0x3ffdba10 dte ptr = 0x3ffdacdc ,esp_dte ptr = 0x3ffdacc0 ,event_loop_hdl ptr = 0x3ffdba10 dte ptr = 0x3ffdacdc ,esp_dte ptr = 0x3ffdacc0 ,event_loop_hdl ptr = 0x3ffdba10 config.handler ptr = 0x3ffd5ffc on_modem_event = 0x40091d34 0x40091d34: on_modem_event at D:/Espressif/esp-iot-solution/components/usb/iot_usbh_modem/src/usbh_modem_board.c:329

D (13991) modem_board: Handling bits = 0080, stage = 1, retry = 0 I (13997) modem_board: DTE reconnect, reconnecting ...

I (13980) USB_HCDC: rx0 flush -0 = 0 I (15003) modem_board: reconnect after 5s... I (16003) modem_board: reconnect after 4s... I (17003) modem_board: reconnect after 3s... I (18003) modem_board: reconnect after 2s... I (19003) modem_board: reconnect after 1s... I (19003) modem_board: Modem state STAGE_SYNC, Start D (19013) esp_modem_dce: esp_modem_dce_generic_command(20): Sending command:AT

D (19013) USB_HCDC: cdc write itf: 0, buf = 0x3f00aaf8, len = 3 D (19018) USB_HCDC: cdc read itf: 0, buf = 0x3ffdad28, len = 9, read = 9 D (19023) esp-modem: debug_data: 0x3ffdad28 41 54 0d 0d 0a 4f 4b 0d 0a |AT...OK..| D (19032) esp_modem_dce: esp_modem_dce_generic_command(35): Command:AT succeeded D (19040) esp_modem_dce: esp_modem_dce_generic_command(20): Sending command:ATE0

D (19048) USB_HCDC: cdc write itf: 0, buf = 0x3f00ab04, len = 5 D (19056) USB_HCDC: cdc read itf: 0, buf = 0x3ffdad28, len = 11, read = 11 D (19061) esp-modem: debug_data: 0x3ffdad28 41 54 45 30 0d 0d 0a 4f 4b 0d 0a |ATE0...OK..| D (19071) esp_modem_dce: esp_modem_dce_generic_command(35): Command:ATE0 succeeded I (19078) modem_board: Network Auto reconnecting ... D (19084) event: running post MODEM_BOARD_EVENT:7 with handler 0x400893a0 and context 0x3ffeaf1c on loop 0x3ffd8fe8 0x400893a0: on_modem_event at E:/Project/eps32/example_usb_cat1/usb_cat1/main/app_main.c:140

W (19095) 4g_main: Modem Board Event: Network disconnected E (19101) led_indicator: ./managed_components/espressif__led_indicator/src/led_indicator.c:461 (led_indicator_stop):invalid p_handle I (19113) modem_board: Modem state STAGE_SYNC, Success! D (19219) modem_board: Handling bits = 0100, stage = 3, retry = 0 I (19219) modem_board: Modem state STAGE_CHECK_SIM, Start D (19220) esp_modem_dce: esp_modem_dce_generic_command(20): Sending command:AT+CPIN?

D (19228) USB_HCDC: cdc write itf: 0, buf = 0x3f00ab58, len = 9 D (19237) USB_HCDC: cdc read itf: 0, buf = 0x3ffdad28, len = 22, read = 22 D (19241) esp-modem: debug_data: 0x3ffdad28 0d 0a 2b 43 50 49 4e 3a 20 52 45 41 44 59 0d 0a |..+CPIN: READY..| D (19251) esp-modem: debug_data: 0x3ffdad38 0d 0a 4f 4b 0d 0a |..OK..| D (19261) esp_modem_dce: esp_modem_dce_generic_command(35): Command:AT+CPIN? succeeded I (19269) modem_board: SIM Card Ready D (19273) event: running post MODEM_BOARD_EVENT:2 with handler 0x400893a0 and context 0x3ffeaf1c on loop 0x3ffd8fe8 0x400893a0: on_modem_event at E:/Project/eps32/example_usb_cat1/usb_cat1/main/app_main.c:140

I (19284) 4g_main: Modem Board Event: SIM Card Connected I (19290) modem_board: Modem state STAGE_CHECK_SIM, Success! D (19396) modem_board: Handling bits = 0100, stage = 4, retry = 0 I (19396) modem_board: Modem state STAGE_CHECK_SIGNAL, Start D (19397) esp_modem_dce: esp_modem_dce_generic_command(20): Sending command:AT+CSQ

D (19405) USB_HCDC: cdc write itf: 0, buf = 0x3f00aba0, len = 7 D (19413) USB_HCDC: cdc read itf: 0, buf = 0x3ffdad28, len = 21, read = 21 D (19418) esp-modem: debug_data: 0x3ffdad28 0d 0a 2b 43 53 51 3a 20 32 32 2c 39 39 0d 0a 0d |..+CSQ: 22,99...| D (19428) esp-modem: debug_data: 0x3ffdad38 0a 4f 4b 0d 0a |.OK..| D (19438) esp_modem_dce: esp_modem_dce_generic_command(35): Command:AT+CSQ succeeded I (19446) modem_board: Signal quality: rssi=22, ber=99 I (19452) modem_board: Modem state STAGE_CHECK_SIGNAL, Success! D (19558) modem_board: Handling bits = 0100, stage = 5, retry = 0 I (19558) modem_board: Modem state STAGE_CHECK_REGIST, Start D (19559) esp_modem_dce: esp_modem_dce_generic_command(20): Sending command:AT+COPS?

D (19567) USB_HCDC: cdc write itf: 0, buf = 0x3f00ab30, len = 9 D (19576) USB_HCDC: cdc read itf: 0, buf = 0x3ffdad28, len = 37, read = 37 D (19580) esp-modem: debug_data: 0x3ffdad28 0d 0a 2b 43 4f 50 53 3a 20 30 2c 30 2c 22 43 48 |..+COPS: 0,0,"CH| D (19591) esp-modem: debug_data: 0x3ffdad38 49 4e 41 20 4d 4f 42 49 4c 45 22 2c 37 0d 0a 0d |INA MOBILE",7...| D (19601) esp-modem: debug_data: 0x3ffdad48 0a 4f 4b 0d 0a |.OK..| D (19611) esp_modem_dce: esp_modem_dce_generic_command(35): Command:AT+COPS? succeeded I (19619) modem_board: Network registed, Operator: "CHINA MOBILE" I (19625) modem_board: Modem state STAGE_CHECK_REGIST, Success! D (19732) modem_board: Handling bits = 0100, stage = 6, retry = 0 I (19732) modem_board: Modem state STAGE_START_PPP, Start D (19733) esp_modem_dce: esp_modem_dce_generic_command(20): Sending command:AT+CGDCONT=1,"IP","cmnet"

D (19742) USB_HCDC: cdc write itf: 0, buf = 0x3ffeaf3c, len = 26 D (19753) USB_HCDC: cdc read itf: 0, buf = 0x3ffdad28, len = 6, read = 6 D (19755) esp-modem: debug_data: 0x3ffdad28 0d 0a 4f 4b 0d 0a |..OK..| D (19765) esp_modem_dce: esp_modem_dce_generic_command(35): Command:AT+CGDCONT=1,"IP","cmnet" succeeded D (19775) esp_modem_dce: esp_modem_dce_generic_command(20): Sending command:ATD*99#

D (19782) USB_HCDC: cdc write itf: 0, buf = 0x3f00abb0, len = 8 D (19791) USB_HCDC: cdc read itf: 0, buf = 0x3ffdad28, len = 11, read = 11 D (19796) esp-modem: debug_data: 0x3ffdad28 0d 0a 43 4f 4e 4e 45 43 54 0d 0a |..CONNECT..| D (19805) esp_modem_dce: esp_modem_dce_generic_command(35): Command:ATD*99# succeeded I (19814) modem_board: Modem state STAGE_START_PPP, Success! D (19815) event: running post ESP_MODEM_EVENT:0 with handler 0x400b3208 and context 0x3ffeb370 on loop 0x3ffdba10 0x400b3208: esp_netif_action_start at D:/Espressif/frameworks/esp-idf-v5.1.2/components/esp_netif/esp_netif_handlers.c:24

D (19830) esp_netif_handlers: esp_netif action has started with netif0x3ffeb4a8 from event_id=0 D (19839) esp-netif_lwip-ppp: esp_netif_start_ppp: Starting PPP connection: 0x3ffec418 D (19847) esp-netif_lwip-ppp: Phase Start D (19851) event: running post NETIF_PPP_STATUS:259 with handler 0x400949e8 and context 0x3ffeae80 on loop 0x3ffd8fe8 0x400949e8: on_ppp_changed at D:/Espressif/esp-iot-solution/components/usb/iot_usbh_modem/src/esp_modem_netif.c:73

D (19862) esp-netif_lwip-ppp: Phase Establish D (19866) event: running post NETIF_PPP_STATUS:262 with handler 0x400949e8 and context 0x3ffeae80 on loop 0x3ffd8fe8 0x400949e8: on_ppp_changed at D:/Espressif/esp-iot-solution/components/usb/iot_usbh_modem/src/esp_modem_netif.c:73

D (19877) USB_HCDC: cdc write itf: 0, buf = 0x3ffedc9c, len = 46 D (19883) esp_netif_lwip: check: remote, if=0x3ffeb4a8 fn=0x4011ab6c 0x4011ab6c: esp_netif_update_default_netif_lwip at D:/Espressif/frameworks/esp-idf-v5.1.2/components/esp_netif/lwip/esp_netif_lwip.c:327

D (19889) esp_netif_lwip: esp_netif_update_default_netif_lwip 0x3ffeb4a8 D (19896) esp_netif_lwip: call api in lwip: ret=0x0, give sem D (19902) event: running post ESP_MODEM_EVENT:0 with handler 0x40091d34 and context 0x3ffeaeb4 on loop 0x3ffdba10 0x40091d34: on_modem_event at D:/Espressif/esp-iot-solution/components/usb/iot_usbh_modem/src/usbh_modem_board.c:329

W (19912) modem_board: Modem event! 0 D (19920) modem_board: Handling bits = 0100, stage = 7, retry = 0 I (19923) modem_board: Modem state STAGE_WAIT_IP, Start D (25883) USB_HCDC: cdc write itf: 0, buf = 0x3ffedc9c, len = 46 D (31883) USB_HCDC: cdc write itf: 0, buf = 0x3ffedc9c, len = 46 D (37883) USB_HCDC: cdc write itf: 0, buf = 0x3ffedc9c, len = 46 D (43883) USB_HCDC: cdc write itf: 0, buf = 0x3ffedc9c, len = 46 D (49883) USB_HCDC: cdc write itf: 0, buf = 0x3ffedc9c, len = 46 D (55883) USB_HCDC: cdc write itf: 0, buf = 0x3ffedc9c, len = 46 D (61883) USB_HCDC: cdc write itf: 0, buf = 0x3ffedc9c, len = 46 D (67883) USB_HCDC: cdc write itf: 0, buf = 0x3ffedc9c, len = 46 D (73883) USB_HCDC: cdc write itf: 0, buf = 0x3ffedc9c, len = 46 D (79883) esp-netif_lwip-ppp: Phase Disconnect D (79883) event: running post NETIF_PPP_STATUS:268 with handler 0x400949e8 and context 0x3ffeae80 on loop 0x3ffd8fe8 0x400949e8: on_ppp_changed at D:/Espressif/esp-iot-solution/components/usb/iot_usbh_modem/src/esp_modem_netif.c:73

D (79887) esp-netif_lwip-ppp: Phase Dead D (79891) event: running post NETIF_PPP_STATUS:256 with handler 0x400949e8 and context 0x3ffeae80 on loop 0x3ffd8fe8 0x400949e8: on_ppp_changed at D:/Espressif/esp-iot-solution/components/usb/iot_usbh_modem/src/esp_modem_netif.c:73

I (79901) esp-netif_lwip-ppp: Connection lost D (79906) event: running post IP_EVENT:7 with handler 0x400b3398 and context 0x3ffeae4c on loop 0x3ffd8fe8 0x400b3398: esp_netif_action_disconnected at D:/Espressif/frameworks/esp-idf-v5.1.2/components/esp_netif/esp_netif_handlers.c:83

D (79916) esp_netif_handlers: esp_netif action disconnected with netif0x3ffeb4a8 from event_id=7 D (79925) esp_netif_lwip: check: remote, if=0x3ffeb4a8 fn=0x4011a970 0x4011a970: esp_netif_down_api at D:/Espressif/frameworks/esp-idf-v5.1.2/components/esp_netif/lwip/esp_netif_lwip.c:1638

D (79932) esp_netif_lwip: esp_netif_down_api esp_netif:0x3ffeb4a8 D (79938) esp_netif_lwip: esp_netif_internal_dhcpc_cb lwip-netif:0x3ffeb52c D (79945) esp_netif_lwip: check: local, if=0x3ffeb4a8 fn=0x4011ab6c 0x4011ab6c: esp_netif_update_default_netif_lwip at D:/Espressif/frameworks/esp-idf-v5.1.2/components/esp_netif/lwip/esp_netif_lwip.c:327

D (79951) esp_netif_lwip: esp_netif_update_default_netif_lwip 0x3ffeb4a8 D (79958) esp_netif_lwip: call api in lwip: ret=0x0, give sem D (79964) event: running post IP_EVENT:7 with handler 0x40091d34 and context 0x3ffeaee8 on loop 0x3ffd8fe8 0x40091d34: on_modem_event at D:/Espressif/esp-iot-solution/components/usb/iot_usbh_modem/src/usbh_modem_board.c:329

I (79974) modem_board: IP event! 7 I (79978) modem_board: Modem Disconnect from PPP Server W (79984) modem_board: Modem Got IP timeout, retry from start! D (79990) modem_board: Handling bits = 0120, stage = 7, retry = 5 E (79996) modem_board: Modem state STAGE_WAIT_IP, retry 5, timeout ! W (80003) modem_board: Retry From Start ! I (80008) modem_board: Modem state STAGE_SYNC, Start D (80024) esp_modem_dce: esp_modem_dce_generic_command(20): Sending command:AT

W (80024) esp-modem-dte: Not support sending command in ppp mode, please exit ppp mode first response timeoutem_dce: esp_modem_dce_generic_command(26): Command:AT I (80049) modem_board: Current timeouts: 1 and errors: 0 W (80049) modem_board: Try to exit ppp mode........ D (80051) esp_modem_dce: esp_modem_dce_generic_command(20): Sending command:+++

D (80058) USB_HCDC: cdc write itf: 0, buf = 0x3f00abc4, len = 3 E (90064) esp-modem-dte: esp_modem_dte_send_cmd(272): process command timeout W (90064) esp_modem_dce: esp_modem_dce_generic_command(26): Command:+++ response timeout D (90069) esp_modem_dce: esp_modem_dce_generic_command(20): Sending command:AT

D (90077) USB_HCDC: cdc write itf: 0, buf = 0x3f00aaf8, len = 3 D (90085) USB_HCDC: cdc read itf: 0, buf = 0x3ffdad28, len = 6, read = 6 D (90090) esp-modem: debug_data: 0x3ffdad28 0d 0a 4f 4b 0d 0a |..OK..| D (90099) esp_modem_dce: esp_modem_dce_generic_command(35): Command:AT succeeded D (90107) esp_modem_dce: esp_modem_dce_generic_command(20): Sending command:ATE0

D (90114) USB_HCDC: cdc write itf: 0, buf = 0x3f00ab04, len = 5 D (90123) USB_HCDC: cdc read itf: 0, buf = 0x3ffdad28, len = 6, read = 6 D (90127) esp-modem: debug_data: 0x3ffdad28 0d 0a 4f 4b 0d 0a |..OK..| D (90137) esp_modem_dce: esp_modem_dce_generic_command(35): Command:ATE0 succeeded I (90145) modem_board: Network Auto reconnecting ... D (90150) event: running post MODEM_BOARD_EVENT:7 with handler 0x400893a0 and context 0x3ffeaf1c on loop 0x3ffd8fe8 0x400893a0: on_modem_event at E:/Project/eps32/example_usb_cat1/usb_cat1/main/app_main.c:140

W (90161) 4g_main: Modem Board Event: Network disconnected E (90167) led_indicator: ./managed_components/espressif__led_indicator/src/led_indicator.c:461 (led_indicator_stop):invalid p_handle I (90180) modem_board: Modem state STAGE_SYNC, Success! D (90285) modem_board: Handling bits = 0120, stage = 3, retry = 0 I (90285) modem_board: Modem state STAGE_CHECK_SIM, Start D (90286) esp_modem_dce: esp_modem_dce_generic_command(20): Sending command:AT+CPIN?

D (90294) USB_HCDC: cdc write itf: 0, buf = 0x3f00ab58, len = 9 D (90302) USB_HCDC: cdc read itf: 0, buf = 0x3ffdad28, len = 22, read = 22 D (90307) esp-modem: debug_data: 0x3ffdad28 0d 0a 2b 43 50 49 4e 3a 20 52 45 41 44 59 0d 0a |..+CPIN: READY..| D (90317) esp-modem: debug_data: 0x3ffdad38 0d 0a 4f 4b 0d 0a |..OK..| D (90327) esp_modem_dce: esp_modem_dce_generic_command(35): Command:AT+CPIN? succeeded I (90335) modem_board: SIM Card Ready D (90339) event: running post MODEM_BOARD_EVENT:2 with handler 0x400893a0 and context 0x3ffeaf1c on loop 0x3ffd8fe8 0x400893a0: on_modem_event at E:/Project/eps32/example_usb_cat1/usb_cat1/main/app_main.c:140

I (90350) 4g_main: Modem Board Event: SIM Card Connected I (90356) modem_board: Modem state STAGE_CHECK_SIM, Success! D (90462) modem_board: Handling bits = 0120, stage = 4, retry = 0 I (90462) modem_board: Modem state STAGE_CHECK_SIGNAL, Start D (90463) esp_modem_dce: esp_modem_dce_generic_command(20): Sending command:AT+CSQ

D (90471) USB_HCDC: cdc write itf: 0, buf = 0x3f00aba0, len = 7 D (90479) USB_HCDC: cdc read itf: 0, buf = 0x3ffdad28, len = 21, read = 21 D (90484) esp-modem: debug_data: 0x3ffdad28 0d 0a 2b 43 53 51 3a 20 32 34 2c 39 39 0d 0a 0d |..+CSQ: 24,99...| D (90494) esp-modem: debug_data: 0x3ffdad38 0a 4f 4b 0d 0a |.OK..| D (90504) esp_modem_dce: esp_modem_dce_generic_command(35): Command:AT+CSQ succeeded I (90512) modem_board: Signal quality: rssi=24, ber=99 I (90518) modem_board: Modem state STAGE_CHECK_SIGNAL, Success! D (90624) modem_board: Handling bits = 0120, stage = 5, retry = 0 I (90624) modem_board: Modem state STAGE_CHECK_REGIST, Start D (90625) esp_modem_dce: esp_modem_dce_generic_command(20): Sending command:AT+COPS?

D (90633) USB_HCDC: cdc write itf: 0, buf = 0x3f00ab30, len = 9 D (90642) USB_HCDC: cdc read itf: 0, buf = 0x3ffdad28, len = 37, read = 37 D (90646) esp-modem: debug_data: 0x3ffdad28 0d 0a 2b 43 4f 50 53 3a 20 30 2c 30 2c 22 43 48 |..+COPS: 0,0,"CH| D (90657) esp-modem: debug_data: 0x3ffdad38 49 4e 41 20 4d 4f 42 49 4c 45 22 2c 37 0d 0a 0d |INA MOBILE",7...| D (90667) esp-modem: debug_data: 0x3ffdad48 0a 4f 4b 0d 0a |.OK..| D (90677) esp_modem_dce: esp_modem_dce_generic_command(35): Command:AT+COPS? succeeded I (90685) modem_board: Network registed, Operator: "CHINA MOBILE" I (90691) modem_board: Modem state STAGE_CHECK_REGIST, Success! D (90798) modem_board: Handling bits = 0120, stage = 6, retry = 0 I (90798) modem_board: Modem state STAGE_START_PPP, Start D (90799) esp_modem_dce: esp_modem_dce_generic_command(20): Sending command:AT+CGDCONT=1,"IP","cmnet"

D (90808) USB_HCDC: cdc write itf: 0, buf = 0x3ffed6a0, len = 26 D (90819) USB_HCDC: cdc read itf: 0, buf = 0x3ffdad28, len = 6, read = 6 D (90821) esp-modem: debug_data: 0x3ffdad28 0d 0a 4f 4b 0d 0a |..OK..| D (90831) esp_modem_dce: esp_modem_dce_generic_command(35): Command:AT+CGDCONT=1,"IP","cmnet" succeeded D (90841) esp_modem_dce: esp_modem_dce_generic_command(20): Sending command:ATD*99#

D (90849) USB_HCDC: cdc write itf: 0, buf = 0x3f00abb0, len = 8 D (90857) USB_HCDC: cdc read itf: 0, buf = 0x3ffdad28, len = 11, read = 11 D (90862) esp-modem: debug_data: 0x3ffdad28 0d 0a 43 4f 4e 4e 45 43 54 0d 0a |..CONNECT..| D (90872) esp_modem_dce: esp_modem_dce_generic_command(35): Command:ATD*99# succeeded I (90880) modem_board: Modem state STAGE_START_PPP, Success! D (90881) event: running post ESP_MODEM_EVENT:0 with handler 0x400b3208 and context 0x3ffeb370 on loop 0x3ffdba10 0x400b3208: esp_netif_action_start at D:/Espressif/frameworks/esp-idf-v5.1.2/components/esp_netif/esp_netif_handlers.c:24

D (90896) esp_netif_handlers: esp_netif action has started with netif0x3ffeb4a8 from event_id=0 D (90905) esp-netif_lwip-ppp: esp_netif_start_ppp: Starting PPP connection: 0x3ffec418 D (90913) esp-netif_lwip-ppp: Phase Start D (90917) event: running post NETIF_PPP_STATUS:259 with handler 0x400949e8 and context 0x3ffeae80 on loop 0x3ffd8fe8 0x400949e8: on_ppp_changed at D:/Espressif/esp-iot-solution/components/usb/iot_usbh_modem/src/esp_modem_netif.c:73

D (90928) esp-netif_lwip-ppp: Phase Establish D (90932) event: running post NETIF_PPP_STATUS:262 with handler 0x400949e8 and context 0x3ffeae80 on loop 0x3ffd8fe8 0x400949e8: on_ppp_changed at D:/Espressif/esp-iot-solution/components/usb/iot_usbh_modem/src/esp_modem_netif.c:73

D (90943) USB_HCDC: cdc write itf: 0, buf = 0x3ffedc9c, len = 47 D (90949) esp_netif_lwip: check: remote, if=0x3ffeb4a8 fn=0x4011ab6c 0x4011ab6c: esp_netif_update_default_netif_lwip at D:/Espressif/frameworks/esp-idf-v5.1.2/components/esp_netif/lwip/esp_netif_lwip.c:327

D (90955) esp_netif_lwip: esp_netif_update_default_netif_lwip 0x3ffeb4a8 D (90962) esp_netif_lwip: call api in lwip: ret=0x0, give sem D (90968) event: running post ESP_MODEM_EVENT:0 with handler 0x40091d34 and context 0x3ffeaeb4 on loop 0x3ffdba10 0x40091d34: on_modem_event at D:/Espressif/esp-iot-solution/components/usb/iot_usbh_modem/src/usbh_modem_board.c:329

W (90978) modem_board: Modem event! 0 D (90986) modem_board: Handling bits = 0120, stage = 7, retry = 0 I (90989) modem_board: Modem state STAGE_WAIT_IP, Start D (96949) USB_HCDC: cdc write itf: 0, buf = 0x3ffedc9c, len = 47 D (102949) USB_HCDC: cdc write itf: 0, buf = 0x3ffedc9c, len = 47 D (108949) USB_HCDC: cdc write itf: 0, buf = 0x3ffedc9c, len = 47 D (114949) USB_HCDC: cdc write itf: 0, buf = 0x3ffedc9c, len = 47 D (120949) USB_HCDC: cdc write itf: 0, buf = 0x3ffedc9c, len = 47 D (126949) USB_HCDC: cdc write itf: 0, buf = 0x3ffedc9c, len = 47 D (132949) USB_HCDC: cdc write itf: 0, buf = 0x3ffedc9c, len = 47 D (138949) USB_HCDC: cdc write itf: 0, buf = 0x3ffedc9c, len = 47**

tyrael-cui commented 6 months ago

问题已经解决,所用的CAT1模块不支持PPP协议,但仍然在拨号命令时,返回connect,导致程序等待ip.