nRF PPK2 "Failed to start PPK"

I've used this PPK2 since December last year, and on another machine (Linux Manjaro) it worked fine for all this time.

Now I want to use on a lab machine running Linux Manjaro and the PPK software fails to connect to the PPK2. The error message I get is "Failed to start PPK". I've tried different USB ports and cables, but no difference.

In the logs I get:

2023-07-07T09:57:56.604Z DEBUG Application data folder: /home/hans/.config/nrfconnect/pc-nrfconnect-ppk
2023-07-07T09:57:56.715Z DEBUG App pc-nrfconnect-ppk v3.5.5 local
2023-07-07T09:57:56.715Z DEBUG App path: /home/hans/.nrfconnect-apps/node_modules/pc-nrfconnect-ppk
2023-07-07T09:57:56.715Z DEBUG nRFConnect 4.1.2, required by the app is (>=4.0.0)
2023-07-07T09:57:56.715Z DEBUG nRFConnect path: /tmp/.mount_nrfconcd1Oza/resources/app.asar
2023-07-07T09:57:56.715Z DEBUG HomeDir: /home/hans
2023-07-07T09:57:56.715Z DEBUG TmpDir: /tmp
2023-07-07T09:57:56.722Z INFO Using nrf-device-lib-js version: 0.6.12
2023-07-07T09:57:56.722Z INFO Using nrf-device-lib version: 0.15.3
2023-07-07T09:57:56.722Z INFO Using nrfjprog DLL version: 10.19.1
2023-07-07T09:57:56.722Z INFO Using JLink version: JLink_V7.88k
2023-07-07T09:57:56.723Z INFO Installed JLink version does not match the provided version (V7.80c)
2023-07-07T09:57:57.150Z INFO Getting serialport options from persistent store E2204B17A9D8.pc-nrfconnect-ppk
2023-07-07T09:58:02.425Z INFO Validating firmware for device with s/n E2204B17A9D8
2023-07-07T09:58:02.430Z DEBUG Device has DFU trigger interface, the device is in Application mode
2023-07-07T09:58:02.432Z INFO Opening device with s/n E2204B17A9D8
2023-07-07T09:58:02.433Z ERROR Failed to start PPK
2023-07-07T09:58:02.433Z DEBUG Cannot read properties of undefined (reading 'comName')

I've tried to remove the directory in .config and .nrfconnect-apps and retried again from fresh installation, but no difference.

Versions:

  • nRF connect v4.1.2
  • nRF PPK v3.5.5
  • JLink (on system from Arch AUR) v7.88k
  • OS: Manjaro, all packages last updated yesterday.
  • Linux kernel 5.15.106-1-MANJARO

Unfortunately I do not have access to a Windows machine. Unfortunately nRF connect fails to render a GUI (blank screen) inside a Windows 10 VM.

