greearb
commented
5 years ago Please see if this firmware works...it is very similar to stock QCA 10.4.3.something FW.
Closed ghost closed 4 years ago
greearb
commented
5 years ago Please see if this firmware works...it is very similar to stock QCA 10.4.3.something FW.
ghost
commented
5 years ago Doesn't seem like this one can even load
[ 25.909581] ath10k_pci 0000:01:00.0: qca99x0 hw2.0 target 0x01000000 chip_id 0x003b01ff sub 168c:0002 [ 25.909628] ath10k_pci 0000:01:00.0: kconfig debug 0 debugfs 1 tracing 0 dfs 1 testmode 0 [ 25.920616] ath10k_pci 0000:01:00.0: firmware ver 10.4b-ct-9980-fW-000-307bc99 api 5 features peer-flow-ctrl,wmi-10.x-CT crc32 74eef09e [ 25.984568] ath10k_pci 0000:01:00.0: board_file api 2 bmi_id 1:1 crc32 08fa09f2 [ 28.086593] ath10k_pci 0000:01:00.0: 10.4 wmi init: vdevs: 16 peers: 528 tid: 102 [ 28.086635] ath10k_pci 0000:01:00.0: msdu-desc: 2500 skid: 32 [ 28.163916] ath10k_pci 0000:01:00.0: firmware crashed! (guid n/a) [ 28.163950] ath10k_pci 0000:01:00.0: qca99x0 hw2.0 target 0x01000000 chip_id 0x003b01ff sub 168c:0002 [ 28.169016] ath10k_pci 0000:01:00.0: kconfig debug 0 debugfs 1 tracing 0 dfs 1 testmode 0 [ 28.191557] ath10k_pci 0000:01:00.0: firmware ver 10.4b-ct-9980-fW-000-307bc99 api 5 features peer-flow-ctrl,wmi-10.x-CT crc32 74eef09e [ 28.191832] ath10k_pci 0000:01:00.0: board_file api 2 bmi_id 1:1 crc32 08fa09f2 [ 28.204771] ath10k_pci 0000:01:00.0: htt-ver 0.0 wmi-op 6 htt-op 4 cal pre-cal-file max-sta 512 raw 0 hwcrypto 1 [ 28.214376] ath10k_pci 0000:01:00.0: firmware register dump: [ 28.220260] ath10k_pci 0000:01:00.0: [00]: 0x00000009 0x000015B3 0x00941AC9 0x00955B31 [ 28.226253] ath10k_pci 0000:01:00.0: [04]: 0x00941AC9 0x00060330 0x0000001A 0x004186F8 [ 28.233630] ath10k_pci 0000:01:00.0: [08]: 0x00000003 0x00000898 0x000FFD14 0x004596B0 [ 28.243738] ath10k_pci 0000:01:00.0: [12]: 0x00000009 0x00000000 0x00953718 0x00953723 [ 28.249429] ath10k_pci 0000:01:00.0: [16]: 0x00953438 0x00953718 0x00000000 0x00000000 [ 28.259603] ath10k_pci 0000:01:00.0: [20]: 0x40941AC9 0x0040648C 0x00000001 0x00000000 [ 28.265228] ath10k_pci 0000:01:00.0: [24]: 0x809C30A5 0x004064EC 0x00406EA8 0xC0941AC9 [ 28.275398] ath10k_pci 0000:01:00.0: [28]: 0x809C3233 0x0040651C 0x00000023 0x00000898 [ 28.281027] ath10k_pci 0000:01:00.0: [32]: 0x809C9548 0x0040653C 0x0045A240 0x00000002 [ 28.290985] ath10k_pci 0000:01:00.0: [36]: 0x809C01A2 0x0040655C 0x004065BC 0x00000000 [ 28.296826] ath10k_pci 0000:01:00.0: [40]: 0x809C8A69 0x0040658C 0x004065BC 0x00406EA8 [ 28.306929] ath10k_pci 0000:01:00.0: [44]: 0x80981330 0x004065BC 0x00406EA8 0x00406FF0 [ 28.312623] ath10k_pci 0000:01:00.0: [48]: 0x809C8D9D 0x004065EC 0x00406EA8 0x004118A0 [ 28.322907] ath10k_pci 0000:01:00.0: [52]: 0x8098011C 0x0040661C 0x00406EA8 0x00000008 [ 28.328422] ath10k_pci 0000:01:00.0: [56]: 0x809C8F73 0x0040663C 0x00406EA8 0x00000008 [ 28.338478] ath10k_pci 0000:01:00.0: Copy Engine register dump: [ 28.344226] ath10k_pci 0000:01:00.0: [00]: 0x0004a000 14 14 3 3 [ 28.351802] ath10k_pci 0000:01:00.0: [01]: 0x0004a400 4 4 14 15 [ 28.356636] ath10k_pci 0000:01:00.0: [02]: 0x0004a800 1 1 0 1 [ 28.365087] ath10k_pci 0000:01:00.0: [03]: 0x0004ac00 2 2 3 2 [ 28.369483] ath10k_pci 0000:01:00.0: [04]: 0x0004b000 0 0 40 0 [ 28.378177] ath10k_pci 0000:01:00.0: [05]: 0x0004b400 1 1 0 1 [ 28.382330] ath10k_pci 0000:01:00.0: [06]: 0x0004b800 0 0 0 0 [ 28.390875] ath10k_pci 0000:01:00.0: [07]: 0x0004bc00 1 1 1 1 [ 28.395177] ath10k_pci 0000:01:00.0: [08]: 0x0004c000 0 0 127 0 [ 28.403715] ath10k_pci 0000:01:00.0: [09]: 0x0004c400 1 1 1 1 [ 28.408024] ath10k_pci 0000:01:00.0: [10]: 0x0004c800 0 0 0 0 [ 28.416337] ath10k_pci 0000:01:00.0: [11]: 0x0004cc00 0 0 0 0 [ 28.425783] ath10k_pci 0000:01:00.0: debug log header, dbuf: 0x407ecc dropped: 0 [ 28.429753] ath10k_pci 0000:01:00.0: [0] next: 0x407ee4 buf: 0xeab2c sz: 1500 len: 896 count: 68 free: 0 [ 28.437252] ath10k_pci 0000:01:00.0: ath10k_pci ATH10K_DBG_BUFFER: [ 28.444306] ath10k: [0000]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.452471] ath10k: [0008]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.459239] ath10k: [0016]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.470413] ath10k: [0024]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.477293] ath10k: [0032]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.488230] ath10k: [0040]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.495349] ath10k: [0048]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.506387] ath10k: [0056]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.513405] ath10k: [0064]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.524213] ath10k: [0072]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.531461] ath10k: [0080]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.542690] ath10k: [0088]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.549516] ath10k: [0096]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.559802] ath10k: [0104]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.567572] ath10k: [0112]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.578332] ath10k: [0120]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.585625] ath10k: [0128]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.596447] ath10k: [0136]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.603681] ath10k: [0144]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.614744] ath10k: [0152]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.621737] ath10k: [0160]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.632759] ath10k: [0168]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.639795] ath10k: [0176]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.650210] ath10k: [0184]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.657848] ath10k: [0192]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.668424] ath10k: [0200]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.675904] ath10k: [0208]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.687289] ath10k: [0216]: 00000000 00000000 00000000 00000000 00000000 00000000 00000000 00000000 [ 28.693960] ath10k_pci 0000:01:00.0: ATH10K_END [ 28.708330] ath10k_pci 0000:01:00.0: [1] next: 0x407ecc buf: 0xeb11c sz: 1500 len: 0 count: 0 free: 0 [ 33.113810] ath10k_pci 0000:01:00.0: wmi unified ready event not received [ 33.203639] ath10k_pci 0000:01:00.0: could not init core (-110) [ 33.204082] ath10k_pci 0000:01:00.0: could not probe fw (-110)
greearb
commented
5 years ago Firmware ran OOM. Please try editing your modprobe.conf for ath10k and set vdevs to 4 (default is 16).
[root@lf0313-6477 lanforge]# cat /etc/modprobe.d/ath10k.conf ... options ath10k_core num_vdevs_ct=4
And see if that will load and work...
ghost
commented
5 years ago Yep, this one works fine on 5Ghz
greearb
commented
5 years ago Ok, I have uploaded a series of binaries for each commit. The commit-ZZZ in the name shows the commit number...you started with 006. Please use bisect logic to find the bad commit.
https://www.candelatech.com/downloads/ath10k-10-4b/all_builds/all_builds-9980-htt-dec-21-2018.tar.gz
ghost
commented
5 years ago Right, so I went through these, and anything past 153 kills it - hostapd doesn't even acknowledge any connection attempt, and the PS4 complains on not getting a DHCP lease. Which is the first time htt is mentioned, which as i mentioned might not be the problem I have (but a problem nontheless). Because the one I have - using firmware-5-ct-full-community-12.bin-lede.002 (10.4b-ct-9980-fW-012-81e1edd), again, non-htt is that it is connecting, is getting a DHCP lease, but then quickly seemingly stopping any traffic soon after getting that lease. 153 and earlier work though. Might we try the non-htt versions then?
greearb
commented
5 years ago I am working on building a new series...I'm having to backport/tweak some fixes since 9980 won't compile on a lot of the earlier commits in the tree....hopefully I'll have this done today.
greearb
commented
5 years ago Please try bisecting with this set of binaries: http://www.candelatech.com/downloads/ath10k-10-4b/all_builds/all_builds-9980-wmi-jan-3-2019.tar.gz
ghost
commented
5 years ago Sorry for the lag, but i finally got around to bisecting this. firmware-5-full-community-commit-910-3e379a7d.bin is ok firmware-5-full-community-commit-911-4e96efac.bin onwards is broken
greearb
commented
5 years ago I re-sorted the commits a bit and built new images. Please try these. Probably your problem is in the 900 to 915 range, but please double-check and re-bisect.
ghost
commented
5 years ago firmware-5-full-community-commit-909-77c3d414.bin works firmware-5-full-community-commit-910-2dfbe546.bin onwards is bad
greearb
commented
5 years ago That is...interesting. Commit 2dfbe546 is a rate-ctrl optimization that decreases the amount of probes when lots of peers are present.. I have a hard time seeing how it could really break things. Any chance you can take an over-the-air packet capture with that commit enabled and your PS4Pro attempting to talk to it? Preferably with encryption disabled so it is easier to understand the packet capture, but probably I can make use of and encrypted capture as well.
ghost
commented
5 years ago Sure, just tell me exactly how to do it
greearb
commented
5 years ago You really need a third wifi device that can act as a monitor-mode sniffer. Considering you have a 4x4 AP, then you would want a 4x4 sniffer for best results. Ath10k-ct on 9980 or 9984 NIC would be a good option. I think some broadcom chips in laptops can also sniff but I haven't used them myself.
This seems to be a fairly useful description of how to do it: https://sandilands.info/sgordon/capturing-wifi-in-monitor-mode-with-iw
ghost
commented
5 years ago Hopefully this is what is needed. 2 captures, one with working 909 and bad 910. I turn on the console from the off state, then run a network test (it's supposed to reconnect during it), then try to pull up a webpage in the browser
PS4 MAC : E8:9E:B4:AA:7C:E7 C2600 PHY MAC : EC:08:6B:84:19:AC
greearb
commented
5 years ago I believe the captures were made with the monitor mode sniffer in 20Mhz instead of 80Mhz, so a lot of the frames are missing. And over all, I don't see any obvious differences in the sniff. My co-worker has a PS4, he is giong to bring it in next week and we will see if we can reproduce the problem.
ghost
commented
5 years ago These should be better - i need to link them, since they're too big https://cloud.movishell.pl/s/iixBg58waknZYZP
greearb
commented
5 years ago Please see if this image works for you. It worked on our ps4-Pro system (when compiled for our 9984 chipset AP).
firmware-5-full-htt-mgt-community.bin.gz
ghost
commented
5 years ago Nope, no change in behaviour
greearb
commented
5 years ago Can you show me dmesg after reboot with that firmware so I can make sure you are running the same image that I think you are?
ghost
commented
5 years ago Sure
[ 0.000000] Linux version 4.14.82 (movi@Nucille) (gcc version 7.3.0 (OpenWrt GCC 7.3.0 r8614-78ca6a5578)) #0 SMP Fri Nov 30 08:04:29 2018
[ 0.000000] CPU: ARMv7 Processor [512f04d0] revision 0 (ARMv7), cr=10c5787d
[ 0.000000] CPU: div instructions available: patching division code
[ 0.000000] CPU: PIPT / VIPT nonaliasing data cache, PIPT instruction cache
[ 0.000000] OF: fdt: Machine model: TP-Link Archer C2600
[ 0.000000] Memory policy: Data cache writealloc
[ 0.000000] On node 0 totalpages: 122880
[ 0.000000] free_area_init_node: node 0, pgdat c0b258c0, node_mem_map ddc39000
[ 0.000000] Normal zone: 960 pages used for memmap
[ 0.000000] Normal zone: 0 pages reserved
[ 0.000000] Normal zone: 122880 pages, LIFO batch:31
[ 0.000000] random: get_random_bytes called from start_kernel+0x88/0x408 with crng_init=0
[ 0.000000] percpu: Embedded 15 pages/cpu @ddc01000 s29324 r8192 d23924 u61440
[ 0.000000] pcpu-alloc: s29324 r8192 d23924 u61440 alloc=15*4096
[ 0.000000] pcpu-alloc: [0] 0 [0] 1
[ 0.000000] Built 1 zonelists, mobility grouping on. Total pages: 121920
[ 0.000000] Kernel command line:
[ 0.000000] Bootloader command line (ignored): console=ttyHSL1,115200n8 root=mtd:rootfs rootfstype=squashfs
[ 0.000000] PID hash table entries: 2048 (order: 1, 8192 bytes)
[ 0.000000] Dentry cache hash table entries: 65536 (order: 6, 262144 bytes)
[ 0.000000] Inode-cache hash table entries: 32768 (order: 5, 131072 bytes)
[ 0.000000] Memory: 478412K/491520K available (4765K kernel code, 152K rwdata, 1264K rodata, 1024K init, 228K bss, 13108K reserved, 0K cma-reserved, 0K highmem)
[ 0.000000] Virtual kernel memory layout:
[ 0.000000] vector : 0xffff0000 - 0xffff1000 ( 4 kB)
[ 0.000000] fixmap : 0xffc00000 - 0xfff00000 (3072 kB)
[ 0.000000] vmalloc : 0xde800000 - 0xff800000 ( 528 MB)
[ 0.000000] lowmem : 0xc0000000 - 0xde000000 ( 480 MB)
[ 0.000000] pkmap : 0xbfe00000 - 0xc0000000 ( 2 MB)
[ 0.000000] modules : 0xbf000000 - 0xbfe00000 ( 14 MB)
[ 0.000000] .text : 0xc0208000 - 0xc07a76d8 (5758 kB)
[ 0.000000] .init : 0xc0a00000 - 0xc0b00000 (1024 kB)
[ 0.000000] .data : 0xc0b00000 - 0xc0b261c0 ( 153 kB)
[ 0.000000] .bss : 0xc0b28000 - 0xc0b61098 ( 229 kB)
[ 0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=2, Nodes=1
[ 0.000000] Hierarchical RCU implementation.
[ 0.000000] NR_IRQS: 16, nr_irqs: 16, preallocated irqs: 16
[ 0.000000] clocksource: dg_timer: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 305801671480 ns
[ 0.000007] sched_clock: 32 bits at 6MHz, resolution 160ns, wraps every 343597383600ns
[ 0.000020] Switching to timer-based delay loop, resolution 160ns
[ 0.000231] Calibrating delay loop (skipped), value calculated using timer frequency.. 12.50 BogoMIPS (lpj=62500)
[ 0.000255] pid_max: default: 32768 minimum: 301
[ 0.000381] Mount-cache hash table entries: 1024 (order: 0, 4096 bytes)
[ 0.000397] Mountpoint-cache hash table entries: 1024 (order: 0, 4096 bytes)
[ 0.000959] CPU: Testing write buffer coherency: ok
[ 0.001725] Setting up static identity map for 0x42300000 - 0x42300060
[ 0.001879] Hierarchical SRCU implementation.
[ 0.002616] smp: Bringing up secondary CPUs ...
[ 0.004392] smp: Brought up 1 node, 2 CPUs
[ 0.004408] SMP: Total of 2 processors activated (25.00 BogoMIPS).
[ 0.004417] CPU: All CPU(s) started in SVC mode.
[ 0.015740] VFP support v0.3: implementor 51 architecture 64 part 4d variant 2 rev 0
[ 0.015911] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 19112604462750000 ns
[ 0.015934] futex hash table entries: 512 (order: 3, 32768 bytes)
[ 0.016041] pinctrl core: initialized pinctrl subsystem
[ 0.017045] NET: Registered protocol family 16
[ 0.017292] DMA: preallocated 256 KiB pool for atomic coherent allocations
[ 0.018645] cpuidle: using governor ladder
[ 0.018711] cpuidle: using governor menu
[ 0.039673] msm_bus_fabric_init_driver
[ 0.041051] usbcore: registered new interface driver usbfs
[ 0.041133] usbcore: registered new interface driver hub
[ 0.041231] usbcore: registered new device driver usb
[ 0.041289] pps_core: LinuxPPS API ver. 1 registered
[ 0.041304] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti <giometti@linux.it>
[ 0.041335] PTP clock support registered
[ 0.043168] clocksource: Switched to clocksource dg_timer
[ 0.046386] NET: Registered protocol family 2
[ 0.046919] TCP established hash table entries: 4096 (order: 2, 16384 bytes)
[ 0.046960] TCP bind hash table entries: 4096 (order: 3, 32768 bytes)
[ 0.047012] TCP: Hash tables configured (established 4096 bind 4096)
[ 0.047100] UDP hash table entries: 256 (order: 1, 8192 bytes)
[ 0.047125] UDP-Lite hash table entries: 256 (order: 1, 8192 bytes)
[ 0.047307] NET: Registered protocol family 1
[ 0.047353] PCI: CLS 0 bytes, default 64
[ 0.048471] No memory allocated for crashlog
[ 0.048761] workingset: timestamp_bits=30 max_order=17 bucket_order=0
[ 0.053652] squashfs: version 4.0 (2009/01/31) Phillip Lougher
[ 0.053672] jffs2: version 2.2 (NAND) (SUMMARY) (LZMA) (RTIME) (CMODE_PRIORITY) (c) 2001-2006 Red Hat, Inc.
[ 0.063084] io scheduler noop registered
[ 0.063100] io scheduler deadline registered (default)
[ 0.064652] qcom-pcie 1b500000.pci: 1b500000.pci supply vdda not found, using dummy regulator
[ 0.064758] qcom-pcie 1b500000.pci: 1b500000.pci supply vdda_phy not found, using dummy regulator
[ 0.064856] qcom-pcie 1b500000.pci: 1b500000.pci supply vdda_refclk not found, using dummy regulator
[ 0.065675] OF: PCI: host bridge /soc/pci@1b500000 ranges:
[ 0.065722] OF: PCI: IO 0x0fe00000..0x0fefffff -> 0x0fe00000
[ 0.065748] OF: PCI: MEM 0x08000000..0x0fdfffff -> 0x08000000
[ 0.173431] qcom-pcie 1b500000.pci: link up
[ 0.173600] qcom-pcie 1b500000.pci: PCI host bridge to bus 0000:00
[ 0.173623] pci_bus 0000:00: root bus resource [bus 00-ff]
[ 0.173642] pci_bus 0000:00: root bus resource [io 0x0000-0xfffff] (bus address [0xfe00000-0xfefffff])
[ 0.173656] pci_bus 0000:00: root bus resource [mem 0x08000000-0x0fdfffff]
[ 0.173672] pci_bus 0000:00: scanning bus
[ 0.173719] pci 0000:00:00.0: [17cb:0101] type 01 class 0x060400
[ 0.173815] pci 0000:00:00.0: calling pci_fixup_ide_bases+0x0/0x44
[ 0.173888] pci 0000:00:00.0: supports D1
[ 0.173900] pci 0000:00:00.0: PME# supported from D0 D1 D3hot
[ 0.173916] pci 0000:00:00.0: PME# disabled
[ 0.174173] pci_bus 0000:00: fixups for bus
[ 0.174196] PCI: bus0: Fast back to back transfers disabled
[ 0.174215] pci 0000:00:00.0: scanning [bus 01-ff] behind bridge, pass 0
[ 0.174339] pci_bus 0000:01: scanning bus
[ 0.174514] pci 0000:01:00.0: [168c:0040] type 00 class 0x028000
[ 0.174864] pci 0000:01:00.0: reg 0x10: [mem 0x00000000-0x001fffff 64bit]
[ 0.175333] pci 0000:01:00.0: calling pci_fixup_ide_bases+0x0/0x44
[ 0.175977] pci 0000:01:00.0: PME# supported from D0 D3hot D3cold
[ 0.176018] pci 0000:01:00.0: PME# disabled
[ 0.176355] pci_bus 0000:01: fixups for bus
[ 0.176427] PCI: bus1: Fast back to back transfers disabled
[ 0.176442] pci_bus 0000:01: bus scan returning with max=01
[ 0.176461] pci 0000:00:00.0: scanning [bus 01-ff] behind bridge, pass 1
[ 0.176479] pci_bus 0000:00: bus scan returning with max=ff
[ 0.176528] pci 0000:00:00.0: BAR 8: assigned [mem 0x08000000-0x081fffff]
[ 0.176552] pci 0000:01:00.0: BAR 0: assigned [mem 0x08000000-0x081fffff 64bit]
[ 0.176677] pci 0000:00:00.0: PCI bridge to [bus 01-ff]
[ 0.176701] pci 0000:00:00.0: bridge window [mem 0x08000000-0x081fffff]
[ 0.176746] pci 0000:00:00.0: calling qcom_pcie_fixup_final+0x0/0x94
[ 0.176944] pcieport 0000:00:00.0: assign IRQ: got 66
[ 0.177266] pcieport 0000:00:00.0: AER enabled with IRQ 34
[ 0.177387] pci 0000:01:00.0: calling qcom_pcie_fixup_final+0x0/0x94
[ 0.177831] qcom-pcie 1b700000.pci: 1b700000.pci supply vdda not found, using dummy regulator
[ 0.177928] qcom-pcie 1b700000.pci: 1b700000.pci supply vdda_phy not found, using dummy regulator
[ 0.178032] qcom-pcie 1b700000.pci: 1b700000.pci supply vdda_refclk not found, using dummy regulator
[ 0.178810] OF: PCI: host bridge /soc/pci@1b700000 ranges:
[ 0.178847] OF: PCI: IO 0x31e00000..0x31efffff -> 0x31e00000
[ 0.178869] OF: PCI: MEM 0x2e000000..0x31dfffff -> 0x2e000000
[ 0.288797] qcom-pcie 1b700000.pci: link up
[ 0.288943] qcom-pcie 1b700000.pci: PCI host bridge to bus 0001:00
[ 0.288961] pci_bus 0001:00: root bus resource [bus 00-ff]
[ 0.288977] pci_bus 0001:00: root bus resource [mem 0x2e000000-0x31dfffff]
[ 0.288991] pci_bus 0001:00: scanning bus
[ 0.289034] pci 0001:00:00.0: [17cb:0101] type 01 class 0x060400
[ 0.289114] pci 0001:00:00.0: calling pci_fixup_ide_bases+0x0/0x44
[ 0.289177] pci 0001:00:00.0: supports D1
[ 0.289187] pci 0001:00:00.0: PME# supported from D0 D1 D3hot
[ 0.289201] pci 0001:00:00.0: PME# disabled
[ 0.289438] pci_bus 0001:00: fixups for bus
[ 0.289459] PCI: bus0: Fast back to back transfers disabled
[ 0.289475] pci 0001:00:00.0: scanning [bus 01-ff] behind bridge, pass 0
[ 0.289600] pci_bus 0001:01: scanning bus
[ 0.289791] pci 0001:01:00.0: [168c:0040] type 00 class 0x028000
[ 0.290162] pci 0001:01:00.0: reg 0x10: [mem 0x00000000-0x001fffff 64bit]
[ 0.290666] pci 0001:01:00.0: calling pci_fixup_ide_bases+0x0/0x44
[ 0.291359] pci 0001:01:00.0: PME# supported from D0 D3hot D3cold
[ 0.291402] pci 0001:01:00.0: PME# disabled
[ 0.291743] pci_bus 0001:01: fixups for bus
[ 0.291819] PCI: bus1: Fast back to back transfers disabled
[ 0.291833] pci_bus 0001:01: bus scan returning with max=01
[ 0.291848] pci 0001:00:00.0: scanning [bus 01-ff] behind bridge, pass 1
[ 0.291866] pci_bus 0001:00: bus scan returning with max=ff
[ 0.291904] pci 0001:00:00.0: BAR 8: assigned [mem 0x2e000000-0x2e1fffff]
[ 0.291926] pci 0001:01:00.0: BAR 0: assigned [mem 0x2e000000-0x2e1fffff 64bit]
[ 0.292056] pci 0001:00:00.0: PCI bridge to [bus 01-ff]
[ 0.292076] pci 0001:00:00.0: bridge window [mem 0x2e000000-0x2e1fffff]
[ 0.292112] pci 0001:00:00.0: calling qcom_pcie_fixup_final+0x0/0x94
[ 0.292292] pcieport 0001:00:00.0: assign IRQ: got 99
[ 0.292589] pcieport 0001:00:00.0: AER enabled with IRQ 67
[ 0.292704] pci 0001:01:00.0: calling qcom_pcie_fixup_final+0x0/0x94
[ 0.294981] L2 @ QSB rate. Forcing new rate.
[ 0.295183] L2 @ 384000 KHz
[ 0.295351] CPU0 @ 800000 KHz
[ 0.295364] CPU1 @ QSB rate. Forcing new rate.
[ 0.295480] CPU1 @ 384000 KHz
[ 0.299368] gsbi 16300000.gsbi: GSBI port protocol: 6 crci: 0
[ 0.300758] gsbi 1a200000.gsbi: GSBI port protocol: 3 crci: 0
[ 0.302220] Serial: 8250/16550 driver, 2 ports, IRQ sharing disabled
[ 0.303015] msm_serial 16340000.serial: msm_serial: detected port #0
[ 0.303120] msm_serial 16340000.serial: uartclk = 7372800
[ 0.303199] 16340000.serial: ttyMSM0 at MMIO 0x16340000 (irq = 100, base_baud = 460800) is a MSM
[ 0.303238] msm_serial: console setup on port #0
[ 1.032710] console [ttyMSM0] enabled
[ 1.037586] msm_serial: driver initialized
[ 1.046200] loop: module loaded
[ 1.047685] spi_qup 1a280000.spi: IN:block:16, fifo:64, OUT:block:16, fifo:64
[ 1.049572] m25p80 spi0.0: s25fl256s1 (32768 Kbytes)
[ 1.055798] 25 fixed-partitions partitions found on MTD device spi0.0
[ 1.060477] Creating 25 MTD partitions on "spi0.0":
[ 1.066897] 0x000000000000-0x000000020000 : "SBL1"
[ 1.072361] 0x000000020000-0x000000040000 : "MIBIB"
[ 1.077202] 0x000000040000-0x000000060000 : "SBL2"
[ 1.081864] 0x000000060000-0x000000090000 : "SBL3"
[ 1.086797] 0x000000090000-0x0000000a0000 : "DDRCONFIG"
[ 1.091516] 0x0000000a0000-0x0000000b0000 : "SSD"
[ 1.096746] 0x0000000b0000-0x0000000e0000 : "TZ"
[ 1.101507] 0x0000000e0000-0x000000100000 : "RPM"
[ 1.106272] 0x000000100000-0x000000170000 : "fs-uboot"
[ 1.110772] 0x000000170000-0x0000001b0000 : "uboot-env"
[ 1.115916] 0x0000001b0000-0x0000001f0000 : "radio"
[ 1.120926] 0x0000001f0000-0x0000005f0000 : "os-image"
[ 1.125887] 0x0000005f0000-0x000001ef0000 : "rootfs"
[ 1.131002] mtd: device 12 (rootfs) set to be root filesystem
[ 1.136244] 1 squashfs-split partitions found on MTD device rootfs
[ 1.141062] 0x000000ae0000-0x000001ef0000 : "rootfs_data"
[ 1.148501] 0x000001ef0000-0x000001ef0200 : "default-mac"
[ 1.153834] 0x000001ef0200-0x000001ef0400 : "pin"
[ 1.159068] 0x000001ef0400-0x000001f00000 : "product-info"
[ 1.163870] 0x000001f00000-0x000001f10000 : "partition-table"
[ 1.169117] 0x000001f10000-0x000001f20000 : "soft-version"
[ 1.175079] 0x000001f20000-0x000001f30000 : "support-list"
[ 1.180340] 0x000001f30000-0x000001f40000 : "profile"
[ 1.185949] 0x000001f40000-0x000001f50000 : "default-config"
[ 1.190908] 0x000001f50000-0x000001f90000 : "user-config"
[ 1.196789] 0x000001f90000-0x000001fd0000 : "qos-db"
[ 1.201984] 0x000001fd0000-0x000001fe0000 : "usb-config"
[ 1.207121] 0x000001fe0000-0x000002000000 : "log"
[ 1.213800] libphy: GPIO Bitbanged MDIO: probed
[ 1.240648] switch0: Atheros AR8337 rev. 2 switch registered on gpio-0
[ 2.115685] libphy: Fixed MDIO Bus: probed
[ 2.118172] ipq806x-gmac-dwmac 37200000.ethernet: PTP uses main clock
[ 2.119140] stmmac - user ID: 0x10, Synopsys ID: 0x37
[ 2.125295] ipq806x-gmac-dwmac 37200000.ethernet: Ring mode enabled
[ 2.130237] ipq806x-gmac-dwmac 37200000.ethernet: DMA HW capability register supported
[ 2.136404] ipq806x-gmac-dwmac 37200000.ethernet: Enhanced/Alternate descriptors
[ 2.144367] ipq806x-gmac-dwmac 37200000.ethernet: Enabled extended descriptors
[ 2.151850] ipq806x-gmac-dwmac 37200000.ethernet: RX Checksum Offload Engine supported
[ 2.158960] ipq806x-gmac-dwmac 37200000.ethernet: COE Type 2
[ 2.166860] ipq806x-gmac-dwmac 37200000.ethernet: TX Checksum insertion supported
[ 2.172597] ipq806x-gmac-dwmac 37200000.ethernet: Wake-Up On Lan supported
[ 2.180049] ipq806x-gmac-dwmac 37200000.ethernet: Enable RX Mitigation via HW Watchdog Timer
[ 2.189287] ipq806x-gmac-dwmac 37400000.ethernet: PTP uses main clock
[ 2.195694] stmmac - user ID: 0x10, Synopsys ID: 0x37
[ 2.201677] ipq806x-gmac-dwmac 37400000.ethernet: Ring mode enabled
[ 2.206789] ipq806x-gmac-dwmac 37400000.ethernet: DMA HW capability register supported
[ 2.212786] ipq806x-gmac-dwmac 37400000.ethernet: Enhanced/Alternate descriptors
[ 2.220843] ipq806x-gmac-dwmac 37400000.ethernet: Enabled extended descriptors
[ 2.228403] ipq806x-gmac-dwmac 37400000.ethernet: RX Checksum Offload Engine supported
[ 2.235433] ipq806x-gmac-dwmac 37400000.ethernet: COE Type 2
[ 2.243252] ipq806x-gmac-dwmac 37400000.ethernet: TX Checksum insertion supported
[ 2.249146] ipq806x-gmac-dwmac 37400000.ethernet: Wake-Up On Lan supported
[ 2.256520] ipq806x-gmac-dwmac 37400000.ethernet: Enable RX Mitigation via HW Watchdog Timer
[ 2.264260] i2c /dev entries driver
[ 2.273058] Calibration not found.
[ 2.275111] qcom-tsens 900000.thermal-sensor: tsens calibration failed
[ 2.280162] Speed bin: 0
[ 2.285117] PVS bin: 1
[ 2.289519] cpuidle: enable-method property 'qcom,kpss-acc-v1' found operations
[ 2.289965] cpuidle: enable-method property 'qcom,kpss-acc-v1' found operations
[ 2.297899] sdhci: Secure Digital Host Controller Interface driver
[ 2.304435] sdhci: Copyright(c) Pierre Ossman
[ 2.310608] sdhci-pltfm: SDHCI platform and OF driver helper
[ 2.317508] NET: Registered protocol family 10
[ 2.322728] Segment Routing with IPv6
[ 2.325264] NET: Registered protocol family 17
[ 2.329467] 8021q: 802.1Q VLAN Support v1.8
[ 2.333139] Registering SWP/SWPB emulation handler
[ 2.354661] qcom_rpm 108000.rpm: RPM firmware 3.0.16777342
[ 2.369840] s1a: supplied by regulator-dummy
[ 2.369960] s1a: Bringing 0uV into 1050000-1050000uV
[ 2.373724] s1b: supplied by regulator-dummy
[ 2.378205] s1b: Bringing 0uV into 1050000-1050000uV
[ 2.382767] s2a: supplied by regulator-dummy
[ 2.387545] s2a: Bringing 0uV into 800000-800000uV
[ 2.391958] s2b: supplied by regulator-dummy
[ 2.396361] s2b: Bringing 0uV into 800000-800000uV
[ 2.406729] hctosys: unable to open rtc device (rtc0)
[ 2.415912] random: fast init done
[ 2.416528] VFS: Mounted root (squashfs filesystem) readonly on device 31:12.
[ 2.419011] Freeing unused kernel memory: 1024K
[ 3.170333] random: crng init done
[ 3.292058] init: Console is alive
[ 3.292268] init: - watchdog -
[ 5.412798] kmodloader: loading kernel modules from /etc/modules-boot.d/*
[ 5.464667] ehci_hcd: USB 2.0 'Enhanced' Host Controller (EHCI) Driver
[ 5.466907] SCSI subsystem initialized
[ 5.471606] ehci-platform: EHCI generic platform driver
[ 5.475835] ohci_hcd: USB 1.1 'Open' Host Controller (OHCI) Driver
[ 5.479362] ohci-platform: OHCI generic platform driver
[ 5.618388] xhci-hcd xhci-hcd.0.auto: xHCI Host Controller
[ 5.618488] xhci-hcd xhci-hcd.0.auto: new USB bus registered, assigned bus number 1
[ 5.623148] xhci-hcd xhci-hcd.0.auto: hcc params 0x0228f065 hci version 0x100 quirks 0x02010010
[ 5.630527] xhci-hcd xhci-hcd.0.auto: irq 106, io mem 0x11000000
[ 5.639792] hub 1-0:1.0: USB hub found
[ 5.645440] hub 1-0:1.0: 1 port detected
[ 5.649024] xhci-hcd xhci-hcd.0.auto: xHCI Host Controller
[ 5.652896] xhci-hcd xhci-hcd.0.auto: new USB bus registered, assigned bus number 2
[ 5.658272] xhci-hcd xhci-hcd.0.auto: Host supports USB 3.0 SuperSpeed
[ 5.665929] usb usb2: We don't know the algorithms for LPM for this host, disabling LPM.
[ 5.672707] hub 2-0:1.0: USB hub found
[ 5.680748] hub 2-0:1.0: 1 port detected
[ 5.684560] xhci-hcd xhci-hcd.1.auto: xHCI Host Controller
[ 5.688321] xhci-hcd xhci-hcd.1.auto: new USB bus registered, assigned bus number 3
[ 5.693844] xhci-hcd xhci-hcd.1.auto: hcc params 0x0228f065 hci version 0x100 quirks 0x02010010
[ 5.701185] xhci-hcd xhci-hcd.1.auto: irq 107, io mem 0x10000000
[ 5.710315] hub 3-0:1.0: USB hub found
[ 5.716187] hub 3-0:1.0: 1 port detected
[ 5.719848] xhci-hcd xhci-hcd.1.auto: xHCI Host Controller
[ 5.723809] xhci-hcd xhci-hcd.1.auto: new USB bus registered, assigned bus number 4
[ 5.729026] xhci-hcd xhci-hcd.1.auto: Host supports USB 3.0 SuperSpeed
[ 5.736737] usb usb4: We don't know the algorithms for LPM for this host, disabling LPM.
[ 5.743615] hub 4-0:1.0: USB hub found
[ 5.751525] hub 4-0:1.0: 1 port detected
[ 5.757876] usbcore: registered new interface driver usb-storage
[ 5.759680] usbcore: registered new interface driver uas
[ 5.765272] kmodloader: done loading kernel modules from /etc/modules-boot.d/*
[ 5.781077] init: - preinit -
[ 6.293801] usb 1-1: new high-speed USB device number 2 using xhci-hcd
[ 8.512609] Generic PHY fixed-0:01: attached PHY driver [Generic PHY] (mii_bus:phy_addr=fixed-0:01, irq=POLL)
[ 8.514165] dwmac1000: Master AXI performs any burst length
[ 8.521523] ipq806x-gmac-dwmac 37400000.ethernet eth1: IEEE 1588-2008 Advanced Timestamp supported
[ 8.527186] ipq806x-gmac-dwmac 37400000.ethernet eth1: registered PTP clock
[ 8.536912] IPv6: ADDRCONF(NETDEV_UP): eth1: link is not ready
[ 9.595262] ipq806x-gmac-dwmac 37400000.ethernet eth1: Link is Up - 1Gbps/Full - flow control off
[ 9.595356] IPv6: ADDRCONF(NETDEV_CHANGE): eth1: link becomes ready
[ 14.778713] mount_root: loading kmods from internal overlay
[ 14.812212] kmodloader: loading kernel modules from //etc/modules-boot.d/*
[ 14.814705] kmodloader: done loading kernel modules from //etc/modules-boot.d/*
[ 17.055481] jffs2: notice: (148) jffs2_build_xattr_subsystem: complete building xattr subsystem, 8 of xdatum (1 unchecked, 5 orphan) and 53 of xref (14 dead, 0 orphan) found.
[ 17.056879] block: attempting to load /tmp/jffs_cfg/upper/etc/config/fstab
[ 17.083893] block: extroot: not configured
[ 17.448001] jffs2: notice: (146) jffs2_build_xattr_subsystem: complete building xattr subsystem, 8 of xdatum (1 unchecked, 5 orphan) and 53 of xref (14 dead, 0 orphan) found.
[ 17.453123] mount_root: loading kmods from internal overlay
[ 17.488266] kmodloader: loading kernel modules from /tmp/overlay/upper/etc/modules-boot.d/*
[ 17.494192] kmodloader: done loading kernel modules from /tmp/overlay/upper/etc/modules-boot.d/*
[ 19.546467] block: attempting to load /tmp/jffs_cfg/upper/etc/config/fstab
[ 19.657853] block: extroot: not configured
[ 19.723648] mount_root: switching to jffs2 overlay
[ 20.015825] overlayfs: upper fs does not support tmpfile.
[ 20.030043] urandom-seed: Seeding with /etc/urandom.seed
[ 20.169461] procd: - early -
[ 20.169541] procd: - watchdog -
[ 20.870498] procd: - watchdog -
[ 20.870701] procd: - ubus -
[ 20.926851] procd: - init -
[ 21.380703] kmodloader: loading kernel modules from /etc/modules.d/*
[ 21.384982] tun: Universal TUN/TAP device driver, 1.6
[ 21.387770] sit: IPv6, IPv4 and MPLS over IPv4 tunneling driver
[ 21.395185] ip6_tables: (C) 2000-2006 Netfilter Core Team
[ 21.403905] u32 classifier
[ 21.403921] input device check on
[ 21.405494] Actions configured
[ 21.410037] Mirror/redirect action on
[ 21.415358] nf_conntrack version 0.5.0 (8192 buckets, 32768 max)
[ 21.419914] Loading modules backported from Linux version v4.19-rc5-0-g6bf4ca7fbc85
[ 21.422340] Backport generated by backports.git v4.19-rc5-1-0-g05571dcd
[ 21.433441] ip_tables: (C) 2000-2006 Netfilter Core Team
[ 21.454966] Netfilter messages via NETLINK v0.30.
[ 21.457490] usbcore: registered new interface driver usbserial
[ 21.458688] usbcore: registered new interface driver usbserial_generic
[ 21.464527] usbserial: USB Serial support registered for generic
[ 21.472971] wireguard: WireGuard 0.0.20181119 loaded. See www.wireguard.com for information.
[ 21.477152] wireguard: Copyright (C) 2015-2018 Jason A. Donenfeld <Jason@zx2c4.com>. All Rights Reserved.
[ 21.497432] xt_time: kernel timezone is -0000
[ 21.519450] usb 1-1: dvb_usb_v2: found a 'Dexatek DK DVB-T Dongle' in warm state
[ 21.550383] usb 1-1: dvb_usb_v2: will pass the complete MPEG2 transport stream to the software demuxer
[ 21.550451] dvbdev: DVB: registering new adapter (Dexatek DK DVB-T Dongle)
[ 21.575469] i2c i2c-0: Added multiplexed i2c bus 1
[ 21.575497] rtl2832 0-0010: Realtek RTL2832 successfully attached
[ 21.579244] usb 1-1: DVB: registering adapter 0 frontend 0 (Realtek RTL2832 (DVB-T))...
[ 21.585630] fc0013: Fitipower FC0013 successfully attached.
[ 21.620961] usb 1-1: dvb_usb_v2: 'Dexatek DK DVB-T Dongle' successfully initialized and connected
[ 21.621549] usbcore: registered new interface driver dvb_usb_rtl28xxu
[ 21.693903] ctnetlink v0.93: registering with nfnetlink.
[ 21.698453] PPP generic driver version 2.4.2
[ 21.699493] NET: Registered protocol family 24
[ 21.724326] ath10k_pci 0000:01:00.0: assign IRQ: got 66
[ 21.724347] ath10k 4.16 driver, optimized for CT firmware, probing pci device: 0x40.
[ 21.725998] ath10k_pci 0000:01:00.0: enabling device (0140 -> 0142)
[ 21.731622] ath10k_pci 0000:01:00.0: enabling bus mastering
[ 21.733887] ath10k_pci 0000:01:00.0: pci irq msi oper_irq_mode 2 irq_mode 0 reset_mode 0
[ 21.946575] ath10k_pci 0000:01:00.0: fwcfg key: vdevs val: 4
[ 21.960036] ath10k_pci 0000:01:00.0: Direct firmware load for ath10k/QCA99X0/hw2.0/ct-firmware-5.bin failed with error -2
[ 21.960074] ath10k_pci 0000:01:00.0: Falling back to user helper
[ 22.609789] firmware ath10k!QCA99X0!hw2.0!ct-firmware-5.bin: firmware_loading_store: map pages failed
[ 22.610088] ath10k_pci 0000:01:00.0: Direct firmware load for ath10k/QCA99X0/hw2.0/ct-firmware-2.bin failed with error -2
[ 22.618131] ath10k_pci 0000:01:00.0: Falling back to user helper
[ 22.700347] firmware ath10k!QCA99X0!hw2.0!ct-firmware-2.bin: firmware_loading_store: map pages failed
[ 22.700670] ath10k_pci 0000:01:00.0: Direct firmware load for ath10k/QCA99X0/hw2.0/firmware-6.bin failed with error -2
[ 22.708699] ath10k_pci 0000:01:00.0: Falling back to user helper
[ 22.748993] firmware ath10k!QCA99X0!hw2.0!firmware-6.bin: firmware_loading_store: map pages failed
[ 24.917774] ath10k_pci 0000:01:00.0: qca99x0 hw2.0 target 0x01000000 chip_id 0x003b01ff sub 168c:0002
[ 24.917819] ath10k_pci 0000:01:00.0: kconfig debug 0 debugfs 1 tracing 0 dfs 1 testmode 0
[ 24.928701] ath10k_pci 0000:01:00.0: firmware ver 10.4b-ct-9980-fH-012-c2d65911 api 5 features mfp,peer-flow-ctrl,txstatus-noack,wmi-10.x-CT,ratemask-CT,regdump-CT,txrate-CT,flush-all-CT,pingpong-CT,ch-regs-CT,nop-CT,htt-mgt-CT,set-special-CT,tx-rc-CT,cust-stats-CT crc32 732c81dd
[ 24.995912] ath10k_pci 0000:01:00.0: board_file api 2 bmi_id 1:1 crc32 08fa09f2
[ 27.663157] ath10k_pci 0000:01:00.0: 10.4 wmi init: vdevs: 4 peers: 48 tid: 96
[ 27.663194] ath10k_pci 0000:01:00.0: msdu-desc: 2500 skid: 32
[ 27.742860] ath10k_pci 0000:01:00.0: wmi print 'P 48/48 V 4 K 144 PH 152 T 162 msdu-desc: 2500 sw-crypt: 0 ct-sta: 0'
[ 27.743151] ath10k_pci 0000:01:00.0: wmi print 'free: 51680 iram: 37124 sram: 18804'
[ 27.995054] ath10k_pci 0000:01:00.0: htt-ver 2.2 wmi-op 6 htt-op 4 cal pre-cal-file max-sta 32 raw 0 hwcrypto 1
[ 28.102921] ath: EEPROM regdomain: 0x0
[ 28.102936] ath: EEPROM indicates default country code should be used
[ 28.102946] ath: doing EEPROM country->regdmn map search
[ 28.102963] ath: country maps to regdmn code: 0x3a
[ 28.102976] ath: Country alpha2 being used: US
[ 28.102985] ath: Regpair used: 0x3a
[ 28.120949] ath10k_pci 0001:01:00.0: assign IRQ: got 99
[ 28.120981] ath10k 4.16 driver, optimized for CT firmware, probing pci device: 0x40.
[ 28.150413] ath10k_pci 0001:01:00.0: enabling device (0140 -> 0142)
[ 28.150540] ath10k_pci 0001:01:00.0: enabling bus mastering
[ 28.151164] ath10k_pci 0001:01:00.0: pci irq msi oper_irq_mode 2 irq_mode 0 reset_mode 0
[ 28.358790] ath10k_pci 0001:01:00.0: fwcfg key: vdevs val: 4
[ 28.417425] ath10k_pci 0001:01:00.0: Direct firmware load for ath10k/QCA99X0/hw2.0/ct-firmware-5.bin failed with error -2
[ 28.417497] ath10k_pci 0001:01:00.0: Falling back to user helper
[ 28.984041] firmware ath10k!QCA99X0!hw2.0!ct-firmware-5.bin: firmware_loading_store: map pages failed
[ 28.984271] ath10k_pci 0001:01:00.0: Direct firmware load for ath10k/QCA99X0/hw2.0/ct-firmware-2.bin failed with error -2
[ 28.992275] ath10k_pci 0001:01:00.0: Falling back to user helper
[ 29.049128] firmware ath10k!QCA99X0!hw2.0!ct-firmware-2.bin: firmware_loading_store: map pages failed
[ 29.049358] ath10k_pci 0001:01:00.0: Direct firmware load for ath10k/QCA99X0/hw2.0/firmware-6.bin failed with error -2
[ 29.057435] ath10k_pci 0001:01:00.0: Falling back to user helper
[ 29.113996] firmware ath10k!QCA99X0!hw2.0!firmware-6.bin: firmware_loading_store: map pages failed
[ 29.114188] ath10k_pci 0001:01:00.0: qca99x0 hw2.0 target 0x01000000 chip_id 0x003b01ff sub 168c:0002
[ 29.121885] ath10k_pci 0001:01:00.0: kconfig debug 0 debugfs 1 tracing 0 dfs 1 testmode 0
[ 29.133567] ath10k_pci 0001:01:00.0: firmware ver 10.4b-ct-9980-fH-012-c2d65911 api 5 features mfp,peer-flow-ctrl,txstatus-noack,wmi-10.x-CT,ratemask-CT,regdump-CT,txrate-CT,flush-all-CT,pingpong-CT,ch-regs-CT,nop-CT,htt-mgt-CT,set-special-CT,tx-rc-CT,cust-stats-CT crc32 732c81dd
[ 29.214800] ath10k_pci 0001:01:00.0: board_file api 2 bmi_id 1:2 crc32 08fa09f2
[ 30.645480] ath10k_pci 0001:01:00.0: 10.4 wmi init: vdevs: 4 peers: 48 tid: 96
[ 30.645535] ath10k_pci 0001:01:00.0: msdu-desc: 2500 skid: 32
[ 30.723440] ath10k_pci 0001:01:00.0: wmi print 'P 48/48 V 4 K 144 PH 152 T 162 msdu-desc: 2500 sw-crypt: 0 ct-sta: 0'
[ 30.724155] ath10k_pci 0001:01:00.0: wmi print 'free: 51680 iram: 37124 sram: 18804'
[ 31.011965] ath10k_pci 0001:01:00.0: htt-ver 2.2 wmi-op 6 htt-op 4 cal pre-cal-file max-sta 32 raw 0 hwcrypto 1
[ 31.112906] ath: EEPROM regdomain: 0x0
[ 31.112920] ath: EEPROM indicates default country code should be used
[ 31.112929] ath: doing EEPROM country->regdmn map search
[ 31.112946] ath: country maps to regdmn code: 0x3a
[ 31.112960] ath: Country alpha2 being used: US
[ 31.112969] ath: Regpair used: 0x3a
[ 31.122718] usbcore: registered new interface driver option
[ 31.122892] usbserial: USB Serial support registered for GSM modem (1-port)
[ 31.133823] kmodloader: done loading kernel modules from /etc/modules.d/*
[ 34.424477] Generic PHY fixed-0:01: attached PHY driver [Generic PHY] (mii_bus:phy_addr=fixed-0:01, irq=POLL)
[ 34.425460] dwmac1000: Master AXI performs any burst length
[ 34.433379] ipq806x-gmac-dwmac 37400000.ethernet eth1: IEEE 1588-2008 Advanced Timestamp supported
[ 34.439033] ipq806x-gmac-dwmac 37400000.ethernet eth1: registered PTP clock
[ 34.448012] IPv6: ADDRCONF(NETDEV_UP): eth1: link is not ready
[ 34.465971] br-lan: port 1(eth1.1) entered blocking state
[ 34.466006] br-lan: port 1(eth1.1) entered disabled state
[ 34.470580] device eth1.1 entered promiscuous mode
[ 34.475821] device eth1 entered promiscuous mode
[ 34.485670] IPv6: ADDRCONF(NETDEV_UP): br-lan: link is not ready
[ 35.525823] ipq806x-gmac-dwmac 37400000.ethernet eth1: Link is Up - 1Gbps/Full - flow control off
[ 35.526290] IPv6: ADDRCONF(NETDEV_CHANGE): eth1: link becomes ready
[ 35.543784] br-lan: port 1(eth1.1) entered blocking state
[ 35.543824] br-lan: port 1(eth1.1) entered forwarding state
[ 35.549092] IPv6: ADDRCONF(NETDEV_CHANGE): br-lan: link becomes ready
[ 35.559616] ath: EEPROM regdomain: 0x8268
[ 35.560144] ath: EEPROM indicates we should expect a country code
[ 35.564252] ath: doing EEPROM country->regdmn map search
[ 35.570262] ath: country maps to regdmn code: 0x37
[ 35.575719] ath: Country alpha2 being used: PL
[ 35.580215] ath: Regpair used: 0x37
[ 35.584925] ath: regdomain 0x8268 dynamically updated by user
[ 35.588056] ath: EEPROM regdomain: 0x8268
[ 35.593989] ath: EEPROM indicates we should expect a country code
[ 35.597984] ath: doing EEPROM country->regdmn map search
[ 35.604049] ath: country maps to regdmn code: 0x37
[ 35.609356] ath: Country alpha2 being used: PL
[ 35.614045] ath: Regpair used: 0x37
[ 35.618384] ath: regdomain 0x8268 dynamically updated by user
[ 40.076000] ath10k_pci 0001:01:00.0: 10.4 wmi init: vdevs: 4 peers: 48 tid: 96
[ 40.076054] ath10k_pci 0001:01:00.0: msdu-desc: 2500 skid: 32
[ 40.154660] ath10k_pci 0001:01:00.0: wmi print 'P 48/48 V 4 K 144 PH 152 T 162 msdu-desc: 2500 sw-crypt: 0 ct-sta: 0'
[ 40.154857] ath10k_pci 0001:01:00.0: wmi print 'free: 51680 iram: 37124 sram: 18804'
[ 40.534678] ath10k_pci 0001:01:00.0: Firmware lacks feature flag indicating a retry limit of > 2 is OK, requested limit: 4
[ 40.534965] IPv6: ADDRCONF(NETDEV_UP): wlan1: link is not ready
[ 41.074595] ath10k_pci 0001:01:00.0: NOTE: Firmware DBGLOG output disabled in debug_mask: 0x10000000
[ 41.809005] ath10k_pci 0000:01:00.0: 10.4 wmi init: vdevs: 4 peers: 48 tid: 96
[ 41.809040] ath10k_pci 0000:01:00.0: msdu-desc: 2500 skid: 32
[ 41.884789] ath10k_pci 0000:01:00.0: wmi print 'P 48/48 V 4 K 144 PH 152 T 162 msdu-desc: 2500 sw-crypt: 0 ct-sta: 0'
[ 41.885465] ath10k_pci 0000:01:00.0: wmi print 'free: 51680 iram: 37124 sram: 18804'
[ 42.219690] ath10k_pci 0000:01:00.0: Firmware lacks feature flag indicating a retry limit of > 2 is OK, requested limit: 4
[ 42.219911] IPv6: ADDRCONF(NETDEV_UP): wlan0: link is not ready
[ 42.230700] br-lan: port 2(wlan1) entered blocking state
[ 42.235626] br-lan: port 2(wlan1) entered disabled state
[ 42.241549] device wlan1 entered promiscuous mode
[ 42.246928] br-lan: port 3(wlan0) entered blocking state
[ 42.250890] br-lan: port 3(wlan0) entered disabled state
[ 42.256529] device wlan0 entered promiscuous mode
[ 42.738964] IPv6: ADDRCONF(NETDEV_CHANGE): wlan1: link becomes ready
[ 42.739200] br-lan: port 2(wlan1) entered blocking state
[ 42.744574] br-lan: port 2(wlan1) entered forwarding state
[ 43.179687] IPv6: ADDRCONF(NETDEV_CHANGE): wlan0: link becomes ready
[ 43.179795] br-lan: port 3(wlan0) entered blocking state
[ 43.185184] br-lan: port 3(wlan0) entered forwarding state
[ 46.324216] usb 1-1: DVB: adapter 0 frontend 0 frequency 0 out of range (174000000..862000000)That commit built for 9984 works for us. We will do some more testing with the PS4Pro and see if we notice more problems. We don't have a 9980 NIC that we can easily use for this test.
mocmocamoc
commented
4 years ago This issue is still present with a master branch build of OpenWrt and QCA9984, has there been any progress on reproducing/fixing the problem?
greearb
commented
4 years ago What firmware version are you using? And, assuming it is recent, would you be interested in bisecting firmware images to find where this regression was added?
mocmocamoc
commented
4 years ago I'm currently using ath10k-9984-10-4b/firmware-5-ct-full-community-12.bin-lede.014 as specified by OpenWrt master. I've tried going back as far as firmware-5-ct-full-community-12.bin-lede.001 but that exhibits the same problem with a PS4 Pro.
mocmocamoc
commented
4 years ago I also have a Surface Pro 6 which uses the same Marvell 88W8897 wifi chip as the PS4 Pro, and the Surface Pro 6 works fine with master OpenWrt using firmware-5-ct-full-community-12.bin-lede.014.
greearb
commented
4 years ago Ok, that is recent enough that it should have the fix I put in to fix the problem we could reproduce locally. If you want to bisect binaries, grab the tarball from here and let me know the last good commit, assuming there is one: http://www.candelatech.com/downloads/ath10k-9984-10-4b/bisect
mocmocamoc
commented
4 years ago I've just tried firmware-5-full-community-commit-152-f0b1d364c.bin (the highest-numbered non-htt version) from that archive and the PS4 Pro works correctly with that version.
greearb
commented
4 years ago The HTT versions should work fine with the ath10k-ct driver in OpenWRT.
mocmocamoc
commented
4 years ago Thanks, bisection shows that the problem started between these two versions: Good: firmware-5-full-htt-mgt-community-commit-1084-0a05ef49a.bin Bad: firmware-5-full-htt-mgt-community-commit-1085-7597bb62e.bin
greearb
commented
4 years ago Can you do a capture with a 9984 NIC for the good and bad commit? Open AUTH if you can so it is easier to understand what is going on. The 'bad' commit changes rate-ctrl in a relatively minor way, so I am not sure why that would totally break communication.
mocmocamoc
commented
4 years ago I've sent you a mail at the address on your profile with the capture, please let me know if any further details are required.
greearb
commented
4 years ago Please see if this image works better. It is my latest code, but adjusted to make rate-ctrl less aggressive in ramping up rates. firmware-5-full-htt-mgt-community.bin.gz
mocmocamoc
commented
4 years ago The PS4 Pro still has the same connectivity problems with that firmware unfortunately.
greearb
commented
4 years ago Here's a new series to bisect since I had rebased since the older series that you bisected against.
http://www.candelatech.com/downloads/ath10k-9984-10-4b/bisect/all_builds-9984-H-jan-27-2020.tar.gz
mocmocamoc
commented
4 years ago With that set the problem now starts between 1085-cd52f229e (good) and 1086-34b49cc18 (bad).
greearb
commented
4 years ago That's quite interesting, it bisects to the same patch (that I had moved later in my tree). But, earlier I had tried to send you the equiv of 1085-cd52f229e and you indicated it had issues? Can you please double-check that last bisect step, and be sure to use dmesg to confirm you are loading the firmware that you think you are loading?
mocmocamoc
commented
4 years ago I've switched back and forth between 1085-cd52f229e and 1086-34b49cc18 a few times, confirming via dmesg each time, and it still appears that the former is good and the latter is bad. The two files you sent me by email on Friday contain the string "10.4b-ct-9984-fH-012-34b49cc18", which suggests they may be equivalent to 1086-34b49cc18?
greearb
commented
4 years ago Thanks for all the help bisecting this. Bug is now fixed. It was bug introduced in rate-ctrl by me several years ago. I'm attaching a top-of-tree working image (previously sent privately in email) in case others want to try it. I'll send updates to openwrt soon, after hopefully fixing a few other bugs that are actively being worked on. firmware-5-full-htt-mgt-community.bin-master.gz
Description of the problem (how to configure, how to reproduce, how often it happens). PS4Pro on fw 6.20 (latest) has problems communicating on 5Ghz, works perfectly on a 2.4Ghz networks. Both are bridged to LAN. When switching to stock firmware it works as well
Software (OS, Firmware version, kernel, driver, etc) OpenWRT trunk, 10.4b-ct-9980-fW-012-81e1edd, ath10k 4.16 driver, optimized for CT firmware, probing pci device: 0x40.
Hardware (NIC chipset, platform, etc) QCA9980, TP-Link C2600
Logs (dmesg, maybe supplicant and/or hostap) Unfortunately it's hard to debug, since there's no shell on a PS4. On OWRT side i can see it connects to the NIC but then has problems. The console reports no connectivity, and I can't use anything internet related (like browser, seems it can't even get to the DNS server)
Thu Dec 20 20:15:51 2018 daemon.info hostapd: wlan0: STA e8:9e:b4:aa:7c:e7 IEEE 802.11: authenticated Thu Dec 20 20:15:51 2018 daemon.info hostapd: wlan0: STA e8:9e:b4:aa:7c:e7 IEEE 802.11: associated (aid 1) Thu Dec 20 20:15:51 2018 daemon.info hostapd: wlan0: STA e8:9e:b4:aa:7c:e7 RADIUS: starting accounting session EFAC944475672A41 Thu Dec 20 20:15:51 2018 daemon.info hostapd: wlan0: STA e8:9e:b4:aa:7c:e7 WPA: pairwise key handshake completed (RSN) Thu Dec 20 20:15:51 2018 daemon.info dnsmasq-dhcp[3830]: DHCPDISCOVER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:15:51 2018 daemon.info dnsmasq-dhcp[3830]: DHCPOFFER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:15:54 2018 daemon.info dnsmasq-dhcp[3830]: DHCPDISCOVER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:15:54 2018 daemon.info dnsmasq-dhcp[3830]: DHCPOFFER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:15:55 2018 daemon.info dnsmasq-dhcp[3830]: DHCPDISCOVER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:15:55 2018 daemon.info dnsmasq-dhcp[3830]: DHCPOFFER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:15:57 2018 daemon.info dnsmasq-dhcp[3830]: DHCPDISCOVER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:15:57 2018 daemon.info dnsmasq-dhcp[3830]: DHCPOFFER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:15:59 2018 daemon.info dnsmasq-dhcp[3830]: DHCPDISCOVER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:15:59 2018 daemon.info dnsmasq-dhcp[3830]: DHCPOFFER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:16:01 2018 daemon.info dnsmasq-dhcp[3830]: DHCPDISCOVER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:16:01 2018 daemon.info dnsmasq-dhcp[3830]: DHCPOFFER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:16:03 2018 daemon.info dnsmasq-dhcp[3830]: DHCPDISCOVER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:16:03 2018 daemon.info dnsmasq-dhcp[3830]: DHCPOFFER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:16:04 2018 daemon.info dnsmasq-dhcp[3830]: DHCPDISCOVER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:16:04 2018 daemon.info dnsmasq-dhcp[3830]: DHCPOFFER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:16:07 2018 daemon.info dnsmasq-dhcp[3830]: DHCPDISCOVER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:16:07 2018 daemon.info dnsmasq-dhcp[3830]: DHCPOFFER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:16:08 2018 daemon.warn odhcpd[1149]: DHCPV6 SOLICIT IA_NA from 00030001e89eb4aa7ce7 on br-lan: ok 2001:470:71:461::864/128 fdcf:a3f3:45a2::864/128 Thu Dec 20 20:16:09 2018 daemon.info dnsmasq-dhcp[3830]: DHCPDISCOVER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:16:09 2018 daemon.info dnsmasq-dhcp[3830]: DHCPOFFER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:16:10 2018 daemon.warn odhcpd[1149]: DHCPV6 SOLICIT IA_NA from 00030001e89eb4aa7ce7 on br-lan: ok 2001:470:71:461::864/128 fdcf:a3f3:45a2::864/128 Thu Dec 20 20:16:11 2018 daemon.info dnsmasq-dhcp[3830]: DHCPDISCOVER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:16:11 2018 daemon.info dnsmasq-dhcp[3830]: DHCPOFFER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:16:12 2018 daemon.warn odhcpd[1149]: DHCPV6 SOLICIT IA_NA from 00030001e89eb4aa7ce7 on br-lan: ok 2001:470:71:461::864/128 fdcf:a3f3:45a2::864/128 Thu Dec 20 20:16:13 2018 daemon.info dnsmasq-dhcp[3830]: DHCPDISCOVER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:16:13 2018 daemon.info dnsmasq-dhcp[3830]: DHCPOFFER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:16:15 2018 daemon.info dnsmasq-dhcp[3830]: DHCPDISCOVER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:16:15 2018 daemon.info dnsmasq-dhcp[3830]: DHCPOFFER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:16:16 2018 daemon.warn odhcpd[1149]: DHCPV6 SOLICIT IA_NA from 00030001e89eb4aa7ce7 on br-lan: ok 2001:470:71:461::864/128 fdcf:a3f3:45a2::864/128 Thu Dec 20 20:16:17 2018 daemon.info dnsmasq-dhcp[3830]: DHCPDISCOVER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:16:17 2018 daemon.info dnsmasq-dhcp[3830]: DHCPOFFER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:16:19 2018 daemon.info dnsmasq-dhcp[3830]: DHCPDISCOVER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:16:19 2018 daemon.info dnsmasq-dhcp[3830]: DHCPOFFER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:16:22 2018 daemon.info dnsmasq-dhcp[3830]: DHCPDISCOVER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:16:22 2018 daemon.info dnsmasq-dhcp[3830]: DHCPOFFER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:16:24 2018 daemon.warn odhcpd[1149]: DHCPV6 SOLICIT IA_NA from 00030001e89eb4aa7ce7 on br-lan: ok 2001:470:71:461::864/128 fdcf:a3f3:45a2::864/128 Thu Dec 20 20:16:40 2018 daemon.warn odhcpd[1149]: DHCPV6 SOLICIT IA_NA from 00030001e89eb4aa7ce7 on br-lan: ok 2001:470:71:461::864/128 fdcf:a3f3:45a2::864/128 Thu Dec 20 20:16:42 2018 daemon.info dnsmasq-dhcp[3830]: DHCPDISCOVER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7 Thu Dec 20 20:16:42 2018 daemon.info dnsmasq-dhcp[3830]: DHCPOFFER(br-lan) 10.1.1.35 e8:9e:b4:aa:7c:e7