On Fri, 2020-06-05 at 02:45 +0000, Robin Gong wrote: > On 2020/06/03 Matthias Schiffer <matthias.schiffer@xxxxxxxxxxxxxxx> > wrote: > > On Wed, 2020-06-03 at 09:50 +0000, Robin Gong wrote: > > > On 2020/06/03 Matthias Schiffer < > > > matthias.schiffer@xxxxxxxxxxxxxxx> > > > wrote: > > > > On Thu, 2020-05-21 at 04:34 +0800, Robin Gong wrote: > > > > > There is ecspi ERR009165 on i.mx6/7 soc family, which cause > > > > > FIFO > > > > > transfer to be send twice in DMA mode. Please get more > > > > > information > > > > > from: > > > > > > > > > https://eur01.safelinks.protection.outlook.com/?url=https%3A%2F%2Fwww > > > > > . > > > > > > > > > > > > > > > > > nxp.com%2Fdocs%2Fen%2Ferrata%2FIMX6DQCE.pdf&data=02%7C01%7C > > > > yibin.g > > > > > > > > > > > > > > > > > ong%40nxp.com%7C4621358b9be04a79d2d508d80798835b%7C686ea1d3bc2b > > > > 4c6fa92 > > > > > > > > > > > > > > > > > cd99c5c301635%7C0%7C1%7C637267698912634476&sdata=hR66H1hP% > > > > 2Fqb6OXe > > > > > w9wpXizY8DiNfZZ1KLwu3Kty87jc%3D&reserved=0. The > > > > > workaround > > > > is > > > > > adding new sdma ram script which works in XCH mode as PIO > > > > > inside > > > > > sdma instead of SMC mode, meanwhile, 'TX_THRESHOLD' should be > > > > > 0. > > > > > The issue > > > > > > > > should be exist on all legacy i.mx6/7 soc family before > > > > i.mx6ul. > > > > > NXP fix this design issue from i.mx6ul, so newer chips > > > > > including > > > > > i.mx6ul/ 6ull/6sll do not need this workaroud anymore. All > > > > > other > > > > > i.mx6/7/8 chips still need this workaroud. This patch set add > > > > > new > > > > > 'fsl,imx6ul-ecspi' > > > > > for ecspi driver and 'ecspi_fixed' in sdma driver to choose > > > > > if > > > > > need errata or not. > > > > > The first two reverted patches should be the same issue, > > > > > though, > > > > > it seems 'fixed' by changing to other shp script. Hope Sean > > > > > or > > > > > Sascha could have the chance to test this patch set if could > > > > > fix > > > > > their issues. > > > > > Besides, enable sdma support for i.mx8mm/8mq and fix ecspi1 > > > > > not > > > > > work on i.mx8mm because the event id is zero. > > > > > > > > > > PS: > > > > > Please get sdma firmware from below linux-firmware and > > > > > copy it > > > > > to your local rootfs /lib/firmware/imx/sdma. > > > > > > > > > > > > Hello Robin, > > > > > > > > we have tried out this series, and there seems to be an issue > > > > with > > > > the > > > > PIO fallback. We are testing on an i.MX6Q board, and our kernel > > > > is > > > > a > > > > mostly-unmodified 5.4, on which we backported all SDMA patches > > > > from > > > > next-20200602 (imx-sdma.c is identical to next-20200602 > > > > version), > > > > and > > > > then applied this whole series. > > > > > > > > We build the SDMA driver as a kernel module, which is loaded by > > > > udev, > > > > so the root filesystem is ready and the SDMA firmware can be > > > > loaded. > > > > The behaviour we're seeing is the following: > > > > > > > > 1. As long as the SDMA driver is not loaded, initializing > > > > spi_imx > > > > will > > > > be deferred > > > > 2. imx_sdma is loaded. The SDMA firmware is not yet loaded at > > > > this > > > > point > > > > 3. spi_imx is initialized and an SPI-NOR flash is probed. To > > > > load > > > > the > > > > BFPT, the driver will attempt to use DMA; this will fail with > > > > EINVAL as > > > > long as the SDMA firmware is not ready, so the fallback to PIO > > > > happens > > > > (4. SDMA firmware is ready, subsequent SPI transfers use DMA) > > > > > > > > The problem happens in step 3: Whenever the driver falls back > > > > to > > > > PIO, > > > > the received data is corrupt. The behaviour is specific to the > > > > fallback: When I disable DMA completely via spi_imx.use_dma, or > > > > when > > > > the timing is lucky and the SDMA firmware gets loaded before > > > > the > > > > flash > > > > is probed, no corruption can be observed. > > > > > > Thanks Matthias, would you like post log? > > > > > > > I have attached the following log files: > > - pio.log: DMA disabled via module parameter > > - dma.log: "lucky" timing, SDMA firmware loaded before SPI-NOR > > probe > > - fallback.log: DMA->PIO fallback > > > > The logs include some additional log messages: > > - Return value of spi_imx_dma_transfer() before PIO fallback > > - SPI-NOR SFPT dump > > > > It can be seen that the BFPT data is identical in pio.log and > > dma.log, > > and differs almost completely in fallback.log. The corrupted data > > seems > > to be random, or uninitialized memory; it differs with every boot. > > Would you please have a try with the attached patch? Thanks. Thank you, this fixes the issue we're seeing. Kind regards, Matthias
[ 0.000000] Booting Linux on physical CPU 0x0 [ 0.000000] Linux version 5.4.39 (oe-user@oe-host) (gcc version 9.2.0 (GCC)) #1 SMP PREEMPT Fri Jun 5 07:23:40 UTC 2020 [ 0.000000] CPU: ARMv7 Processor [412fc09a] revision 10 (ARMv7), cr=10c5387d [ 0.000000] CPU: PIPT / VIPT nonaliasing data cache, VIPT aliasing instruction cache [ 0.000000] OF: fdt: Machine model: TQ TQMa6Q on MBa6x [ 0.000000] Memory policy: Data cache writealloc [ 0.000000] cma: Reserved 160 MiB at 0x46000000 [ 0.000000] On node 0 totalpages: 262144 [ 0.000000] Normal zone: 2048 pages used for memmap [ 0.000000] Normal zone: 0 pages reserved [ 0.000000] Normal zone: 262144 pages, LIFO batch:63 [ 0.000000] percpu: Embedded 20 pages/cpu s50664 r8192 d23064 u81920 [ 0.000000] pcpu-alloc: s50664 r8192 d23064 u81920 alloc=20*4096 [ 0.000000] pcpu-alloc: [0] 0 [0] 1 [0] 2 [0] 3 [ 0.000000] Built 1 zonelists, mobility grouping on. Total pages: 260096 [ 0.000000] Kernel command line: root=/dev/mmcblk1p2 ro rootwait console=ttymxc1,115200 spi_imx.dyndbg=+p consoleblank=0 cma=160M [ 0.000000] Dentry cache hash table entries: 131072 (order: 7, 524288 bytes, linear) [ 0.000000] Inode-cache hash table entries: 65536 (order: 6, 262144 bytes, linear) [ 0.000000] mem auto-init: stack:off, heap alloc:off, heap free:off [ 0.000000] Memory: 850004K/1048576K available (12288K kernel code, 942K rwdata, 3656K rodata, 1024K init, 6554K bss, 34732K reserved, 163840K cma-reserved, 0K highmem) [ 0.000000] random: get_random_u32 called from __kmem_cache_create+0x20/0x2b8 with crng_init=0 [ 0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=4, Nodes=1 [ 0.000000] ftrace: allocating 34625 entries in 68 pages [ 0.000000] Running RCU self tests [ 0.000000] rcu: Preemptible hierarchical RCU implementation. [ 0.000000] rcu: RCU lockdep checking is enabled. [ 0.000000] Tasks RCU enabled. [ 0.000000] rcu: RCU calculated value of scheduler-enlistment delay is 10 jiffies. [ 0.000000] NR_IRQS: 16, nr_irqs: 16, preallocated irqs: 16 [ 0.000000] L2C-310 errata 752271 769419 enabled [ 0.000000] L2C-310 enabling early BRESP for Cortex-A9 [ 0.000000] L2C-310 full line of zeros enabled for Cortex-A9 [ 0.000000] L2C-310 ID prefetch enabled, offset 16 lines [ 0.000000] L2C-310 dynamic clock gating enabled, standby mode enabled [ 0.000000] L2C-310 cache controller enabled, 16 ways, 1024 kB [ 0.000000] L2C-310: CACHE_ID 0x410000c7, AUX_CTRL 0x76470001 [ 0.000000] Switching to timer-based delay loop, resolution 333ns [ 0.000009] sched_clock: 32 bits at 3000kHz, resolution 333ns, wraps every 715827882841ns [ 0.000040] clocksource: mxc_timer1: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 637086815595 ns [ 0.001629] Console: colour dummy device 80x30 [ 0.001665] Lock dependency validator: Copyright (c) 2006 Red Hat, Inc., Ingo Molnar [ 0.001687] ... MAX_LOCKDEP_SUBCLASSES: 8 [ 0.001711] ... MAX_LOCK_DEPTH: 48 [ 0.001731] ... MAX_LOCKDEP_KEYS: 8192 [ 0.001753] ... CLASSHASH_SIZE: 4096 [ 0.001774] ... MAX_LOCKDEP_ENTRIES: 32768 [ 0.001795] ... MAX_LOCKDEP_CHAINS: 65536 [ 0.001816] ... CHAINHASH_SIZE: 32768 [ 0.001836] memory used by lock dependency info: 3997 kB [ 0.001856] memory used for stack traces: 2112 kB [ 0.001878] per task-struct memory footprint: 1536 bytes [ 0.001953] Calibrating delay loop (skipped), value calculated using timer frequency.. 6.00 BogoMIPS (lpj=30000) [ 0.001988] pid_max: default: 32768 minimum: 301 [ 0.002526] Mount-cache hash table entries: 2048 (order: 1, 8192 bytes, linear) [ 0.002572] Mountpoint-cache hash table entries: 2048 (order: 1, 8192 bytes, linear) [ 0.005083] CPU: Testing write buffer coherency: ok [ 0.005169] CPU0: Spectre v2: using BPIALL workaround [ 0.006459] CPU0: thread -1, cpu 0, socket 0, mpidr 80000000 [ 0.059678] Setting up static identity map for 0x10100000 - 0x10100060 [ 0.079539] rcu: Hierarchical SRCU implementation. [ 0.129550] smp: Bringing up secondary CPUs ... [ 0.210001] CPU1: thread -1, cpu 1, socket 0, mpidr 80000001 [ 0.210016] CPU1: Spectre v2: using BPIALL workaround [ 0.289894] CPU2: thread -1, cpu 2, socket 0, mpidr 80000002 [ 0.289910] CPU2: Spectre v2: using BPIALL workaround [ 0.369888] CPU3: thread -1, cpu 3, socket 0, mpidr 80000003 [ 0.369903] CPU3: Spectre v2: using BPIALL workaround [ 0.370513] smp: Brought up 1 node, 4 CPUs [ 0.370547] SMP: Total of 4 processors activated (24.00 BogoMIPS). [ 0.370573] CPU: All CPU(s) started in SVC mode. [ 0.372564] devtmpfs: initialized [ 0.411117] VFP support v0.3: implementor 41 architecture 3 part 30 variant 9 rev 4 [ 0.413270] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 19112604462750000 ns [ 0.413334] futex hash table entries: 1024 (order: 4, 65536 bytes, linear) [ 0.421673] pinctrl core: initialized pinctrl subsystem [ 0.426412] NET: Registered protocol family 16 [ 0.433920] DMA: preallocated 256 KiB pool for atomic coherent allocations [ 0.437726] cpuidle: using governor ladder [ 0.438009] CPU identified as i.MX6Q, silicon rev 1.5 [ 0.471621] vdd1p1: supplied by regulator-dummy [ 0.473787] vdd3p0: supplied by regulator-dummy [ 0.475680] vdd2p5: supplied by regulator-dummy [ 0.477536] vddarm: supplied by regulator-dummy [ 0.479670] vddpu: supplied by regulator-dummy [ 0.481530] vddsoc: supplied by regulator-dummy [ 0.521081] hw-breakpoint: found 5 (+1 reserved) breakpoint and 1 watchpoint registers. [ 0.521146] hw-breakpoint: maximum watchpoint size is 4 bytes. [ 0.524299] imx6q-pinctrl 20e0000.iomuxc: initialized IMX pinctrl driver [ 0.644216] mxs-dma 110000.dma-apbh: initialized [ 0.653222] vgaarb: loaded [ 0.654666] SCSI subsystem initialized [ 0.655483] libata version 3.00 loaded. [ 0.656501] usbcore: registered new interface driver usbfs [ 0.656737] usbcore: registered new interface driver hub [ 0.657080] usbcore: registered new device driver usb [ 0.657588] usb_phy_generic usbphynop1: usbphynop1 supply vcc not found, using dummy regulator [ 0.658449] usb_phy_generic usbphynop2: usbphynop2 supply vcc not found, using dummy regulator [ 0.665470] i2c i2c-0: IMX I2C adapter registered [ 0.666320] pps_core: LinuxPPS API ver. 1 registered [ 0.666349] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti <giometti@xxxxxxxx> [ 0.666430] PTP clock support registered [ 0.674652] clocksource: Switched to clocksource mxc_timer1 [ 1.740208] thermal_sys: Registered thermal governor 'fair_share' [ 1.740222] thermal_sys: Registered thermal governor 'step_wise' [ 1.740260] thermal_sys: Registered thermal governor 'user_space' [ 1.741160] NET: Registered protocol family 2 [ 1.743061] tcp_listen_portaddr_hash hash table entries: 512 (order: 2, 20480 bytes, linear) [ 1.743196] TCP established hash table entries: 8192 (order: 3, 32768 bytes, linear) [ 1.743432] TCP bind hash table entries: 8192 (order: 6, 294912 bytes, linear) [ 1.744897] TCP: Hash tables configured (established 8192 bind 8192) [ 1.745528] UDP hash table entries: 512 (order: 3, 40960 bytes, linear) [ 1.745768] UDP-Lite hash table entries: 512 (order: 3, 40960 bytes, linear) [ 1.746564] NET: Registered protocol family 1 [ 1.748943] RPC: Registered named UNIX socket transport module. [ 1.749009] RPC: Registered udp transport module. [ 1.749037] RPC: Registered tcp transport module. [ 1.749064] RPC: Registered tcp NFSv4.1 backchannel transport module. [ 1.760424] PCI: CLS 0 bytes, default 64 [ 1.761389] hw perfevents: no interrupt-affinity property for /pmu, guessing. [ 1.762261] hw perfevents: enabled with armv7_cortex_a9 PMU driver, 7 counters available [ 1.768318] Initialise system trusted keyrings [ 1.769028] workingset: timestamp_bits=30 max_order=18 bucket_order=0 [ 1.792661] NFS: Registering the id_resolver key type [ 1.792800] Key type id_resolver registered [ 1.792870] Key type id_legacy registered [ 1.792932] nfs4filelayout_init: NFSv4 File Layout Driver Registering... [ 1.793719] fuse: init (API version 7.31) [ 1.796020] NILFS version 2 loaded [ 1.838986] Key type asymmetric registered [ 1.839100] Asymmetric key parser 'x509' registered [ 1.839275] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 249) [ 1.839367] io scheduler mq-deadline registered [ 1.839401] io scheduler kyber registered [ 1.847454] imx6q-pcie 1ffc000.pcie: host bridge /soc/pcie@1ffc000 ranges: [ 1.847675] imx6q-pcie 1ffc000.pcie: IO 0x01f80000..0x01f8ffff -> 0x00000000 [ 1.847866] imx6q-pcie 1ffc000.pcie: MEM 0x01000000..0x01efffff -> 0x01000000 [ 1.859118] pfuze100-regulator 0-0008: Full layer: 2, Metal layer: 1 [ 1.860092] pfuze100-regulator 0-0008: FAB: 0, FIN: 0 [ 1.860126] pfuze100-regulator 0-0008: pfuze100 found. [ 1.891216] 21e8000.serial: ttymxc1 at MMIO 0x21e8000 (irq = 66, base_baud = 5000000) is a IMX [ 2.678656] printk: console [ttymxc1] enabled [ 2.685153] 21ec000.serial: ttymxc2 at MMIO 0x21ec000 (irq = 67, base_baud = 5000000) is a IMX [ 2.695707] 21f0000.serial: ttymxc3 at MMIO 0x21f0000 (irq = 68, base_baud = 5000000) is a IMX [ 2.706224] 21f4000.serial: ttymxc4 at MMIO 0x21f4000 (irq = 69, base_baud = 5000000) is a IMX [ 2.739808] etnaviv etnaviv: bound 130000.gpu (ops gpu_ops) [ 2.746264] etnaviv etnaviv: bound 134000.gpu (ops gpu_ops) [ 2.752620] etnaviv etnaviv: bound 2204000.gpu (ops gpu_ops) [ 2.758410] etnaviv-gpu 130000.gpu: model: GC2000, revision: 5108 [ 2.765556] etnaviv-gpu 134000.gpu: model: GC320, revision: 5007 [ 2.771816] etnaviv-gpu 2204000.gpu: model: GC355, revision: 1215 [ 2.778030] etnaviv-gpu 2204000.gpu: Ignoring GPU with VG and FE2.0 [ 2.787199] [drm] Initialized etnaviv 1.3.0 20151214 for etnaviv on minor 0 [ 2.799546] imx-ipuv3 2400000.ipu: IPUv3H probed [ 2.807632] [drm] Supports vblank timestamp caching Rev 2 (21.10.2013). [ 2.814322] [drm] No driver support for vblank timestamp query. [ 2.821418] imx-drm display-subsystem: bound imx-ipuv3-crtc.2 (ops ipu_crtc_ops) [ 2.829349] imx-drm display-subsystem: bound imx-ipuv3-crtc.3 (ops ipu_crtc_ops) [ 2.837354] imx-drm display-subsystem: bound imx-ipuv3-crtc.6 (ops ipu_crtc_ops) [ 2.845276] imx-drm display-subsystem: bound imx-ipuv3-crtc.7 (ops ipu_crtc_ops) [ 2.854389] [drm] Initialized imx-drm 1.0.0 20120507 for display-subsystem on minor 1 [ 2.862675] imx-ipuv3 2800000.ipu: IPUv3H probed [ 2.912586] loop: module loaded [ 2.918439] at24 0-0050: 8192 byte 24c64 EEPROM, writable, 32 bytes/write [ 2.927616] at24 0-0057: 8192 byte 24c64 EEPROM, writable, 32 bytes/write [ 2.937469] ahci-imx 2200000.sata: fsl,transmit-level-mV not specified, using 00000024 [ 2.945500] ahci-imx 2200000.sata: fsl,transmit-boost-mdB not specified, using 00000480 [ 2.953544] ahci-imx 2200000.sata: fsl,transmit-atten-16ths not specified, using 00002000 [ 2.961821] ahci-imx 2200000.sata: fsl,receive-eq-mdB not specified, using 05000000 [ 2.969862] ahci-imx 2200000.sata: 2200000.sata supply ahci not found, using dummy regulator [ 2.974678] imx6q-pcie 1ffc000.pcie: Phy link never came up [ 2.978838] ahci-imx 2200000.sata: 2200000.sata supply phy not found, using dummy regulator [ 2.987906] imx6q-pcie 1ffc000.pcie: PCI host bridge to bus 0000:00 [ 2.993159] ahci-imx 2200000.sata: 2200000.sata supply target not found, using dummy regulator [ 2.998671] pci_bus 0000:00: root bus resource [bus 00-ff] [ 2.998699] pci_bus 0000:00: root bus resource [io 0x0000-0xffff] [ 3.011182] ahci-imx 2200000.sata: SSS flag set, parallel bus scan disabled [ 3.012881] pci_bus 0000:00: root bus resource [mem 0x01000000-0x01efffff] [ 3.019183] ahci-imx 2200000.sata: AHCI 0001.0300 32 slots 1 ports 3 Gbps 0x1 impl platform mode [ 3.026411] pci 0000:00:00.0: [16c3:abcd] type 01 class 0x060400 [ 3.033056] ahci-imx 2200000.sata: flags: ncq sntf stag pm led clo only pmp pio slum part ccc apst [ 3.041992] pci 0000:00:00.0: reg 0x10: [mem 0x00000000-0x000fffff] [ 3.063650] pci 0000:00:00.0: reg 0x38: [mem 0x00000000-0x0000ffff pref] [ 3.067674] scsi host0: ahci-imx [ 3.070548] pci 0000:00:00.0: Limiting cfg_size to 512 [ 3.075295] ata1: SATA max UDMA/133 mmio [mem 0x02200000-0x02203fff] port 0x100 irq 72 [ 3.079130] pci 0000:00:00.0: supports D1 [ 3.089282] spi_imx 2008000.spi: can't get the TX DMA channel, error -517! [ 3.090799] pci 0000:00:00.0: PME# supported from D0 D1 D3hot D3cold [ 3.092133] spi_imx 2018000.spi: can't get the TX DMA channel, error -517! [ 3.099384] libphy: Fixed MDIO Bus: probed [ 3.102695] PCI: bus0: Fast back to back transfers disabled [ 3.105356] CAN device driver interface [ 3.113649] PCI: bus1: Fast back to back transfers enabled [ 3.114285] flexcan 2090000.flexcan: 2090000.flexcan supply xceiver not found, using dummy regulator [ 3.119291] pci 0000:00:00.0: BAR 0: assigned [mem 0x01000000-0x010fffff] [ 3.131705] flexcan 2094000.flexcan: 2094000.flexcan supply xceiver not found, using dummy regulator [ 3.135310] pci 0000:00:00.0: BAR 6: assigned [mem 0x01100000-0x0110ffff pref] [ 3.151786] pci 0000:00:00.0: PCI bridge to [bus 01-ff] [ 3.153541] pps pps0: new PPS source ptp0 [ 3.159151] pcieport 0000:00:00.0: PME: Signaling with IRQ 306 [ 3.168741] pcieport 0000:00:00.0: AER: enabled with IRQ 306 [ 3.169048] libphy: fec_enet_mii_bus: probed [ 3.183769] fec 2188000.ethernet eth0: registered PHC device 0 [ 3.190548] usbcore: registered new interface driver cdc_ether [ 3.196665] usbcore: registered new interface driver smsc95xx [ 3.202461] ehci_hcd: USB 2.0 'Enhanced' Host Controller (EHCI) Driver [ 3.209144] ehci-pci: EHCI PCI platform driver [ 3.219204] imx_usb 2184000.usb: No over current polarity defined [ 3.230025] ci_hdrc ci_hdrc.0: EHCI Host Controller [ 3.235495] ci_hdrc ci_hdrc.0: new USB bus registered, assigned bus number 1 [ 3.264720] ci_hdrc ci_hdrc.0: USB 2.0 started, EHCI 1.00 [ 3.271845] usb usb1: New USB device found, idVendor=1d6b, idProduct=0002, bcdDevice= 5.04 [ 3.280322] usb usb1: New USB device strings: Mfr=3, Product=2, SerialNumber=1 [ 3.287654] usb usb1: Product: EHCI Host Controller [ 3.292565] usb usb1: Manufacturer: Linux 5.4.39 ehci_hcd [ 3.298056] usb usb1: SerialNumber: ci_hdrc.0 [ 3.305485] hub 1-0:1.0: USB hub found [ 3.309555] hub 1-0:1.0: 1 port detected [ 3.317484] imx_usb 2184200.usb: 2184200.usb supply vbus not found, using dummy regulator [ 3.330416] ci_hdrc ci_hdrc.1: EHCI Host Controller [ 3.335501] ci_hdrc ci_hdrc.1: new USB bus registered, assigned bus number 2 [ 3.364702] ci_hdrc ci_hdrc.1: USB 2.0 started, EHCI 1.00 [ 3.371209] usb usb2: New USB device found, idVendor=1d6b, idProduct=0002, bcdDevice= 5.04 [ 3.379600] usb usb2: New USB device strings: Mfr=3, Product=2, SerialNumber=1 [ 3.386918] usb usb2: Product: EHCI Host Controller [ 3.391831] usb usb2: Manufacturer: Linux 5.4.39 ehci_hcd [ 3.397322] usb usb2: SerialNumber: ci_hdrc.1 [ 3.403588] hub 2-0:1.0: USB hub found [ 3.407620] hub 2-0:1.0: 1 port detected [ 3.416582] mousedev: PS/2 mouse device common for all mice [ 3.426923] ata1: SATA link down (SStatus 0 SControl 300) [ 3.432599] ahci-imx 2200000.sata: no device found, disabling link. [ 3.434404] rtc-ds1307 0-0068: registered as rtc0 [ 3.438995] ahci-imx 2200000.sata: pass ahci_imx..hotplug=1 to enable hotplug [ 3.445882] i2c /dev entries driver [ 3.455954] IR NEC protocol handler initialized [ 3.460526] IR RC5(x/sz) protocol handler initialized [ 3.465704] IR RC6 protocol handler initialized [ 3.470272] IR JVC protocol handler initialized [ 3.474914] IR Sony protocol handler initialized [ 3.479565] IR SANYO protocol handler initialized [ 3.484300] IR Sharp protocol handler initialized [ 3.489093] IR MCE Keyboard/mouse protocol handler initialized [ 3.495017] IR XMP protocol handler initialized [ 3.506346] lm75 0-0048: hwmon0: sensor 'lm75' [ 3.513239] lm75 0-0049: hwmon1: sensor 'lm75' [ 3.523672] imx2-wdt 20bc000.wdog: timeout 60 sec (nowayout=0) [ 3.532392] sdhci: Secure Digital Host Controller Interface driver [ 3.538672] sdhci: Copyright(c) Pierre Ossman [ 3.543062] sdhci-pltfm: SDHCI platform and OF driver helper [ 3.550780] sdhci-esdhc-imx 2194000.usdhc: Got CD GPIO [ 3.556135] sdhci-esdhc-imx 2194000.usdhc: Got WP GPIO [ 3.598990] mmc1: SDHCI controller on 2194000.usdhc [2194000.usdhc] using ADMA [ 3.651070] mmc1: new high speed SD card at address 1234 [ 3.657883] mmc0: SDHCI controller on 2198000.usdhc [2198000.usdhc] using ADMA [ 3.670288] ledtrig-cpu: registered to indicate activity on CPUs [ 3.671305] mmcblk1: mmc1:1234 SA02G 1.84 GiB [ 3.681554] caam 2100000.caam: Entropy delay = 3200 [ 3.703274] mmcblk1: p1 p2 [ 3.747319] caam 2100000.caam: Instantiated RNG4 SH0 [ 3.774779] usb 2-1: new high-speed USB device number 2 using ci_hdrc [ 3.787144] mmc0: new DDR MMC card at address 0001 [ 3.794197] mmcblk0: mmc0:0001 MMC04G 3.52 GiB [ 3.799884] mmcblk0boot0: mmc0:0001 MMC04G partition 1 16.0 MiB [ 3.806963] mmcblk0boot1: mmc0:0001 MMC04G partition 2 16.0 MiB [ 3.808082] caam 2100000.caam: Instantiated RNG4 SH1 [ 3.813829] mmcblk0rpmb: mmc0:0001 MMC04G partition 3 128 KiB, chardev (248:0) [ 3.817956] caam 2100000.caam: device ID = 0x0a16010000000000 (Era 4) [ 3.817974] caam 2100000.caam: job rings = 2, qi = 0 [ 3.892098] caam algorithms registered in /proc/crypto [ 3.912582] caam_jr 2101000.jr0: registering rng-caam [ 3.919891] hidraw: raw HID events driver (C) Jiri Kosina [ 3.930853] NET: Registered protocol family 10 [ 3.939894] Segment Routing with IPv6 [ 3.943729] sit: IPv6, IPv4 and MPLS over IPv4 tunneling driver [ 3.952463] NET: Registered protocol family 17 [ 3.957050] can: controller area network core (rev 20170425 abi 9) [ 3.963506] NET: Registered protocol family 29 [ 3.968053] can: raw protocol (rev 20170425) [ 3.972458] can: broadcast manager protocol (rev 20170425 t) [ 3.975864] usb 2-1: New USB device found, idVendor=0424, idProduct=2517, bcdDevice= 0.02 [ 3.978267] can: netlink gateway (rev 20190810) max_hops=1 [ 3.986497] usb 2-1: New USB device strings: Mfr=0, Product=0, SerialNumber=0 [ 3.992533] Key type dns_resolver registered [ 4.001775] hub 2-1:1.0: USB hub found [ 4.007726] hub 2-1:1.0: 7 ports detected [ 4.019922] Registering SWP/SWPB emulation handler [ 4.026940] Loading compiled-in X.509 certificates [ 4.033765] Key type ._fscrypt registered [ 4.038061] Key type .fscrypt registered [ 4.197921] spi_imx 2008000.spi: can't get the TX DMA channel, error -517! [ 4.199984] spi_imx 2018000.spi: can't get the TX DMA channel, error -517! [ 4.203694] imx_thermal tempmon: Industrial CPU temperature grade - max:105C critical:100C passive:95C [ 4.215406] spi_imx 2008000.spi: can't get the TX DMA channel, error -517! [ 4.217246] spi_imx 2018000.spi: can't get the TX DMA channel, error -517! [ 4.219297] spi_imx 2008000.spi: can't get the TX DMA channel, error -517! [ 4.221081] spi_imx 2018000.spi: can't get the TX DMA channel, error -517! [ 4.225245] random: fast init done [ 4.229248] rtc-ds1307 0-0068: setting system clock to 2000-01-01T00:01:08 UTC (946684868) [ 4.238084] cfg80211: Loading compiled-in X.509 certificates for regulatory database [ 4.258979] cfg80211: Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7' [ 4.267092] platform regulatory.0: Direct firmware load for regulatory.db failed with error -2 [ 4.276176] cfg80211: failed to load regulatory.db [ 4.301827] EXT4-fs (mmcblk1p2): INFO: recovery required on readonly filesystem [ 4.309472] EXT4-fs (mmcblk1p2): write access will be enabled during recovery [ 4.334800] usb 2-1.1: new high-speed USB device number 3 using ci_hdrc [ 4.496212] usb 2-1.1: New USB device found, idVendor=0424, idProduct=9e00, bcdDevice= 3.00 [ 4.504886] usb 2-1.1: New USB device strings: Mfr=0, Product=0, SerialNumber=0 [ 4.517379] smsc95xx v1.0.6 [ 4.648480] smsc95xx 2-1.1:1.0 eth1: register 'smsc95xx' at usb-ci_hdrc.1-1.1, smsc95xx USB 2.0 Ethernet, f2:78:83:43:d1:7b [ 4.662389] spi_imx 2008000.spi: can't get the TX DMA channel, error -517! [ 4.664256] spi_imx 2018000.spi: can't get the TX DMA channel, error -517! [ 4.967482] EXT4-fs (mmcblk1p2): recovery complete [ 4.986706] EXT4-fs (mmcblk1p2): mounted filesystem with ordered data mode. Opts: (null) [ 4.996436] VFS: Mounted root (ext4 filesystem) readonly on device 179:2. [ 5.007139] devtmpfs: mounted [ 5.028362] Freeing unused kernel memory: 1024K [ 5.034564] Run /sbin/init as init process [ 5.606188] systemd[1]: System time before build time, advancing clock. [ 5.710605] systemd[1]: systemd 243.2+ running in system mode. (-PAM -AUDIT -SELINUX +IMA -APPARMOR +SMACK +SYSVINIT +UTMP -LIBCRYPTSETUP -GCRYPT -GNUTLS +ACL +XZ -LZ4 -SECCOMP +BLKID -ELFUTILS +KMOD -IDN2 -IDN -PCRE2 default-hierarchy=hybrid) [ 5.736335] systemd[1]: Detected architecture arm. [ 5.799308] systemd[1]: Set hostname to <tqma6q-mba6x>. [ 6.675645] systemd[1]: /lib/systemd/system/dbus.socket:5: ListenStream= references a path below legacy directory /var/run/, updating /var/run/dbus/system_bus_socket \xe2\x86\x92 /run/dbus/system_bus_socket; please update the unit file accordingly. [ 7.024418] systemd[1]: /lib/systemd/system/rpcbind.socket:5: ListenStream= references a path below legacy directory /var/run/, updating /var/run/rpcbind.sock \xe2\x86\x92 /run/rpcbind.sock; please update the unit file accordingly. [ 7.088772] random: systemd: uninitialized urandom read (16 bytes read) [ 7.100144] systemd[1]: Created slice system-getty.slice. [ 7.135611] random: systemd: uninitialized urandom read (16 bytes read) [ 7.146536] systemd[1]: Created slice system-serial\x2dgetty.slice. [ 7.195582] random: systemd: uninitialized urandom read (16 bytes read) [ 7.206267] systemd[1]: Created slice User and Session Slice. [ 7.247801] systemd[1]: Started Dispatch Password Requests to Console Directory Watch. [ 7.287818] systemd[1]: Started Forward Password Requests to Wall Directory Watch. [ 8.148199] random: crng init done [ 8.151661] random: 7 urandom warning(s) missed due to ratelimiting [ 8.613147] EXT4-fs (mmcblk1p2): re-mounted. Opts: (null) [ 8.619572] ext4 filesystem being remounted at / supports timestamps until 2038 (0x7fffffff) [ 9.101979] systemd[297]: systemd-udevd.service: ProtectHostname=yes is configured, but the kernel does not support UTS namespaces, ignoring namespace setup. [ 9.267307] systemd-journald[279]: Received client request to flush runtime journal. [ 11.123314] input: gpio-buttons as /devices/soc0/gpio-buttons/input/input0 [ 11.127794] input: gpio-beeper as /devices/soc0/gpio-beeper/input/input1 [ 11.157434] mc: Linux media interface: v0.10 [ 11.172601] spi_imx 2008000.spi: can't get the TX DMA channel, error -517! [ 11.174915] spi_imx 2018000.spi: can't get the TX DMA channel, error -517! [ 11.176776] spi_imx 2008000.spi: can't get the TX DMA channel, error -517! [ 11.178815] spi_imx 2018000.spi: can't get the TX DMA channel, error -517! [ 11.219686] videodev: Linux video capture interface: v2.00 [ 11.401520] imx_media_common: module is from the staging directory, the quality is unknown, you have been warned. [ 11.457916] spi_imx 2008000.spi: can't get the TX DMA channel, error -517! [ 11.460009] spi_imx 2018000.spi: can't get the TX DMA channel, error -517! [ 11.470667] imx6_media: module is from the staging directory, the quality is unknown, you have been warned. [ 11.650219] fsl-ssi-dai 2028000.ssi: No cache defaults, reading back from HW [ 11.860185] spi_imx 2008000.spi: can't get the TX DMA channel, error -517! [ 11.869667] spi_imx 2018000.spi: can't get the TX DMA channel, error -517! [ 11.871503] fsl-ssi-dai 2028000.ssi: No cache defaults, reading back from HW [ 11.968879] spi spi0.0: spi_imx_setup: mode 0, 8 bpw, 50000000 hz [ 11.972130] spi_imx 2008000.spi: mx51_ecspi_clkdiv: fin: 60000000, fspi: 50000000, post: 0, pre: 1 [ 11.972637] spi_imx 2008000.spi: mx51_ecspi_clkdiv: fin: 60000000, fspi: 50000000, post: 0, pre: 1 [ 12.016379] spi-nor spi0.0: n25q128a13 [ 12.020443] spi-nor spi0.0: spi_nor_info_init_params: 03 [ 12.035872] spi_imx 2008000.spi: mx51_ecspi_clkdiv: fin: 60000000, fspi: 50000000, post: 0, pre: 1 [ 12.035951] spi_imx 2008000.spi: mx51_ecspi_clkdiv: fin: 60000000, fspi: 50000000, post: 0, pre: 1 [ 12.036037] spi_imx 2008000.spi: mx51_ecspi_clkdiv: fin: 60000000, fspi: 50000000, post: 0, pre: 1 [ 12.036102] spi_imx 2008000.spi: mx51_ecspi_clkdiv: fin: 60000000, fspi: 50000000, post: 0, pre: 1 [ 12.036459] spi-nor spi0.0: Header: 53 [ 12.040355] spi-nor spi0.0: Header: 46 [ 12.044198] spi-nor spi0.0: Header: 44 [ 12.073621] spi-nor spi0.0: Header: 50 [ 12.077592] spi-nor spi0.0: Header: 05 [ 12.081414] spi-nor spi0.0: Header: 01 [ 12.112231] spi-nor spi0.0: Header: 01 [ 12.134785] spi-nor spi0.0: Header: ff [ 12.139506] spi-nor spi0.0: Header: 00 [ 12.143317] spi-nor spi0.0: Header: 05 [ 12.159246] spi-nor spi0.0: Header: 01 [ 12.163108] spi-nor spi0.0: Header: 10 [ 12.184776] spi-nor spi0.0: Header: 30 [ 12.188615] spi-nor spi0.0: Header: 00 [ 12.221040] spi-nor spi0.0: Header: 00 [ 12.244702] spi-nor spi0.0: Header: ff [ 12.266541] spi_imx 2008000.spi: mx51_ecspi_clkdiv: fin: 60000000, fspi: 50000000, post: 0, pre: 1 [ 12.266706] spi_imx 2008000.spi: mx51_ecspi_clkdiv: fin: 60000000, fspi: 50000000, post: 0, pre: 1 [ 12.266788] spi_imx 2008000.spi: mx51_ecspi_clkdiv: fin: 60000000, fspi: 50000000, post: 0, pre: 1 [ 12.266866] spi_imx 2008000.spi: mx51_ecspi_clkdiv: fin: 60000000, fspi: 50000000, post: 0, pre: 1 [ 12.267190] spi-nor spi0.0: bfpt addr=30 len=40 [ 12.285142] spi_imx 2008000.spi: mx51_ecspi_clkdiv: fin: 60000000, fspi: 50000000, post: 0, pre: 1 [ 12.285246] spi_imx 2008000.spi: mx51_ecspi_clkdiv: fin: 60000000, fspi: 50000000, post: 0, pre: 1 [ 12.285534] spi_imx 2008000.spi: mx51_ecspi_clkdiv: fin: 60000000, fspi: 50000000, post: 0, pre: 1 [ 12.285658] spi_imx 2008000.spi: mx51_ecspi_clkdiv: fin: 60000000, fspi: 50000000, post: 0, pre: 1 [ 12.286591] spi-nor spi0.0: DMA transfer: -22 [ 12.286630] spi-nor spi0.0: Fallback to PIO mode [ 12.296534] spi-nor spi0.0: bfpt: e5 [ 12.314782] spi-nor spi0.0: bfpt: 20 [ 12.344792] spi-nor spi0.0: bfpt: f1 [ 12.348426] spi-nor spi0.0: bfpt: ff [ 12.352037] spi-nor spi0.0: bfpt: ff [ 12.397380] spi-nor spi0.0: bfpt: ff [ 12.416917] spi-nor spi0.0: bfpt: ff [ 12.420597] spi-nor spi0.0: bfpt: 07 [ 12.424267] spi-nor spi0.0: bfpt: 29 [ 12.442571] spi-nor spi0.0: bfpt: eb [ 12.458160] spi-nor spi0.0: bfpt: 27 [ 12.462405] Micrel KSZ9031 Gigabit PHY 2188000.ethernet-1:03: attached PHY driver [Micrel KSZ9031 Gigabit PHY] (mii_bus:phy_addr=2188000.ethernet-1:03, irq=104) [ 12.467943] spi-nor spi0.0: bfpt: 6b [ 12.510726] spi-nor spi0.0: bfpt: 27 [ 12.514394] spi-nor spi0.0: bfpt: 3b [ 12.518667] spi-nor spi0.0: bfpt: 27 [ 12.534799] spi-nor spi0.0: bfpt: bb [ 12.538425] spi-nor spi0.0: bfpt: ff [ 12.542035] spi-nor spi0.0: bfpt: ff [ 12.550887] imx6_media_csi: module is from the staging directory, the quality is unknown, you have been warned. [ 12.554781] spi-nor spi0.0: bfpt: ff [ 12.561370] imx6_media_csi: module is from the staging directory, the quality is unknown, you have been warned. [ 12.574772] spi-nor spi0.0: bfpt: ff [ 12.578560] spi-nor spi0.0: bfpt: ff [ 12.582176] spi-nor spi0.0: bfpt: ff [ 12.583566] imx6_media_csi: module is from the staging directory, the quality is unknown, you have been warned. [ 12.585889] spi-nor spi0.0: bfpt: 27 [ 12.585908] spi-nor spi0.0: bfpt: bb [ 12.585923] spi-nor spi0.0: bfpt: ff [ 12.585938] spi-nor spi0.0: bfpt: ff [ 12.585953] spi-nor spi0.0: bfpt: 29 [ 12.626081] imx6_media_csi: module is from the staging directory, the quality is unknown, you have been warned. [ 12.656095] ipu1_csi0: Registered ipu1_csi0 capture as /dev/video0 [ 12.675198] ipu1_ic_prpenc: Registered ipu1_ic_prpenc capture as /dev/video1 [ 12.683695] spi-nor spi0.0: bfpt: eb [ 12.687574] spi-nor spi0.0: bfpt: 0c [ 12.691231] spi-nor spi0.0: bfpt: 20 [ 12.705004] ipu1_ic_prpvf: Registered ipu1_ic_prpvf capture as /dev/video2 [ 12.712086] imx-media: ipu1_csi0:1 -> ipu1_ic_prp:0 [ 12.717491] spi-nor spi0.0: bfpt: 10 [ 12.721154] spi-nor spi0.0: bfpt: d8 [ 12.734691] spi-nor spi0.0: bfpt: 00 [ 12.738348] spi-nor spi0.0: bfpt: 00 [ 12.741995] spi-nor spi0.0: bfpt: 00 [ 12.745946] imx-media: ipu1_csi0:1 -> ipu1_vdic:0 [ 12.750739] imx-media: ipu1_vdic:2 -> ipu1_ic_prp:0 [ 12.764770] spi-nor spi0.0: bfpt: 00 [ 12.768433] spi-nor spi0.0: bfpt: 35 [ 12.772076] spi-nor spi0.0: bfpt: 8a [ 12.775953] imx-media: ipu1_ic_prp:1 -> ipu1_ic_prpenc:0 [ 12.781355] imx-media: ipu1_ic_prp:2 -> ipu1_ic_prpvf:0 [ 12.804725] spi-nor spi0.0: bfpt: 01 [ 12.808484] spi-nor spi0.0: bfpt: 00 [ 12.812131] spi-nor spi0.0: bfpt: 82 [ 12.816051] imx-media: subdev ipu1_csi0 bound [ 12.822311] ipu1_csi1: Registered ipu1_csi1 capture as /dev/video3 [ 12.844770] spi-nor spi0.0: bfpt: a3 [ 12.848570] imx-media: ipu1_csi1:1 -> ipu1_ic_prp:0 [ 12.853600] imx-media: ipu1_csi1:1 -> ipu1_vdic:0 [ 12.858512] spi-nor spi0.0: bfpt: 03 [ 12.862158] spi-nor spi0.0: bfpt: cb [ 12.865986] spi-nor spi0.0: bfpt: ac [ 12.869667] spi-nor spi0.0: bfpt: c1 [ 12.873309] spi-nor spi0.0: bfpt: 04 [ 12.877400] imx-media: subdev ipu1_csi1 bound [ 12.894954] ipu2_csi0: Registered ipu2_csi0 capture as /dev/video4 [ 12.902306] spi-nor spi0.0: bfpt: 2e [ 12.906067] spi-nor spi0.0: bfpt: 7a [ 12.909718] spi-nor spi0.0: bfpt: 75 [ 12.913391] spi-nor spi0.0: bfpt: 7a [ 12.922719] ipu2_ic_prpenc: Registered ipu2_ic_prpenc capture as /dev/video5 [ 12.936367] ipu2_ic_prpvf: Registered ipu2_ic_prpvf capture as /dev/video6 [ 12.943584] imx-media: ipu2_csi0:1 -> ipu2_ic_prp:0 [ 12.954793] spi-nor spi0.0: bfpt: 75 [ 12.958625] spi-nor spi0.0: bfpt: fb [ 12.962308] spi-nor spi0.0: bfpt: 00 [ 12.974773] imx-media: ipu2_csi0:1 -> ipu2_vdic:0 [ 12.994794] spi-nor spi0.0: bfpt: 00 [ 12.998462] spi-nor spi0.0: bfpt: 80 [ 13.002103] spi-nor spi0.0: bfpt: 08 [ 13.006025] imx-media: ipu2_vdic:2 -> ipu2_ic_prp:0 [ 13.010994] imx-media: ipu2_ic_prp:1 -> ipu2_ic_prpenc:0 [ 13.016510] spi-nor spi0.0: bfpt: 0f [ 13.020173] spi-nor spi0.0: bfpt: 82 [ 13.023833] spi-nor spi0.0: bfpt: ff [ 13.027699] imx-media: ipu2_ic_prp:2 -> ipu2_ic_prpvf:0 [ 13.032998] imx-media: subdev ipu2_csi0 bound [ 13.054705] spi-nor spi0.0: bfpt: 81 [ 13.058330] spi-nor spi0.0: bfpt: 3d [ 13.064247] ipu2_csi1: Registered ipu2_csi1 capture as /dev/video7 [ 13.071092] spi-nor spi0.0: bfpt: 00 [ 13.084715] imx-media: ipu2_csi1:1 -> ipu2_ic_prp:0 [ 13.089898] spi-nor spi0.0: bfpt: 00 [ 13.093519] spi-nor spi0.0: spi_nor_parse_bfpt: 03 [ 13.098731] imx-media: ipu2_csi1:1 -> ipu2_vdic:0 [ 13.103489] imx-media: subdev ipu2_csi1 bound [ 13.114805] spi-nor spi0.0: spi_nor_parse_bfpt: 0c [ 13.121796] spi-nor spi0.0: param headers: 03 [ 13.132542] spi-nor spi0.0: param headers: 00 [ 13.148607] spi-nor spi0.0: param headers: 01 [ 13.153245] spi-nor spi0.0: param headers: 02 [ 13.174355] spi-nor spi0.0: param headers: 00 [ 13.178882] spi-nor spi0.0: param headers: 01 [ 13.183279] spi-nor spi0.0: param headers: 00 [ 13.204795] spi-nor spi0.0: param headers: ff [ 13.224825] spi-nor spi0.0: has uniform erase [ 13.229237] spi-nor spi0.0: spi_nor_select_erase: 08 [ 13.234241] spi-nor spi0.0: n25q128a13 (16384 Kbytes) [ 13.316374] coda 2040000.vpu: Direct firmware load for vpu_fw_imx6q.bin failed with error -2 [ 13.331434] imx-sdma 20ec000.sdma: loaded firmware 3.5 [ 13.355143] coda 2040000.vpu: Using fallback firmware vpu/vpu_fw_imx6q.bin [ 13.383312] spi spi0.1: spi_imx_setup: mode 0, 8 bpw, 1000000 hz [ 13.414032] spi_imx 2008000.spi: probed [ 13.514940] spi spi4.0: spi_imx_setup: mode 0, 8 bpw, 1000000 hz [ 13.517232] spi_imx 2018000.spi: probed [ 13.680184] imx-tlv320aic32x4 sound: tlv320aic32x4-hifi <-> 2028000.ssi mapping ok [ 13.693001] coda 2040000.vpu: Firmware code revision: 570363 [ 13.715442] coda 2040000.vpu: Initialized CODA960. [ 13.720303] coda 2040000.vpu: Firmware version: 3.1.1 [ 13.746657] coda 2040000.vpu: encoder registered as video8 [ 13.757458] coda 2040000.vpu: decoder registered as video9 [ 14.365520] IPv6: ADDRCONF(NETDEV_CHANGE): can0: link becomes ready [ 14.373301] IPv6: ADDRCONF(NETDEV_CHANGE): can1: link becomes ready [ 14.473634] smsc95xx 2-1.1:1.0 eth1: link up, 100Mbps, full-duplex, lpa 0xC5E1