Parents
  • Hi Hans

    Thanks for the update.

    Could you enable verbose logging in the nRF Connect for Desktop app for the power profiler, you will find it in the about tab and try again 

    In the app, do I understand correctly that is does not show as something similar to this?

    Just two more things to make sure we don't forget the basics. 

    Have you tested with another USB cable and different port? I once wasted to many minutes due to a USBcable without any data pins.

    Could you test the PPK2 on another computer, from the system requirements it says Ubuntu Linux however my colleagues said that they have used it with Manjaro in the past

    Regards

    Runar

  • Attached is a verbose log.

    Have you tested with another USB cable and different port? I once wasted to many minutes due to a USBcable without any data pins.

    Yes I have. Made no difference.

    Could you test the PPK2 on another computer, from the system requirements it says Ubuntu Linux however my colleagues said that they have used it with Manjaro in the past

    At this moment unfortunately, no.

    I can try later.

    In the app, do I understand correctly that is does not show as something similar to this?

    It does list the PPK2 device in that menu. But when I try to connect it logs the "Failed to start PPK" error.

    2023-07-07T11:50:58.088Z DEBUG Application data folder: /home/hans/.config/nrfconnect/pc-nrfconnect-ppk
    2023-07-07T11:50:58.177Z INFO Using nrf-device-lib-js version: 0.6.12
    2023-07-07T11:50:58.177Z INFO Using nrf-device-lib version: 0.15.3
    2023-07-07T11:50:58.177Z INFO Using nrfjprog DLL version: 10.19.1
    2023-07-07T11:50:58.177Z INFO Using JLink version: JLink_V7.88k
    2023-07-07T11:50:58.178Z DEBUG [nrfdl][debug](13:50:58.091) [jlink] [NRFJPROG][Client][] open
    2023-07-07T11:50:58.178Z DEBUG [nrfdl][debug](13:50:58.091) [jlink] [NRFJPROG][Client][] start
    2023-07-07T11:50:58.178Z DEBUG [nrfdl][debug](13:50:58.100) [jlink] [NRFJPROG][SeggerBackend][] Logger sink registered in Segger backend logger
    2023-07-07T11:50:58.178Z DEBUG [nrfdl][debug](13:50:58.100) [jlink] [NRFJPROG][JLink][] Logger sink registered in JLink logger
    2023-07-07T11:50:58.179Z DEBUG [nrfdl][debug](13:50:58.100) [jlink] [NRFJPROG][nRFXX][] open
    2023-07-07T11:50:58.179Z DEBUG [nrfdl][debug](13:50:58.100) [jlink] [NRFJPROG][nRFXX][] just_check_family
    2023-07-07T11:50:58.179Z DEBUG [nrfdl][debug](13:50:58.100) [jlink] [NRFJPROG][SeggerBackend][] open_dll
    2023-07-07T11:50:58.179Z DEBUG [nrfdl][debug](13:50:58.100) [jlink] [NRFJPROG][SeggerBackend][] No J-Link DLL path was provided. Attempting to auto detect.
    2023-07-07T11:50:58.179Z VERBOSE [nrfdl][trace](13:50:58.103) [jlink] [NRFJPROG][Client][] Command open executed for 6 milliseconds with result 0
    2023-07-07T11:50:58.180Z DEBUG [nrfdl][debug](13:50:58.103) [jlink] [NRFJPROG][Client][] jlink_dll_version
    2023-07-07T11:50:58.180Z VERBOSE [nrfdl][trace](13:50:58.103) [jlink] [NRFJPROG][Client][] Command jlink_dll_version executed for 0 milliseconds with result 0
    2023-07-07T11:50:58.180Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][SeggerBackend][] Set batch mode
    2023-07-07T11:50:58.181Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][SeggerBackend][] dll_version
    2023-07-07T11:50:58.181Z VERBOSE [nrfdl][trace](13:50:58.110) [jlink] [NRFJPROG][Worker][] Command open executed for 3 milliseconds with result 0
    2023-07-07T11:50:58.181Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][nRFXX][] dll_version
    2023-07-07T11:50:58.182Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][SeggerBackend][] is_connected_to_emu
    2023-07-07T11:50:58.182Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][SeggerBackend][] dll_version
    2023-07-07T11:50:58.182Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][SeggerBackend][] is_connected_to_emu
    2023-07-07T11:50:58.182Z VERBOSE [nrfdl][trace](13:50:58.110) [jlink] [NRFJPROG][Worker][] Command jlink_dll_version executed for 0 milliseconds with result 0
    2023-07-07T11:50:58.182Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][nRFXX][] close
    2023-07-07T11:50:58.182Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][SeggerBackend][] is_connected_to_emu
    2023-07-07T11:50:58.183Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][SeggerBackend][] close
    2023-07-07T11:50:58.183Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][SeggerBackend][] disconnect_from_emu
    2023-07-07T11:50:58.183Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][SeggerBackend][] is_connected_to_emu
    2023-07-07T11:50:58.184Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][SeggerBackend][] Segger Backend closed.
    2023-07-07T11:50:58.184Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][nRFXX][] nRF family DLL closed
    2023-07-07T11:50:58.184Z VERBOSE [nrfdl][trace](13:50:58.114) [jlink] [NRFJPROG][Client][] Command close executed for 10 milliseconds with result 0
    2023-07-07T11:50:58.184Z DEBUG [nrfdl][debug](13:50:58.114) [jlink] [NRFJPROG][Client][] terminate
    2023-07-07T11:50:58.184Z VERBOSE [nrfdl][trace](13:50:58.114) [jlink] [NRFJPROG][Client][] Command terminate executed for 0 milliseconds with result 0
    2023-07-07T11:50:58.184Z VERBOSE [nrfdl][trace](13:50:58.120) [jlink] [NRFJPROG][Worker][] Command close executed for 10 milliseconds with result 0
    2023-07-07T11:50:58.184Z VERBOSE [nrfdl][trace](13:50:58.120) [jlink] [NRFJPROG][Worker][] Command terminate executed for 0 milliseconds with result 0
    2023-07-07T11:50:58.184Z VERBOSE [nrfdl][trace](13:50:58.120) [jlink] [NRFJPROG][Worker][] Executed 4 commands for 13 milliseconds
    2023-07-07T11:50:58.184Z DEBUG [nrfdl][debug](13:50:58.130) [jlink] [NRFJPROG][Client][] Worker process exited with code: 0
    2023-07-07T11:50:58.184Z DEBUG [nrfdl][debug](13:50:58.130) [jlink] [NRFJPROG][Client][] Worker process exited with code: 0
    2023-07-07T11:50:58.184Z DEBUG [nrfdl][debug](13:50:58.130) [jlink] [NRFJPROG][Client][] Child process terminated with result 0
    2023-07-07T11:50:58.185Z VERBOSE [nrfdl][trace](13:50:58.130) [jlink] [NRFJPROG][Client][] Executed 4 commands for 16 milliseconds
    2023-07-07T11:50:58.185Z DEBUG [nrfdl][debug](13:50:58.131) [jlink] [NRFJPROG][Client][] terminate
    2023-07-07T11:50:58.185Z WARN [nrfdl][warning](13:50:58.142) [JlinkARM] JlinkARM version non expected one found: JLink_V7.88k, expected: JLink_V7.80c
    2023-07-07T11:50:58.254Z DEBUG App pc-nrfconnect-ppk v3.5.5 local
    2023-07-07T11:50:58.254Z DEBUG App path: /home/hans/.nrfconnect-apps/node_modules/pc-nrfconnect-ppk
    2023-07-07T11:50:58.254Z DEBUG nRFConnect 4.1.2, required by the app is (>=4.0.0)
    2023-07-07T11:50:58.254Z DEBUG nRFConnect path: /tmp/.mount_nrfconIV0ziU/resources/app.asar
    2023-07-07T11:50:58.254Z DEBUG HomeDir: /home/hans
    2023-07-07T11:50:58.254Z DEBUG TmpDir: /tmp
    2023-07-07T11:50:58.264Z INFO Installed JLink version does not match the provided version (V7.80c)
    2023-07-07T11:50:58.264Z WARN [nrfdl][warning](13:50:58.254) [JlinkARM] JlinkARM version non expected one found: JLink_V7.88k, expected: JLink_V7.80c
    2023-07-07T11:50:58.281Z VERBOSE [nrfdl][trace](13:50:58.280) USBPlatformAPI::copyDeviceToUSB: Getting string descriptor for manufacturer
    2023-07-07T11:50:58.281Z VERBOSE [nrfdl][trace](13:50:58.281) USBPlatformAPI::getStringDescriptor: descriptor = Nordic Semiconductor
    2023-07-07T11:50:58.281Z VERBOSE [nrfdl][trace](13:50:58.281) USBPlatformAPI::copyDeviceToUSB: Getting string descriptor for product
    2023-07-07T11:50:58.282Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::getStringDescriptor: descriptor = PPK2
    2023-07-07T11:50:58.282Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::copyDeviceToUSB: Getting string descriptor for serialnumber
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::getStringDescriptor: descriptor = E2204B17A9D8
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::enumerate: Found new device with identifier 1-27, adding it
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::enumerate: New device added, in total 2 devices are added
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::enumerate: Starting iteration 2
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::enumerate: Doing copyDeviceToUsb of device #2
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::copyDeviceToUSB: idVendor=0x8087, idProduct=0xaaa
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) Unable to open USB device. Error code: -3 (LIBUSB_ERROR_ACCESS). 
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::enumerate: Found new device with identifier 1-4, adding it
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::enumerate: New device added, in total 3 devices are added
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::enumerate: Starting iteration 3
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::enumerate: Doing copyDeviceToUsb of device #3
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::copyDeviceToUSB: idVendor=0xbda, idProduct=0x5650
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) Unable to open USB device. Error code: -3 (LIBUSB_ERROR_ACCESS). 
    2023-07-07T11:50:58.284Z VERBOSE [nrfdl][trace](13:50:58.283) USBPlatformAPI::enumerate: Found new device with identifier 1-3, adding it
    2023-07-07T11:50:58.284Z VERBOSE [nrfdl][trace](13:50:58.283) USBPlatformAPI::enumerate: New device added, in total 4 devices are added
    2023-07-07T11:50:58.284Z VERBOSE [nrfdl][trace](13:50:58.283) USBPlatformAPI::enumerate: Starting iteration 4
    2023-07-07T11:50:58.284Z VERBOSE [nrfdl][trace](13:50:58.283) USBPlatformAPI::enumerate: Doing copyDeviceToUsb of device #4
    2023-07-07T11:50:58.284Z VERBOSE [nrfdl][trace](13:50:58.283) USBPlatformAPI::copyDeviceToUSB: idVendor=0xa5c, idProduct=0x5832
    2023-07-07T11:50:58.390Z VERBOSE [nrfdl][trace](13:50:58.390) USBPlatformAPI::copyDeviceToUSB: Getting string descriptor for manufacturer
    2023-07-07T11:50:58.391Z VERBOSE [nrfdl][trace](13:50:58.391) USBPlatformAPI::getStringDescriptor: descriptor = Broadcom Corp
    2023-07-07T11:50:58.391Z VERBOSE [nrfdl][trace](13:50:58.391) USBPlatformAPI::copyDeviceToUSB: Getting string descriptor for product
    2023-07-07T11:50:58.391Z VERBOSE [nrfdl][trace](13:50:58.391) USBPlatformAPI::getStringDescriptor: descriptor = 5880
    2023-07-07T11:50:58.392Z VERBOSE [nrfdl][trace](13:50:58.391) USBPlatformAPI::copyDeviceToUSB: Getting string descriptor for serialnumber
    2023-07-07T11:50:58.392Z VERBOSE [nrfdl][trace](13:50:58.391) USBPlatformAPI::getStringDescriptor: descriptor = 0123456789ABCD
    2023-07-07T11:50:58.392Z VERBOSE [nrfdl][trace](13:50:58.392) USBPlatformAPI::enumerate: Found new device with identifier 1-2, adding it
    2023-07-07T11:50:58.392Z VERBOSE [nrfdl][trace](13:50:58.392) USBPlatformAPI::enumerate: New device added, in total 5 devices are added
    2023-07-07T11:50:58.392Z VERBOSE [nrfdl][trace](13:50:58.392) USBPlatformAPI::enumerate: Starting iteration 5
    2023-07-07T11:50:58.393Z VERBOSE [nrfdl][trace](13:50:58.392) USBPlatformAPI::enumerate: Doing copyDeviceToUsb of device #5
    2023-07-07T11:50:58.393Z VERBOSE [nrfdl][trace](13:50:58.392) USBPlatformAPI::copyDeviceToUSB: idVendor=0x1d6b, idProduct=0x2
    2023-07-07T11:50:58.393Z VERBOSE [nrfdl][trace](13:50:58.392) Unable to open USB device. Error code: -3 (LIBUSB_ERROR_ACCESS). 
    2023-07-07T11:50:58.393Z VERBOSE [nrfdl][trace](13:50:58.392) USBPlatformAPI::enumerate: Found new device with identifier 1-1, adding it
    2023-07-07T11:50:58.393Z VERBOSE [nrfdl][trace](13:50:58.392) USBPlatformAPI::enumerate: New device added, in total 6 devices are added
    2023-07-07T11:50:58.394Z VERBOSE [nrfdl][trace](13:50:58.392) USBPlatformAPI::enumerate: Found 6 devices
    2023-07-07T11:50:58.394Z DEBUG [nrfdl][debug](13:50:58.392) USBLister: Adding new device with id 1 and serial number: 'NONE'
    2023-07-07T11:50:58.394Z DEBUG [nrfdl][debug](13:50:58.392) USBLister: Adding new device with id 2 and serial number: '0123456789ABCD'
    2023-07-07T11:50:58.394Z DEBUG [nrfdl][debug](13:50:58.392) USBLister: Adding new device with id 3 and serial number: 'NONE'
    2023-07-07T11:50:58.394Z DEBUG [nrfdl][debug](13:50:58.393) USBLister: Adding new device with id 4 and serial number: 'NONE'
    2023-07-07T11:50:58.394Z DEBUG [nrfdl][debug](13:50:58.393) USBLister: Adding new device with id 5 and serial number: 'E2204B17A9D8'
    2023-07-07T11:50:58.395Z VERBOSE [nrfdl][trace](13:50:58.393) USBPlatformAPI::copyDeviceToUSB: idVendor=0x1d6b, idProduct=0x3
    2023-07-07T11:50:58.395Z VERBOSE [nrfdl][trace](13:50:58.393) Unable to open USB device. Error code: -3 (LIBUSB_ERROR_ACCESS). 
    2023-07-07T11:50:58.395Z VERBOSE [nrfdl][trace](13:50:58.393) USBPlatformAPI::copyDeviceToUSB: idVendor=0x1915, idProduct=0xc00a
    2023-07-07T11:50:58.395Z VERBOSE [nrfdl][trace](13:50:58.393) USBPlatformAPI::copyDeviceToUSB: Getting string descriptor for manufacturer
    2023-07-07T11:50:58.395Z VERBOSE [nrfdl][trace](13:50:58.393) USBPlatformAPI::getStringDescriptor: descriptor = Nordic Semiconductor
    2023-07-07T11:50:58.396Z VERBOSE [nrfdl][trace](13:50:58.393) USBPlatformAPI::copyDeviceToUSB: Getting string descriptor for product
    2023-07-07T11:50:58.396Z VERBOSE [nrfdl][trace](13:50:58.394) USBPlatformAPI::getStringDescriptor: descriptor = PPK2
    2023-07-07T11:50:58.396Z VERBOSE [nrfdl][trace](13:50:58.394) USBPlatformAPI::copyDeviceToUSB: Getting string descriptor for serialnumber
    2023-07-07T11:50:58.396Z VERBOSE [nrfdl][trace](13:50:58.394) USBPlatformAPI::getStringDescriptor: descriptor = E2204B17A9D8
    2023-07-07T11:50:58.397Z VERBOSE [nrfdl][trace](13:50:58.395) USBPlatformAPI::copyDeviceToUSB: idVendor=0x1d6b, idProduct=0x3
    2023-07-07T11:50:58.397Z VERBOSE [nrfdl][trace](13:50:58.395) Unable to open USB device. Error code: -3 (LIBUSB_ERROR_ACCESS). 
    2023-07-07T11:50:58.398Z VERBOSE [nrfdl][trace](13:50:58.395) USBPlatformAPI::copyDeviceToUSB: idVendor=0x1915, idProduct=0xc00a
    2023-07-07T11:50:58.398Z VERBOSE [nrfdl][trace](13:50:58.395) USBPlatformAPI::copyDeviceToUSB: Getting string descriptor for manufacturer
    2023-07-07T11:50:58.398Z VERBOSE [nrfdl][trace](13:50:58.396) USBPlatformAPI::getStringDescriptor: descriptor = Nordic Semiconductor
    2023-07-07T11:50:58.398Z VERBOSE [nrfdl][trace](13:50:58.396) USBPlatformAPI::copyDeviceToUSB: Getting string descriptor for product
    2023-07-07T11:50:58.399Z VERBOSE [nrfdl][trace](13:50:58.396) USBPlatformAPI::getStringDescriptor: descriptor = PPK2
    2023-07-07T11:50:58.399Z VERBOSE [nrfdl][trace](13:50:58.396) USBPlatformAPI::copyDeviceToUSB: Getting string descriptor for serialnumber
    2023-07-07T11:50:58.399Z VERBOSE [nrfdl][trace](13:50:58.397) USBPlatformAPI::getStringDescriptor: descriptor = E2204B17A9D8
    2023-07-07T11:50:58.399Z DEBUG [nrfdl][debug](13:50:58.397) USBLister: Adding new device with id 6 and serial number: 'NONE'
    2023-07-07T11:50:58.400Z VERBOSE [nrfdl][trace](13:50:58.398) DeviceLister::enumerate::enumerate_task: After async_lister->enumerate
    2023-07-07T11:50:58.400Z VERBOSE [nrfdl][trace](13:50:58.399) [jlink] JLinkPlugin::enumerate
    2023-07-07T11:50:58.400Z DEBUG [nrfdl][debug](13:50:58.399) [jlink] [->] enumerate
    2023-07-07T11:50:58.400Z DEBUG [nrfdl][debug](13:50:58.399) [jlink] JLinkHW::enumerate all devices
    2023-07-07T11:50:58.413Z DEBUG [nrfdl][debug](13:50:58.412) [jlink] [NRFJPROG][Client][] open
    2023-07-07T11:50:58.421Z DEBUG [nrfdl][debug](13:50:58.412) [jlink] [NRFJPROG][Client][] start
    2023-07-07T11:50:58.434Z DEBUG [nrfdl][debug](13:50:58.433) [jlink] [NRFJPROG][SeggerBackend][] Logger sink registered in Segger backend logger
    2023-07-07T11:50:58.434Z DEBUG [nrfdl][debug](13:50:58.433) [jlink] [NRFJPROG][JLink][] Logger sink registered in JLink logger
    2023-07-07T11:50:58.434Z DEBUG [nrfdl][debug](13:50:58.433) [jlink] [NRFJPROG][nRFXX][] open
    2023-07-07T11:50:58.435Z DEBUG [nrfdl][debug](13:50:58.433) [jlink] [NRFJPROG][nRFXX][] just_check_family
    2023-07-07T11:50:58.435Z DEBUG [nrfdl][debug](13:50:58.433) [jlink] [NRFJPROG][SeggerBackend][] open_dll
    2023-07-07T11:50:58.435Z DEBUG [nrfdl][debug](13:50:58.433) [jlink] [NRFJPROG][SeggerBackend][] No J-Link DLL path was provided. Attempting to auto detect.
    2023-07-07T11:50:58.440Z VERBOSE [nrfdl][trace](13:50:58.440) [jlink] [NRFJPROG][Client][] Command open executed for 11 milliseconds with result 0
    2023-07-07T11:50:58.441Z DEBUG [nrfdl][debug](13:50:58.440) [jlink] [NRFJPROG][Client][] enum_emu_snr
    2023-07-07T11:50:58.444Z DEBUG [nrfdl][debug](13:50:58.443) [jlink] [NRFJPROG][SeggerBackend][] Set batch mode
    2023-07-07T11:50:58.444Z DEBUG [nrfdl][debug](13:50:58.443) [jlink] [NRFJPROG][SeggerBackend][] dll_version
    2023-07-07T11:50:58.444Z VERBOSE [nrfdl][trace](13:50:58.443) [jlink] [NRFJPROG][Worker][] Command open executed for 7 milliseconds with result 0
    2023-07-07T11:50:58.445Z DEBUG [nrfdl][debug](13:50:58.443) [jlink] [NRFJPROG][nRFXX][] enum_emu_snr
    2023-07-07T11:50:58.445Z DEBUG [nrfdl][debug](13:50:58.443) [jlink] [NRFJPROG][SeggerBackend][] is_connected_to_emu
    2023-07-07T11:50:58.445Z DEBUG [nrfdl][debug](13:50:58.443) [jlink] [NRFJPROG][SeggerBackend][] enum_emu_snr
    2023-07-07T11:50:58.445Z DEBUG [nrfdl][debug](13:50:58.443) [jlink] [NRFJPROG][SeggerBackend][] ---just_enum_emu_snr
    2023-07-07T11:50:58.445Z DEBUG [nrfdl][debug](13:50:58.443) [jlink] [NRFJPROG][SeggerBackend][] ---just_get_num_emus
    2023-07-07T11:50:58.822Z VERBOSE [nrfdl][trace](13:50:58.822) [jlink] [NRFJPROG][Client][] Command enum_emu_snr executed for 381 milliseconds with result 0
    2023-07-07T11:50:58.823Z DEBUG [nrfdl][debug](13:50:58.822) [jlink] Found 0 JLink devices connected
    2023-07-07T11:50:58.828Z DEBUG [nrfdl][debug](13:50:58.827) [jlink] [NRFJPROG][SeggerBackend][] is_connected_to_emu
    2023-07-07T11:50:58.828Z VERBOSE [nrfdl][trace](13:50:58.828) [jlink] [NRFJPROG][Worker][] Command enum_emu_snr executed for 381 milliseconds with result 0
    2023-07-07T11:50:58.828Z DEBUG [nrfdl][debug](13:50:58.828) [jlink] [NRFJPROG][nRFXX][] close
    2023-07-07T11:50:58.828Z DEBUG [nrfdl][debug](13:50:58.828) [jlink] [NRFJPROG][SeggerBackend][] is_connected_to_emu
    2023-07-07T11:50:58.828Z DEBUG [nrfdl][debug](13:50:58.828) [jlink] [NRFJPROG][SeggerBackend][] close
    2023-07-07T11:50:58.828Z DEBUG [nrfdl][debug](13:50:58.828) [jlink] [NRFJPROG][SeggerBackend][] disconnect_from_emu
    2023-07-07T11:50:58.828Z DEBUG [nrfdl][debug](13:50:58.828) [jlink] [NRFJPROG][SeggerBackend][] is_connected_to_emu
    2023-07-07T11:50:58.828Z DEBUG [nrfdl][debug](13:50:58.828) [jlink] [NRFJPROG][SeggerBackend][] Segger Backend closed.
    2023-07-07T11:50:58.828Z DEBUG [nrfdl][debug](13:50:58.828) [jlink] [NRFJPROG][nRFXX][] nRF family DLL closed
    2023-07-07T11:50:58.833Z VERBOSE [nrfdl][trace](13:50:58.833) [jlink] [NRFJPROG][Client][] Command close executed for 10 milliseconds with result 0
    2023-07-07T11:50:58.834Z DEBUG [nrfdl][debug](13:50:58.833) [jlink] [NRFJPROG][Client][] terminate
    2023-07-07T11:50:58.834Z VERBOSE [nrfdl][trace](13:50:58.833) [jlink] [NRFJPROG][Client][] Command terminate executed for 0 milliseconds with result 0
    2023-07-07T11:50:58.838Z VERBOSE [nrfdl][trace](13:50:58.838) [jlink] [NRFJPROG][Worker][] Command close executed for 10 milliseconds with result 0
    2023-07-07T11:50:58.838Z VERBOSE [nrfdl][trace](13:50:58.838) [jlink] [NRFJPROG][Worker][] Command terminate executed for 0 milliseconds with result 0
    2023-07-07T11:50:58.838Z VERBOSE [nrfdl][trace](13:50:58.838) [jlink] [NRFJPROG][Worker][] Executed 4 commands for 398 milliseconds
    2023-07-07T11:50:58.849Z DEBUG [nrfdl][debug](13:50:58.849) [jlink] [NRFJPROG][Client][] Worker process exited with code: 0
    2023-07-07T11:50:58.850Z DEBUG [nrfdl][debug](13:50:58.849) [jlink] [NRFJPROG][Client][] Worker process exited with code: 0
    2023-07-07T11:50:58.850Z DEBUG [nrfdl][debug](13:50:58.849) [jlink] [NRFJPROG][Client][] Child process terminated with result 0
    2023-07-07T11:50:58.850Z VERBOSE [nrfdl][trace](13:50:58.849) [jlink] [NRFJPROG][Client][] Executed 4 commands for 402 milliseconds
    2023-07-07T11:50:58.850Z DEBUG [nrfdl][debug](13:50:58.849) [jlink] [NRFJPROG][Client][] terminate
    2023-07-07T11:50:58.860Z DEBUG [nrfdl][debug](13:50:58.859) [jlink] JLinkHW::enumerate waiting for futures
    2023-07-07T11:50:58.860Z DEBUG [nrfdl][debug](13:50:58.859) [jlink] JLinkHW::enumerate done waiting for futures
    2023-07-07T11:50:58.860Z DEBUG [nrfdl][debug](13:50:58.859) [jlink] [<-] enumerate [took 460ms]
    2023-07-07T11:50:58.860Z DEBUG [nrfdl][debug](13:50:58.860) Enumeration for plugin 'jlink' took 461 ms
    2023-07-07T11:50:58.860Z DEBUG [nrfdl][debug](13:50:58.860) [SerialPortListerHW::LINUX] Linux serialport enumerate.
    2023-07-07T11:50:58.862Z DEBUG [nrfdl][debug](13:50:58.862) [SerialPortListerHW::LINUX] try to map FTDI to segger device
    2023-07-07T11:50:58.862Z DEBUG [nrfdl][debug](13:50:58.862) Enumeration for plugin 'serialport' took 1 ms
    2023-07-07T11:50:58.862Z DEBUG [nrfdl][debug](13:50:58.862) Enumeration for plugin 'sdfu' took 0 ms
    2023-07-07T11:50:58.862Z VERBOSE [nrfdl][trace](13:50:58.862) [broken] BrokenPlugin::enumerate
    2023-07-07T11:50:58.862Z DEBUG [nrfdl][debug](13:50:58.862) Enumeration for plugin 'broken' took 0 ms
    2023-07-07T11:50:58.862Z VERBOSE [nrfdl][trace](13:50:58.862) DeviceLister::enumerate: Found device with serial number: '<unknown>'
    2023-07-07T11:50:58.862Z VERBOSE [nrfdl][trace](13:50:58.862) DeviceLister::enumerate: Found device with serial number: 'E2204B17A9D8'
    2023-07-07T11:50:58.863Z VERBOSE [nrfdl][trace](13:50:58.862) DeviceLister::enumerate: device registered to device list
    2023-07-07T11:50:58.863Z VERBOSE [nrfdl][trace](13:50:58.862) DeviceLister::enumerate: Found device with serial number: '<unknown>'
    2023-07-07T11:50:58.863Z VERBOSE [nrfdl][trace](13:50:58.862) DeviceLister::enumerate: Found device with serial number: '<unknown>'
    2023-07-07T11:50:58.863Z VERBOSE [nrfdl][trace](13:50:58.862) DeviceLister::enumerate: Found device with serial number: '0123456789ABCD'
    2023-07-07T11:50:58.863Z VERBOSE [nrfdl][trace](13:50:58.862) DeviceLister::enumerate: Found device with serial number: '<unknown>'
    2023-07-07T11:50:58.863Z VERBOSE [nrfdl][trace](13:50:58.862) DeviceLister::enumerate: Finished in 839 ms
    2023-07-07T11:50:58.863Z VERBOSE [nrfdl][trace](13:50:58.862) DeviceLister::enumerate: Completed waiting for enumerate task
    2023-07-07T11:50:58.863Z VERBOSE [nrfdl][trace](13:50:58.862) DeviceLister::enumerate: done
    2023-07-07T11:50:58.864Z INFO Getting serialport options from persistent store E2204B17A9D8.pc-nrfconnect-ppk
    2023-07-07T11:51:00.278Z INFO Validating firmware for device with s/n E2204B17A9D8
    2023-07-07T11:51:00.292Z DEBUG Device has DFU trigger interface, the device is in Application mode
    2023-07-07T11:51:00.299Z INFO Opening device with s/n E2204B17A9D8
    2023-07-07T11:51:00.302Z ERROR Failed to start PPK
    2023-07-07T11:51:00.302Z DEBUG Cannot read properties of undefined (reading 'comName')
    

Reply
  • Attached is a verbose log.

    Have you tested with another USB cable and different port? I once wasted to many minutes due to a USBcable without any data pins.

    Yes I have. Made no difference.

    Could you test the PPK2 on another computer, from the system requirements it says Ubuntu Linux however my colleagues said that they have used it with Manjaro in the past

    At this moment unfortunately, no.

    I can try later.

    In the app, do I understand correctly that is does not show as something similar to this?

    It does list the PPK2 device in that menu. But when I try to connect it logs the "Failed to start PPK" error.

    2023-07-07T11:50:58.088Z DEBUG Application data folder: /home/hans/.config/nrfconnect/pc-nrfconnect-ppk
    2023-07-07T11:50:58.177Z INFO Using nrf-device-lib-js version: 0.6.12
    2023-07-07T11:50:58.177Z INFO Using nrf-device-lib version: 0.15.3
    2023-07-07T11:50:58.177Z INFO Using nrfjprog DLL version: 10.19.1
    2023-07-07T11:50:58.177Z INFO Using JLink version: JLink_V7.88k
    2023-07-07T11:50:58.178Z DEBUG [nrfdl][debug](13:50:58.091) [jlink] [NRFJPROG][Client][] open
    2023-07-07T11:50:58.178Z DEBUG [nrfdl][debug](13:50:58.091) [jlink] [NRFJPROG][Client][] start
    2023-07-07T11:50:58.178Z DEBUG [nrfdl][debug](13:50:58.100) [jlink] [NRFJPROG][SeggerBackend][] Logger sink registered in Segger backend logger
    2023-07-07T11:50:58.178Z DEBUG [nrfdl][debug](13:50:58.100) [jlink] [NRFJPROG][JLink][] Logger sink registered in JLink logger
    2023-07-07T11:50:58.179Z DEBUG [nrfdl][debug](13:50:58.100) [jlink] [NRFJPROG][nRFXX][] open
    2023-07-07T11:50:58.179Z DEBUG [nrfdl][debug](13:50:58.100) [jlink] [NRFJPROG][nRFXX][] just_check_family
    2023-07-07T11:50:58.179Z DEBUG [nrfdl][debug](13:50:58.100) [jlink] [NRFJPROG][SeggerBackend][] open_dll
    2023-07-07T11:50:58.179Z DEBUG [nrfdl][debug](13:50:58.100) [jlink] [NRFJPROG][SeggerBackend][] No J-Link DLL path was provided. Attempting to auto detect.
    2023-07-07T11:50:58.179Z VERBOSE [nrfdl][trace](13:50:58.103) [jlink] [NRFJPROG][Client][] Command open executed for 6 milliseconds with result 0
    2023-07-07T11:50:58.180Z DEBUG [nrfdl][debug](13:50:58.103) [jlink] [NRFJPROG][Client][] jlink_dll_version
    2023-07-07T11:50:58.180Z VERBOSE [nrfdl][trace](13:50:58.103) [jlink] [NRFJPROG][Client][] Command jlink_dll_version executed for 0 milliseconds with result 0
    2023-07-07T11:50:58.180Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][SeggerBackend][] Set batch mode
    2023-07-07T11:50:58.181Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][SeggerBackend][] dll_version
    2023-07-07T11:50:58.181Z VERBOSE [nrfdl][trace](13:50:58.110) [jlink] [NRFJPROG][Worker][] Command open executed for 3 milliseconds with result 0
    2023-07-07T11:50:58.181Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][nRFXX][] dll_version
    2023-07-07T11:50:58.182Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][SeggerBackend][] is_connected_to_emu
    2023-07-07T11:50:58.182Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][SeggerBackend][] dll_version
    2023-07-07T11:50:58.182Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][SeggerBackend][] is_connected_to_emu
    2023-07-07T11:50:58.182Z VERBOSE [nrfdl][trace](13:50:58.110) [jlink] [NRFJPROG][Worker][] Command jlink_dll_version executed for 0 milliseconds with result 0
    2023-07-07T11:50:58.182Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][nRFXX][] close
    2023-07-07T11:50:58.182Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][SeggerBackend][] is_connected_to_emu
    2023-07-07T11:50:58.183Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][SeggerBackend][] close
    2023-07-07T11:50:58.183Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][SeggerBackend][] disconnect_from_emu
    2023-07-07T11:50:58.183Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][SeggerBackend][] is_connected_to_emu
    2023-07-07T11:50:58.184Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][SeggerBackend][] Segger Backend closed.
    2023-07-07T11:50:58.184Z DEBUG [nrfdl][debug](13:50:58.110) [jlink] [NRFJPROG][nRFXX][] nRF family DLL closed
    2023-07-07T11:50:58.184Z VERBOSE [nrfdl][trace](13:50:58.114) [jlink] [NRFJPROG][Client][] Command close executed for 10 milliseconds with result 0
    2023-07-07T11:50:58.184Z DEBUG [nrfdl][debug](13:50:58.114) [jlink] [NRFJPROG][Client][] terminate
    2023-07-07T11:50:58.184Z VERBOSE [nrfdl][trace](13:50:58.114) [jlink] [NRFJPROG][Client][] Command terminate executed for 0 milliseconds with result 0
    2023-07-07T11:50:58.184Z VERBOSE [nrfdl][trace](13:50:58.120) [jlink] [NRFJPROG][Worker][] Command close executed for 10 milliseconds with result 0
    2023-07-07T11:50:58.184Z VERBOSE [nrfdl][trace](13:50:58.120) [jlink] [NRFJPROG][Worker][] Command terminate executed for 0 milliseconds with result 0
    2023-07-07T11:50:58.184Z VERBOSE [nrfdl][trace](13:50:58.120) [jlink] [NRFJPROG][Worker][] Executed 4 commands for 13 milliseconds
    2023-07-07T11:50:58.184Z DEBUG [nrfdl][debug](13:50:58.130) [jlink] [NRFJPROG][Client][] Worker process exited with code: 0
    2023-07-07T11:50:58.184Z DEBUG [nrfdl][debug](13:50:58.130) [jlink] [NRFJPROG][Client][] Worker process exited with code: 0
    2023-07-07T11:50:58.184Z DEBUG [nrfdl][debug](13:50:58.130) [jlink] [NRFJPROG][Client][] Child process terminated with result 0
    2023-07-07T11:50:58.185Z VERBOSE [nrfdl][trace](13:50:58.130) [jlink] [NRFJPROG][Client][] Executed 4 commands for 16 milliseconds
    2023-07-07T11:50:58.185Z DEBUG [nrfdl][debug](13:50:58.131) [jlink] [NRFJPROG][Client][] terminate
    2023-07-07T11:50:58.185Z WARN [nrfdl][warning](13:50:58.142) [JlinkARM] JlinkARM version non expected one found: JLink_V7.88k, expected: JLink_V7.80c
    2023-07-07T11:50:58.254Z DEBUG App pc-nrfconnect-ppk v3.5.5 local
    2023-07-07T11:50:58.254Z DEBUG App path: /home/hans/.nrfconnect-apps/node_modules/pc-nrfconnect-ppk
    2023-07-07T11:50:58.254Z DEBUG nRFConnect 4.1.2, required by the app is (>=4.0.0)
    2023-07-07T11:50:58.254Z DEBUG nRFConnect path: /tmp/.mount_nrfconIV0ziU/resources/app.asar
    2023-07-07T11:50:58.254Z DEBUG HomeDir: /home/hans
    2023-07-07T11:50:58.254Z DEBUG TmpDir: /tmp
    2023-07-07T11:50:58.264Z INFO Installed JLink version does not match the provided version (V7.80c)
    2023-07-07T11:50:58.264Z WARN [nrfdl][warning](13:50:58.254) [JlinkARM] JlinkARM version non expected one found: JLink_V7.88k, expected: JLink_V7.80c
    2023-07-07T11:50:58.281Z VERBOSE [nrfdl][trace](13:50:58.280) USBPlatformAPI::copyDeviceToUSB: Getting string descriptor for manufacturer
    2023-07-07T11:50:58.281Z VERBOSE [nrfdl][trace](13:50:58.281) USBPlatformAPI::getStringDescriptor: descriptor = Nordic Semiconductor
    2023-07-07T11:50:58.281Z VERBOSE [nrfdl][trace](13:50:58.281) USBPlatformAPI::copyDeviceToUSB: Getting string descriptor for product
    2023-07-07T11:50:58.282Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::getStringDescriptor: descriptor = PPK2
    2023-07-07T11:50:58.282Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::copyDeviceToUSB: Getting string descriptor for serialnumber
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::getStringDescriptor: descriptor = E2204B17A9D8
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::enumerate: Found new device with identifier 1-27, adding it
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::enumerate: New device added, in total 2 devices are added
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::enumerate: Starting iteration 2
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::enumerate: Doing copyDeviceToUsb of device #2
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::copyDeviceToUSB: idVendor=0x8087, idProduct=0xaaa
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) Unable to open USB device. Error code: -3 (LIBUSB_ERROR_ACCESS). 
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::enumerate: Found new device with identifier 1-4, adding it
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::enumerate: New device added, in total 3 devices are added
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::enumerate: Starting iteration 3
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::enumerate: Doing copyDeviceToUsb of device #3
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) USBPlatformAPI::copyDeviceToUSB: idVendor=0xbda, idProduct=0x5650
    2023-07-07T11:50:58.283Z VERBOSE [nrfdl][trace](13:50:58.282) Unable to open USB device. Error code: -3 (LIBUSB_ERROR_ACCESS). 
    2023-07-07T11:50:58.284Z VERBOSE [nrfdl][trace](13:50:58.283) USBPlatformAPI::enumerate: Found new device with identifier 1-3, adding it
    2023-07-07T11:50:58.284Z VERBOSE [nrfdl][trace](13:50:58.283) USBPlatformAPI::enumerate: New device added, in total 4 devices are added
    2023-07-07T11:50:58.284Z VERBOSE [nrfdl][trace](13:50:58.283) USBPlatformAPI::enumerate: Starting iteration 4
    2023-07-07T11:50:58.284Z VERBOSE [nrfdl][trace](13:50:58.283) USBPlatformAPI::enumerate: Doing copyDeviceToUsb of device #4
    2023-07-07T11:50:58.284Z VERBOSE [nrfdl][trace](13:50:58.283) USBPlatformAPI::copyDeviceToUSB: idVendor=0xa5c, idProduct=0x5832
    2023-07-07T11:50:58.390Z VERBOSE [nrfdl][trace](13:50:58.390) USBPlatformAPI::copyDeviceToUSB: Getting string descriptor for manufacturer
    2023-07-07T11:50:58.391Z VERBOSE [nrfdl][trace](13:50:58.391) USBPlatformAPI::getStringDescriptor: descriptor = Broadcom Corp
    2023-07-07T11:50:58.391Z VERBOSE [nrfdl][trace](13:50:58.391) USBPlatformAPI::copyDeviceToUSB: Getting string descriptor for product
    2023-07-07T11:50:58.391Z VERBOSE [nrfdl][trace](13:50:58.391) USBPlatformAPI::getStringDescriptor: descriptor = 5880
    2023-07-07T11:50:58.392Z VERBOSE [nrfdl][trace](13:50:58.391) USBPlatformAPI::copyDeviceToUSB: Getting string descriptor for serialnumber
    2023-07-07T11:50:58.392Z VERBOSE [nrfdl][trace](13:50:58.391) USBPlatformAPI::getStringDescriptor: descriptor = 0123456789ABCD
    2023-07-07T11:50:58.392Z VERBOSE [nrfdl][trace](13:50:58.392) USBPlatformAPI::enumerate: Found new device with identifier 1-2, adding it
    2023-07-07T11:50:58.392Z VERBOSE [nrfdl][trace](13:50:58.392) USBPlatformAPI::enumerate: New device added, in total 5 devices are added
    2023-07-07T11:50:58.392Z VERBOSE [nrfdl][trace](13:50:58.392) USBPlatformAPI::enumerate: Starting iteration 5
    2023-07-07T11:50:58.393Z VERBOSE [nrfdl][trace](13:50:58.392) USBPlatformAPI::enumerate: Doing copyDeviceToUsb of device #5
    2023-07-07T11:50:58.393Z VERBOSE [nrfdl][trace](13:50:58.392) USBPlatformAPI::copyDeviceToUSB: idVendor=0x1d6b, idProduct=0x2
    2023-07-07T11:50:58.393Z VERBOSE [nrfdl][trace](13:50:58.392) Unable to open USB device. Error code: -3 (LIBUSB_ERROR_ACCESS). 
    2023-07-07T11:50:58.393Z VERBOSE [nrfdl][trace](13:50:58.392) USBPlatformAPI::enumerate: Found new device with identifier 1-1, adding it
    2023-07-07T11:50:58.393Z VERBOSE [nrfdl][trace](13:50:58.392) USBPlatformAPI::enumerate: New device added, in total 6 devices are added
    2023-07-07T11:50:58.394Z VERBOSE [nrfdl][trace](13:50:58.392) USBPlatformAPI::enumerate: Found 6 devices
    2023-07-07T11:50:58.394Z DEBUG [nrfdl][debug](13:50:58.392) USBLister: Adding new device with id 1 and serial number: 'NONE'
    2023-07-07T11:50:58.394Z DEBUG [nrfdl][debug](13:50:58.392) USBLister: Adding new device with id 2 and serial number: '0123456789ABCD'
    2023-07-07T11:50:58.394Z DEBUG [nrfdl][debug](13:50:58.392) USBLister: Adding new device with id 3 and serial number: 'NONE'
    2023-07-07T11:50:58.394Z DEBUG [nrfdl][debug](13:50:58.393) USBLister: Adding new device with id 4 and serial number: 'NONE'
    2023-07-07T11:50:58.394Z DEBUG [nrfdl][debug](13:50:58.393) USBLister: Adding new device with id 5 and serial number: 'E2204B17A9D8'
    2023-07-07T11:50:58.395Z VERBOSE [nrfdl][trace](13:50:58.393) USBPlatformAPI::copyDeviceToUSB: idVendor=0x1d6b, idProduct=0x3
    2023-07-07T11:50:58.395Z VERBOSE [nrfdl][trace](13:50:58.393) Unable to open USB device. Error code: -3 (LIBUSB_ERROR_ACCESS). 
    2023-07-07T11:50:58.395Z VERBOSE [nrfdl][trace](13:50:58.393) USBPlatformAPI::copyDeviceToUSB: idVendor=0x1915, idProduct=0xc00a
    2023-07-07T11:50:58.395Z VERBOSE [nrfdl][trace](13:50:58.393) USBPlatformAPI::copyDeviceToUSB: Getting string descriptor for manufacturer
    2023-07-07T11:50:58.395Z VERBOSE [nrfdl][trace](13:50:58.393) USBPlatformAPI::getStringDescriptor: descriptor = Nordic Semiconductor
    2023-07-07T11:50:58.396Z VERBOSE [nrfdl][trace](13:50:58.393) USBPlatformAPI::copyDeviceToUSB: Getting string descriptor for product
    2023-07-07T11:50:58.396Z VERBOSE [nrfdl][trace](13:50:58.394) USBPlatformAPI::getStringDescriptor: descriptor = PPK2
    2023-07-07T11:50:58.396Z VERBOSE [nrfdl][trace](13:50:58.394) USBPlatformAPI::copyDeviceToUSB: Getting string descriptor for serialnumber
    2023-07-07T11:50:58.396Z VERBOSE [nrfdl][trace](13:50:58.394) USBPlatformAPI::getStringDescriptor: descriptor = E2204B17A9D8
    2023-07-07T11:50:58.397Z VERBOSE [nrfdl][trace](13:50:58.395) USBPlatformAPI::copyDeviceToUSB: idVendor=0x1d6b, idProduct=0x3
    2023-07-07T11:50:58.397Z VERBOSE [nrfdl][trace](13:50:58.395) Unable to open USB device. Error code: -3 (LIBUSB_ERROR_ACCESS). 
    2023-07-07T11:50:58.398Z VERBOSE [nrfdl][trace](13:50:58.395) USBPlatformAPI::copyDeviceToUSB: idVendor=0x1915, idProduct=0xc00a
    2023-07-07T11:50:58.398Z VERBOSE [nrfdl][trace](13:50:58.395) USBPlatformAPI::copyDeviceToUSB: Getting string descriptor for manufacturer
    2023-07-07T11:50:58.398Z VERBOSE [nrfdl][trace](13:50:58.396) USBPlatformAPI::getStringDescriptor: descriptor = Nordic Semiconductor
    2023-07-07T11:50:58.398Z VERBOSE [nrfdl][trace](13:50:58.396) USBPlatformAPI::copyDeviceToUSB: Getting string descriptor for product
    2023-07-07T11:50:58.399Z VERBOSE [nrfdl][trace](13:50:58.396) USBPlatformAPI::getStringDescriptor: descriptor = PPK2
    2023-07-07T11:50:58.399Z VERBOSE [nrfdl][trace](13:50:58.396) USBPlatformAPI::copyDeviceToUSB: Getting string descriptor for serialnumber
    2023-07-07T11:50:58.399Z VERBOSE [nrfdl][trace](13:50:58.397) USBPlatformAPI::getStringDescriptor: descriptor = E2204B17A9D8
    2023-07-07T11:50:58.399Z DEBUG [nrfdl][debug](13:50:58.397) USBLister: Adding new device with id 6 and serial number: 'NONE'
    2023-07-07T11:50:58.400Z VERBOSE [nrfdl][trace](13:50:58.398) DeviceLister::enumerate::enumerate_task: After async_lister->enumerate
    2023-07-07T11:50:58.400Z VERBOSE [nrfdl][trace](13:50:58.399) [jlink] JLinkPlugin::enumerate
    2023-07-07T11:50:58.400Z DEBUG [nrfdl][debug](13:50:58.399) [jlink] [->] enumerate
    2023-07-07T11:50:58.400Z DEBUG [nrfdl][debug](13:50:58.399) [jlink] JLinkHW::enumerate all devices
    2023-07-07T11:50:58.413Z DEBUG [nrfdl][debug](13:50:58.412) [jlink] [NRFJPROG][Client][] open
    2023-07-07T11:50:58.421Z DEBUG [nrfdl][debug](13:50:58.412) [jlink] [NRFJPROG][Client][] start
    2023-07-07T11:50:58.434Z DEBUG [nrfdl][debug](13:50:58.433) [jlink] [NRFJPROG][SeggerBackend][] Logger sink registered in Segger backend logger
    2023-07-07T11:50:58.434Z DEBUG [nrfdl][debug](13:50:58.433) [jlink] [NRFJPROG][JLink][] Logger sink registered in JLink logger
    2023-07-07T11:50:58.434Z DEBUG [nrfdl][debug](13:50:58.433) [jlink] [NRFJPROG][nRFXX][] open
    2023-07-07T11:50:58.435Z DEBUG [nrfdl][debug](13:50:58.433) [jlink] [NRFJPROG][nRFXX][] just_check_family
    2023-07-07T11:50:58.435Z DEBUG [nrfdl][debug](13:50:58.433) [jlink] [NRFJPROG][SeggerBackend][] open_dll
    2023-07-07T11:50:58.435Z DEBUG [nrfdl][debug](13:50:58.433) [jlink] [NRFJPROG][SeggerBackend][] No J-Link DLL path was provided. Attempting to auto detect.
    2023-07-07T11:50:58.440Z VERBOSE [nrfdl][trace](13:50:58.440) [jlink] [NRFJPROG][Client][] Command open executed for 11 milliseconds with result 0
    2023-07-07T11:50:58.441Z DEBUG [nrfdl][debug](13:50:58.440) [jlink] [NRFJPROG][Client][] enum_emu_snr
    2023-07-07T11:50:58.444Z DEBUG [nrfdl][debug](13:50:58.443) [jlink] [NRFJPROG][SeggerBackend][] Set batch mode
    2023-07-07T11:50:58.444Z DEBUG [nrfdl][debug](13:50:58.443) [jlink] [NRFJPROG][SeggerBackend][] dll_version
    2023-07-07T11:50:58.444Z VERBOSE [nrfdl][trace](13:50:58.443) [jlink] [NRFJPROG][Worker][] Command open executed for 7 milliseconds with result 0
    2023-07-07T11:50:58.445Z DEBUG [nrfdl][debug](13:50:58.443) [jlink] [NRFJPROG][nRFXX][] enum_emu_snr
    2023-07-07T11:50:58.445Z DEBUG [nrfdl][debug](13:50:58.443) [jlink] [NRFJPROG][SeggerBackend][] is_connected_to_emu
    2023-07-07T11:50:58.445Z DEBUG [nrfdl][debug](13:50:58.443) [jlink] [NRFJPROG][SeggerBackend][] enum_emu_snr
    2023-07-07T11:50:58.445Z DEBUG [nrfdl][debug](13:50:58.443) [jlink] [NRFJPROG][SeggerBackend][] ---just_enum_emu_snr
    2023-07-07T11:50:58.445Z DEBUG [nrfdl][debug](13:50:58.443) [jlink] [NRFJPROG][SeggerBackend][] ---just_get_num_emus
    2023-07-07T11:50:58.822Z VERBOSE [nrfdl][trace](13:50:58.822) [jlink] [NRFJPROG][Client][] Command enum_emu_snr executed for 381 milliseconds with result 0
    2023-07-07T11:50:58.823Z DEBUG [nrfdl][debug](13:50:58.822) [jlink] Found 0 JLink devices connected
    2023-07-07T11:50:58.828Z DEBUG [nrfdl][debug](13:50:58.827) [jlink] [NRFJPROG][SeggerBackend][] is_connected_to_emu
    2023-07-07T11:50:58.828Z VERBOSE [nrfdl][trace](13:50:58.828) [jlink] [NRFJPROG][Worker][] Command enum_emu_snr executed for 381 milliseconds with result 0
    2023-07-07T11:50:58.828Z DEBUG [nrfdl][debug](13:50:58.828) [jlink] [NRFJPROG][nRFXX][] close
    2023-07-07T11:50:58.828Z DEBUG [nrfdl][debug](13:50:58.828) [jlink] [NRFJPROG][SeggerBackend][] is_connected_to_emu
    2023-07-07T11:50:58.828Z DEBUG [nrfdl][debug](13:50:58.828) [jlink] [NRFJPROG][SeggerBackend][] close
    2023-07-07T11:50:58.828Z DEBUG [nrfdl][debug](13:50:58.828) [jlink] [NRFJPROG][SeggerBackend][] disconnect_from_emu
    2023-07-07T11:50:58.828Z DEBUG [nrfdl][debug](13:50:58.828) [jlink] [NRFJPROG][SeggerBackend][] is_connected_to_emu
    2023-07-07T11:50:58.828Z DEBUG [nrfdl][debug](13:50:58.828) [jlink] [NRFJPROG][SeggerBackend][] Segger Backend closed.
    2023-07-07T11:50:58.828Z DEBUG [nrfdl][debug](13:50:58.828) [jlink] [NRFJPROG][nRFXX][] nRF family DLL closed
    2023-07-07T11:50:58.833Z VERBOSE [nrfdl][trace](13:50:58.833) [jlink] [NRFJPROG][Client][] Command close executed for 10 milliseconds with result 0
    2023-07-07T11:50:58.834Z DEBUG [nrfdl][debug](13:50:58.833) [jlink] [NRFJPROG][Client][] terminate
    2023-07-07T11:50:58.834Z VERBOSE [nrfdl][trace](13:50:58.833) [jlink] [NRFJPROG][Client][] Command terminate executed for 0 milliseconds with result 0
    2023-07-07T11:50:58.838Z VERBOSE [nrfdl][trace](13:50:58.838) [jlink] [NRFJPROG][Worker][] Command close executed for 10 milliseconds with result 0
    2023-07-07T11:50:58.838Z VERBOSE [nrfdl][trace](13:50:58.838) [jlink] [NRFJPROG][Worker][] Command terminate executed for 0 milliseconds with result 0
    2023-07-07T11:50:58.838Z VERBOSE [nrfdl][trace](13:50:58.838) [jlink] [NRFJPROG][Worker][] Executed 4 commands for 398 milliseconds
    2023-07-07T11:50:58.849Z DEBUG [nrfdl][debug](13:50:58.849) [jlink] [NRFJPROG][Client][] Worker process exited with code: 0
    2023-07-07T11:50:58.850Z DEBUG [nrfdl][debug](13:50:58.849) [jlink] [NRFJPROG][Client][] Worker process exited with code: 0
    2023-07-07T11:50:58.850Z DEBUG [nrfdl][debug](13:50:58.849) [jlink] [NRFJPROG][Client][] Child process terminated with result 0
    2023-07-07T11:50:58.850Z VERBOSE [nrfdl][trace](13:50:58.849) [jlink] [NRFJPROG][Client][] Executed 4 commands for 402 milliseconds
    2023-07-07T11:50:58.850Z DEBUG [nrfdl][debug](13:50:58.849) [jlink] [NRFJPROG][Client][] terminate
    2023-07-07T11:50:58.860Z DEBUG [nrfdl][debug](13:50:58.859) [jlink] JLinkHW::enumerate waiting for futures
    2023-07-07T11:50:58.860Z DEBUG [nrfdl][debug](13:50:58.859) [jlink] JLinkHW::enumerate done waiting for futures
    2023-07-07T11:50:58.860Z DEBUG [nrfdl][debug](13:50:58.859) [jlink] [<-] enumerate [took 460ms]
    2023-07-07T11:50:58.860Z DEBUG [nrfdl][debug](13:50:58.860) Enumeration for plugin 'jlink' took 461 ms
    2023-07-07T11:50:58.860Z DEBUG [nrfdl][debug](13:50:58.860) [SerialPortListerHW::LINUX] Linux serialport enumerate.
    2023-07-07T11:50:58.862Z DEBUG [nrfdl][debug](13:50:58.862) [SerialPortListerHW::LINUX] try to map FTDI to segger device
    2023-07-07T11:50:58.862Z DEBUG [nrfdl][debug](13:50:58.862) Enumeration for plugin 'serialport' took 1 ms
    2023-07-07T11:50:58.862Z DEBUG [nrfdl][debug](13:50:58.862) Enumeration for plugin 'sdfu' took 0 ms
    2023-07-07T11:50:58.862Z VERBOSE [nrfdl][trace](13:50:58.862) [broken] BrokenPlugin::enumerate
    2023-07-07T11:50:58.862Z DEBUG [nrfdl][debug](13:50:58.862) Enumeration for plugin 'broken' took 0 ms
    2023-07-07T11:50:58.862Z VERBOSE [nrfdl][trace](13:50:58.862) DeviceLister::enumerate: Found device with serial number: '<unknown>'
    2023-07-07T11:50:58.862Z VERBOSE [nrfdl][trace](13:50:58.862) DeviceLister::enumerate: Found device with serial number: 'E2204B17A9D8'
    2023-07-07T11:50:58.863Z VERBOSE [nrfdl][trace](13:50:58.862) DeviceLister::enumerate: device registered to device list
    2023-07-07T11:50:58.863Z VERBOSE [nrfdl][trace](13:50:58.862) DeviceLister::enumerate: Found device with serial number: '<unknown>'
    2023-07-07T11:50:58.863Z VERBOSE [nrfdl][trace](13:50:58.862) DeviceLister::enumerate: Found device with serial number: '<unknown>'
    2023-07-07T11:50:58.863Z VERBOSE [nrfdl][trace](13:50:58.862) DeviceLister::enumerate: Found device with serial number: '0123456789ABCD'
    2023-07-07T11:50:58.863Z VERBOSE [nrfdl][trace](13:50:58.862) DeviceLister::enumerate: Found device with serial number: '<unknown>'
    2023-07-07T11:50:58.863Z VERBOSE [nrfdl][trace](13:50:58.862) DeviceLister::enumerate: Finished in 839 ms
    2023-07-07T11:50:58.863Z VERBOSE [nrfdl][trace](13:50:58.862) DeviceLister::enumerate: Completed waiting for enumerate task
    2023-07-07T11:50:58.863Z VERBOSE [nrfdl][trace](13:50:58.862) DeviceLister::enumerate: done
    2023-07-07T11:50:58.864Z INFO Getting serialport options from persistent store E2204B17A9D8.pc-nrfconnect-ppk
    2023-07-07T11:51:00.278Z INFO Validating firmware for device with s/n E2204B17A9D8
    2023-07-07T11:51:00.292Z DEBUG Device has DFU trigger interface, the device is in Application mode
    2023-07-07T11:51:00.299Z INFO Opening device with s/n E2204B17A9D8
    2023-07-07T11:51:00.302Z ERROR Failed to start PPK
    2023-07-07T11:51:00.302Z DEBUG Cannot read properties of undefined (reading 'comName')
    

Children
Related