raspberrypi / linux

Kernel source tree for Raspberry Pi-provided kernel builds. Issues unrelated to the linux kernel should be posted on the community forum at https://forums.raspberrypi.com/
Other
11.15k stars 5k forks source link

Ureadahead Errors out with ENOENT #3838

Open marchom opened 4 years ago

marchom commented 4 years ago

When running ureadahead on Ubuntu it keeps erroring out.

Strace:

openat(3, "events/fs/do_sys_open/enable", O_RDWR|O_LARGEFILE) = -1 ENOENT (No such file or directory)
close(3)                                = 0
write(2, "ureadahead: Error while tracing:"..., 59ureadahead: Error while tracing: No such file or directory
) = 59
exit_group(5)                           = ?
+++ exited with 5 +++

To reproduce Run Ubuntu 18.04 with this kernel. sudo su strace /sbin/ureadahead

Expected behaviour events/fs/do_sys_open/enable and the 2 other events to be available.

Actual behaviour Add a clear and concise description of what actually happened.

System System Information

Raspberry Pi 4 Model B Rev 1.1 NAME="Ubuntu" VERSION="18.04.5 LTS (Bionic Beaver)" ID=ubuntu ID_LIKE=debian

cat: /etc/rpi-issue: No such file or directory

Linux server 5.4.61-v7l+ #1339 SMP Tue Sep 1 18:51:27 BST 2020 armv7l armv7l armv7l GNU/Linux Revision : b03111 Serial : 100000002a54c103 Model : Raspberry Pi 4 Model B Rev 1.1 VCHI initialization failed Throttled flag : VCHI initialization failed Camera :

Videocore information

VCHI initialization failed

VCHI initialization failed

Filesystem information

Filesystem 1K-blocks Used Available Use% Mounted on /dev/root 7048376 2815444 4216548 41% / devtmpfs 921880 0 921880 0% /dev tmpfs 955672 0 955672 0% /dev/shm tmpfs 955672 3828 951844 1% /run tmpfs 5120 0 5120 0% /run/lock tmpfs 955672 0 955672 0% /sys/fs/cgroup /dev/sda3 23158908 2142240 19817212 10% /mnt/data /dev/sda1 261868 35324 226544 14% /boot //10.0.1.6/sda1-ata-ST2000DM001-1ER1 1922727312 1922727312 0 100% /media/HDD01 tmpfs 191132 0 191132 0% /run/user/1000

Filename Type Size Used Priority /mnt/data/swapfile file 2097148 0 -2

Package version information

openbox: Installed: (none) lxpanel: Installed: (none) pcmanfm: Installed: (none)

Networking Information

eth0: flags=4163<UP,BROADCAST,RUNNING,MULTICAST> mtu 1500 inet x.x.x.x netmask x.x.x.x broadcast x.x.x.x inet6 y::y.y.y.y prefixlen 64 scopeid 0x20 ether m.m.m.m txqueuelen 1000 (Ethernet) RX packets 49144 bytes 10256926 (10.2 MB) RX errors 0 dropped 0 overruns 0 frame 0 TX packets 45414 bytes 10122855 (10.1 MB) TX errors 0 dropped 0 overruns 0 carrier 0 collisions 0

lo: flags=73<UP,LOOPBACK,RUNNING> mtu 65536 inet x.x.x.x netmask x.x.x.x inet6 ::1 prefixlen 128 scopeid 0x10 loop txqueuelen 1000 (Local Loopback) RX packets 2575 bytes 279047 (279.0 KB) RX errors 0 dropped 0 overruns 0 frame 0 TX packets 2575 bytes 279047 (279.0 KB) TX errors 0 dropped 0 overruns 0 carrier 0 collisions 0

tun0: flags=4305<UP,POINTOPOINT,RUNNING,NOARP,MULTICAST> mtu 1500 inet x.x.x.x netmask x.x.x.x destination x.x.x.x inet6 y::y.y.y.y prefixlen 64 scopeid 0x20 unspec 00-00-00-00-00-00-00-00-00-00-00-00-00-00-00-00 txqueuelen 100 (UNSPEC) RX packets 0 bytes 0 (0.0 B) RX errors 0 dropped 0 overruns 0 frame 0 TX packets 0 bytes 0 (0.0 B) TX errors 0 dropped 0 overruns 0 carrier 0 collisions 0

USB Information

/: Bus 02.Port 1: Dev 1, Class=root_hub, Driver=xhci_hcd/4p, 5000M | Port 1: Dev 2, If 0, Class=Mass Storage, Driver=usb-storage, 5000M /: Bus 01.Port 1: Dev 1, Class=root_hub, Driver=xhci_hcd/1p, 480M | Port 1: Dev 2, If 0, Class=Hub, Driver=hub/4p, 480M | Port 4: Dev 3, If 0, Class=Human Interface Device, Driver=usbhid, 12M | Port 4: Dev 3, If 1, Class=Human Interface Device, Driver=usbhid, 12M |__ Port 4: Dev 3, If 2, Class=Human Interface Device, Driver=usbhid, 12M

Display Information

Running Legacy framebuffer

utils/raspinfo/raspinfo: line 125: tvservice: command not found

config.txt

VCHI initialization failed VCHI initialization failed

cmdline.txt

coherent_pool=1M 8250.nr_uarts=0 snd_bcm2835.enable_compat_alsa=0 snd_bcm2835.enable_hdmi=1 snd_bcm2835.enable_headphones=1 bcm2708_fb.fbwidth=1360 bcm2708_fb.fbheight=768 bcm2708_fb.fbswap=1 smsc95xx.macaddr=DC:A6:32:13:70:76 vc_mem.mem_base=0x3eb00000 vc_mem.mem_size=0x3ff00000 net.ifnames=0 dwc_otg.lpm_enable=0 console=ttyS0,115200 console=tty1 root=/dev/sda2 rootfstype=ext4 elevator=deadline rootwait program_usb_timeout=1 panic=10 usb-storage.quirks=152d:0578:u genet.skip_umac_reset=n genet.force_reneg=y

raspi-gpio settings

utils/raspinfo/raspinfo: line 166: raspi-gpio: command not found

vcdbg log messages

[sudo] password for xxxxx: sudo: vcdbg: command not found

dmesg log

` [ 0.000000] Booting Linux on physical CPU 0x0 [ 0.000000] Linux version 5.4.61-v7l+ (dom@buildbot) (gcc version 4.9.3 (crosstool-NG crosstool-ng-1.22.0-88-g8460611)) #1339 SMP Tue Sep 1 18:51:27 BST 2020 [ 0.000000] CPU: ARMv7 Processor [410fd083] revision 3 (ARMv7), cr=30c5383d [ 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: Raspberry Pi 4 Model B Rev 1.1 [ 0.000000] Memory policy: Data cache writealloc [ 0.000000] Reserved memory: created CMA memory pool at 0x000000002ac00000, size 64 MiB [ 0.000000] OF: reserved mem: initialized node linux,cma, compatible id shared-dma-pool [ 0.000000] On node 0 totalpages: 504576 [ 0.000000] DMA zone: 2304 pages used for memmap [ 0.000000] DMA zone: 0 pages reserved [ 0.000000] DMA zone: 196608 pages, LIFO batch:63 [ 0.000000] HighMem zone: 307968 pages, LIFO batch:63 [ 0.000000] percpu: Embedded 20 pages/cpu s49920 r8192 d23808 u81920 [ 0.000000] pcpu-alloc: s49920 r8192 d23808 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: 502272 [ 0.000000] Kernel command line: coherent_pool=1M 8250.nr_uarts=0 snd_bcm2835.enable_compat_alsa=0 snd_bcm2835.enable_hdmi=1 snd_bcm2835.enable_headphones=1 bcm2708_fb.fbwidth=1360 bcm2708_fb.fbheight=768 bcm2708_fb.fbswap=1 smsc95xx.macaddr=m.m.m.m vc_mem.mem_base=0x3eb00000 vc_mem.mem_size=0x3ff00000 net.ifnames=0 dwc_otg.lpm_enable=0 console=ttyS0,115200 console=tty1 root=/dev/sda2 rootfstype=ext4 elevator=deadline rootwait program_usb_timeout=1 panic=10 usb-storage.quirks=152d:0578:u genet.skip_umac_reset=n genet.force_reneg=y [ 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] software IO TLB: mapped [mem 0x25400000-0x29400000] (64MB) [ 0.000000] Memory: 1843764K/2018304K available (10240K kernel code, 738K rwdata, 2808K rodata, 2048K init, 857K bss, 109004K reserved, 65536K cma-reserved, 1231872K highmem) [ 0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=4, Nodes=1 [ 0.000000] ftrace: allocating 31123 entries in 61 pages [ 0.000000] rcu: Hierarchical RCU implementation. [ 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] GIC: Using split EOI/Deactivate mode [ 0.000000] random: get_random_bytes called from start_kernel+0x344/0x520 with crng_init=0 [ 0.000008] sched_clock: 32 bits at 1000kHz, resolution 1000ns, wraps every 2147483647500ns [ 0.000032] clocksource: timer: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1911260446275 ns [ 0.000113] bcm2835: system timer (irq = 17) [ 0.000772] arch_timer: cp15 timer(s) running at 54.00MHz (phys). [ 0.000792] clocksource: arch_sys_counter: mask: 0xffffffffffffff max_cycles: 0xc743ce346, max_idle_ns: 440795203123 ns [ 0.000813] sched_clock: 56 bits at 54MHz, resolution 18ns, wraps every 4398046511102ns [ 0.000829] Switching to timer-based delay loop, resolution 18ns [ 0.001066] Console: colour dummy device 80x30 [ 0.001562] printk: console [tty1] enabled [ 0.001623] Calibrating delay loop (skipped), value calculated using timer frequency.. 108.00 BogoMIPS (lpj=540000) [ 0.001664] pid_max: default: 32768 minimum: 301 [ 0.001821] LSM: Security Framework initializing [ 0.002026] Mount-cache hash table entries: 2048 (order: 1, 8192 bytes, linear) [ 0.002067] Mountpoint-cache hash table entries: 2048 (order: 1, 8192 bytes, linear) [ 0.003252] Disabling memory control group subsystem [ 0.003387] CPU: Testing write buffer coherency: ok [ 0.003873] CPU0: thread -1, cpu 0, socket 0, mpidr 80000000 [ 0.004721] Setting up static identity map for 0x200000 - 0x20003c [ 0.004924] rcu: Hierarchical SRCU implementation. [ 0.005563] smp: Bringing up secondary CPUs ... [ 0.006616] CPU1: thread -1, cpu 1, socket 0, mpidr 80000001 [ 0.007788] CPU2: thread -1, cpu 2, socket 0, mpidr 80000002 [ 0.008902] CPU3: thread -1, cpu 3, socket 0, mpidr 80000003 [ 0.009047] smp: Brought up 1 node, 4 CPUs [ 0.009115] SMP: Total of 4 processors activated (432.00 BogoMIPS). [ 0.009140] CPU: All CPU(s) started in HYP mode. [ 0.009162] CPU: Virtualization extensions available. [ 0.009953] devtmpfs: initialized [ 0.023510] VFP support v0.3: implementor 41 architecture 3 part 40 variant 8 rev 0 [ 0.023774] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 19112604462750000 ns [ 0.023821] futex hash table entries: 1024 (order: 4, 65536 bytes, linear) [ 0.026148] pinctrl core: initialized pinctrl subsystem [ 0.027122] NET: Registered protocol family 16 [ 0.030969] DMA: preallocated 1024 KiB pool for atomic coherent allocations [ 0.031571] audit: initializing netlink subsys (disabled) [ 0.031818] audit: type=2000 audit(0.030:1): state=initialized audit_enabled=0 res=1 [ 0.033054] hw-breakpoint: found 5 (+1 reserved) breakpoint and 4 watchpoint registers. [ 0.033089] hw-breakpoint: maximum watchpoint size is 8 bytes. [ 0.033420] Serial: AMBA PL011 UART driver [ 0.036588] bcm2835-mbox fe00b880.mailbox: mailbox enabled [ 0.060833] raspberrypi-firmware soc:firmware: Attached to firmware from 2020-09-03 18:04, variant start [ 0.070849] raspberrypi-firmware soc:firmware: Firmware hash is 68206b4397629e1a0892db7a9156aed86525172f [ 0.124097] bcm2835-dma fe007000.dma: DMA legacy API manager, dmachans=0x1 [ 0.128500] vgaarb: loaded [ 0.128971] SCSI subsystem initialized [ 0.129197] usbcore: registered new interface driver usbfs [ 0.129280] usbcore: registered new interface driver hub [ 0.129413] usbcore: registered new device driver usb [ 0.129728] usb_phy_generic phy: phy supply vcc not found, using dummy regulator [ 0.131656] clocksource: Switched to clocksource arch_sys_counter [ 0.907991] VFS: Disk quotas dquot_6.6.0 [ 0.908101] VFS: Dquot-cache hash table entries: 1024 (order 0, 4096 bytes) [ 0.908271] FS-Cache: Loaded [ 0.908470] CacheFiles: Loaded [ 0.918301] thermal_sys: Registered thermal governor 'step_wise' [ 0.918654] NET: Registered protocol family 2 [ 0.919421] tcp_listen_portaddr_hash hash table entries: 512 (order: 0, 6144 bytes, linear) [ 0.919472] TCP established hash table entries: 8192 (order: 3, 32768 bytes, linear) [ 0.919565] TCP bind hash table entries: 8192 (order: 4, 65536 bytes, linear) [ 0.919653] TCP: Hash tables configured (established 8192 bind 8192) [ 0.919810] UDP hash table entries: 512 (order: 2, 16384 bytes, linear) [ 0.919859] UDP-Lite hash table entries: 512 (order: 2, 16384 bytes, linear) [ 0.920119] NET: Registered protocol family 1 [ 0.920805] RPC: Registered named UNIX socket transport module. [ 0.920834] RPC: Registered udp transport module. [ 0.920858] RPC: Registered tcp transport module. [ 0.920881] RPC: Registered tcp NFSv4.1 backchannel transport module. [ 0.920915] PCI: CLS 0 bytes, default 64 [ 0.923000] hw perfevents: enabled with armv7_cortex_a15 PMU driver, 7 counters available [ 0.925105] Initialise system trusted keyrings [ 0.925350] workingset: timestamp_bits=14 max_order=19 bucket_order=5 [ 0.936271] FS-Cache: Netfs 'nfs' registered for caching [ 0.936985] NFS: Registering the id_resolver key type [ 0.937037] Key type id_resolver registered [ 0.937061] Key type id_legacy registered [ 0.937095] nfs4filelayout_init: NFSv4 File Layout Driver Registering... [ 0.938202] Key type asymmetric registered [ 0.938229] Asymmetric key parser 'x509' registered [ 0.938410] bounce: pool size: 64 pages [ 0.938463] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 249) [ 0.938691] io scheduler mq-deadline registered [ 0.938719] io scheduler kyber registered [ 0.942404] brcm-pcie fd500000.pcie: host bridge /scb/pcie@7d500000 ranges: [ 0.942446] brcm-pcie fd500000.pcie: No bus range found for /scb/pcie@7d500000, using [bus 00-ff] [ 0.942529] brcm-pcie fd500000.pcie: MEM 0x0600000000..0x0603ffffff -> 0x00f8000000 [ 0.942613] brcm-pcie fd500000.pcie: IB MEM 0x0000000000..0x007fffffff -> 0x0000000000 [ 1.003775] brcm-pcie fd500000.pcie: link up, 5 GT/s x1 (SSC) [ 1.004115] brcm-pcie fd500000.pcie: PCI host bridge to bus 0000:00 [ 1.004148] pci_bus 0000:00: root bus resource [bus 00-ff] [ 1.004182] pci_bus 0000:00: root bus resource [mem 0x600000000-0x603ffffff] (bus address [0xf8000000-0xfbffffff]) [ 1.004257] pci 0000:00:00.0: [14e4:2711] type 01 class 0x060400 [ 1.004509] pci 0000:00:00.0: PME# supported from D0 D3hot [ 1.007844] PCI: bus0: Fast back to back transfers disabled [ 1.008079] pci 0000:01:00.0: [1106:3483] type 00 class 0x0c0330 [ 1.008237] pci 0000:01:00.0: reg 0x10: [mem 0x00000000-0x00000fff 64bit] [ 1.008635] pci 0000:01:00.0: PME# supported from D0 D3cold [ 1.012038] PCI: bus1: Fast back to back transfers disabled [ 1.012108] pci 0000:00:00.0: BAR 8: assigned [mem 0x600000000-0x6000fffff] [ 1.012145] pci 0000:01:00.0: BAR 0: assigned [mem 0x600000000-0x600000fff 64bit] [ 1.012242] pci 0000:00:00.0: PCI bridge to [bus 01] [ 1.012277] pci 0000:00:00.0: bridge window [mem 0x600000000-0x6000fffff] [ 1.012582] pcieport 0000:00:00.0: enabling device (0140 -> 0142) [ 1.012824] pcieport 0000:00:00.0: PME: Signaling with IRQ 53 [ 1.013205] pcieport 0000:00:00.0: AER: enabled with IRQ 53 [ 1.013537] pci 0000:01:00.0: enabling device (0140 -> 0142) [ 1.014203] bcm2708_fb soc:fb: FB found 1 display(s) [ 1.043704] Console: switching to colour frame buffer device 170x48 [ 1.049174] bcm2708_fb soc:fb: Registered framebuffer for display 0, size 1360x768 [ 1.055205] iproc-rng200 fe104000.rng: hwrng registered [ 1.055558] vc-mem: phys_addr:0x00000000 mem_base=0x3eb00000 mem_size:0x3ff00000(1023 MiB) [ 1.056256] vc-sm: Videocore shared memory driver [ 1.056816] gpiomem-bcm2835 fe200000.gpiomem: Initialised: Registers at 0xfe200000 [ 1.068882] brd: module loaded [ 1.081097] loop: module loaded [ 1.082554] Loading iSCSI transport class v2.0-870. [ 1.084517] libphy: Fixed MDIO Bus: probed [ 1.085140] bcmgenet fd580000.ethernet: failed to get enet clock [ 1.085221] bcmgenet fd580000.ethernet: GENET 5.0 EPHY: 0x0000 [ 1.085300] bcmgenet fd580000.ethernet: failed to get enet-wol clock [ 1.085383] bcmgenet fd580000.ethernet: failed to get enet-eee clock [ 1.101737] libphy: bcmgenet MII bus: probed [ 1.191758] unimac-mdio unimac-mdio.-19: Broadcom UniMAC MDIO bus [ 1.194548] usbcore: registered new interface driver r8152 [ 1.196380] usbcore: registered new interface driver lan78xx [ 1.198176] usbcore: registered new interface driver smsc95xx [ 1.200265] xhci_hcd 0000:01:00.0: xHCI Host Controller [ 1.202007] xhci_hcd 0000:01:00.0: new USB bus registered, assigned bus number 1 [ 1.205990] xhci_hcd 0000:01:00.0: hcc params 0x002841eb hci version 0x100 quirks 0x0000001000000890 [ 1.208983] usb usb1: New USB device found, idVendor=1d6b, idProduct=0002, bcdDevice= 5.04 [ 1.210727] usb usb1: New USB device strings: Mfr=3, Product=2, SerialNumber=1 [ 1.212510] usb usb1: Product: xHCI Host Controller [ 1.214229] usb usb1: Manufacturer: Linux 5.4.61-v7l+ xhci-hcd [ 1.215930] usb usb1: SerialNumber: 0000:01:00.0 [ 1.218218] hub 1-0:1.0: USB hub found [ 1.219988] hub 1-0:1.0: 1 port detected [ 1.222239] xhci_hcd 0000:01:00.0: xHCI Host Controller [ 1.223930] xhci_hcd 0000:01:00.0: new USB bus registered, assigned bus number 2 [ 1.225633] xhci_hcd 0000:01:00.0: Host supports USB 3.0 SuperSpeed [ 1.227787] usb usb2: New USB device found, idVendor=1d6b, idProduct=0003, bcdDevice= 5.04 [ 1.229503] usb usb2: New USB device strings: Mfr=3, Product=2, SerialNumber=1 [ 1.231234] usb usb2: Product: xHCI Host Controller [ 1.232971] usb usb2: Manufacturer: Linux 5.4.61-v7l+ xhci-hcd [ 1.234672] usb usb2: SerialNumber: 0000:01:00.0 [ 1.236909] hub 2-0:1.0: USB hub found [ 1.238644] hub 2-0:1.0: 4 ports detected [ 1.241780] dwc_otg: version 3.00a 10-AUG-2012 (platform bus) [ 1.243707] dwc_otg: FIQ enabled [ 1.243718] dwc_otg: NAK holdoff enabled [ 1.243730] dwc_otg: FIQ split-transaction FSM enabled [ 1.243744] Module dwc_common_port init [ 1.244167] usbcore: registered new interface driver uas [ 1.245951] usbcore: registered new interface driver usb-storage [ 1.247815] mousedev: PS/2 mouse device common for all mice [ 1.251423] bcm2835-wdt bcm2835-wdt: Broadcom BCM2835 watchdog timer [ 1.256429] sdhci: Secure Digital Host Controller Interface driver [ 1.258093] sdhci: Copyright(c) Pierre Ossman [ 1.260286] mmc-bcm2835 fe300000.mmcnr: could not get clk, deferring probe [ 1.262451] sdhci-pltfm: SDHCI platform and OF driver helper [ 1.267720] ledtrig-cpu: registered to indicate activity on CPUs [ 1.269633] hidraw: raw HID events driver (C) Jiri Kosina [ 1.271439] usbcore: registered new interface driver usbhid [ 1.273107] usbhid: USB HID core driver [ 1.275731] vchiq: vchiq_init_state: slot_zero = (ptrval)

[ 1.289020] [vc_sm_connected_init]: end - returning 0 [ 1.292572] Initializing XFRM netlink socket [ 1.294264] NET: Registered protocol family 17 [ 1.295989] Key type dns_resolver registered [ 1.298136] Registering SWP/SWPB emulation handler [ 1.300071] registered taskstats version 1 [ 1.301766] Loading compiled-in X.509 certificates [ 1.303916] Key type ._fscrypt registered [ 1.305560] Key type .fscrypt registered [ 1.317491] uart-pl011 fe201000.serial: cts_event_workaround enabled [ 1.319222] fe201000.serial: ttyAMA0 at MMIO 0xfe201000 (irq = 29, base_baud = 0) is a PL011 rev2 [ 1.326819] bcm2835-power bcm2835-power: Broadcom BCM2835 power domains driver [ 1.329434] mmc-bcm2835 fe300000.mmcnr: mmc_debug:0 mmc_debug2:0 [ 1.331099] mmc-bcm2835 fe300000.mmcnr: DMA channel allocated [ 1.384273] mmc1: queuing unknown CIS tuple 0x80 (2 bytes) [ 1.387586] mmc1: queuing unknown CIS tuple 0x80 (3 bytes) [ 1.390884] mmc1: queuing unknown CIS tuple 0x80 (3 bytes) [ 1.395499] mmc1: queuing unknown CIS tuple 0x80 (7 bytes) [ 1.398741] mmc1: queuing unknown CIS tuple 0x80 (3 bytes) [ 1.401688] mmc0: SDHCI controller on fe340000.emmc2 [fe340000.emmc2] using ADMA [ 1.406155] of_cfs_init [ 1.407969] of_cfs_init: OK [ 1.410624] Waiting for root device /dev/sda2... [ 1.441771] random: fast init done [ 1.468737] mmc1: new high speed SDIO card at address 0001 [ 1.591702] usb 1-1: new high-speed USB device number 2 using xhci_hcd [ 1.774274] usb 1-1: New USB device found, idVendor=2109, idProduct=3431, bcdDevice= 4.21 [ 1.775890] usb 1-1: New USB device strings: Mfr=0, Product=1, SerialNumber=0 [ 1.777494] usb 1-1: Product: USB2.0 Hub [ 1.780794] hub 1-1:1.0: USB hub found [ 1.782655] hub 1-1:1.0: 4 ports detected [ 1.922043] usb 2-1: new SuperSpeed Gen 1 USB device number 2 using xhci_hcd [ 1.953405] usb 2-1: New USB device found, idVendor=152d, idProduct=0578, bcdDevice= 2.04 [ 1.955024] usb 2-1: New USB device strings: Mfr=1, Product=2, SerialNumber=3 [ 1.956628] usb 2-1: Product: JMS579 [ 1.958199] usb 2-1: Manufacturer: JMicron [ 1.959748] usb 2-1: SerialNumber: 65240752140803128760 [ 1.964631] usb 2-1: UAS is blacklisted for this device, using usb-storage instead [ 1.966310] usb 2-1: UAS is blacklisted for this device, using usb-storage instead [ 1.967856] usb-storage 2-1:1.0: USB Mass Storage device detected [ 1.969890] usb-storage 2-1:1.0: Quirks match for vid 152d pid 0578: 1800000 [ 1.971610] scsi host0: usb-storage 2-1:1.0 [ 2.111697] usb 1-1.4: new full-speed USB device number 3 using xhci_hcd [ 2.252785] usb 1-1.4: New USB device found, idVendor=046d, idProduct=c52b, bcdDevice=12.03 [ 2.254415] usb 1-1.4: New USB device strings: Mfr=1, Product=2, SerialNumber=0 [ 2.256031] usb 1-1.4: Product: USB Receiver [ 2.257647] usb 1-1.4: Manufacturer: Logitech [ 2.271795] input: Logitech USB Receiver as /devices/platform/scb/fd500000.pcie/pci0000:00/0000:00:00.0/0000:01:00.0/usb1/1-1/1-1.4/1-1.4:1.0/0003:046D:C52B.0001/input/input0 [ 2.342538] hid-generic 0003:046D:C52B.0001: input,hidraw0: USB HID v1.11 Keyboard [Logitech USB Receiver] on usb-0000:01:00.0-1.4/input0 [ 2.355898] input: Logitech USB Receiver Mouse as /devices/platform/scb/fd500000.pcie/pci0000:00/0000:00:00.0/0000:01:00.0/usb1/1-1/1-1.4/1-1.4:1.1/0003:046D:C52B.0002/input/input1 [ 2.360339] input: Logitech USB Receiver Consumer Control as /devices/platform/scb/fd500000.pcie/pci0000:00/0000:00:00.0/0000:01:00.0/usb1/1-1/1-1.4/1-1.4:1.1/0003:046D:C52B.0002/input/input2 [ 2.431999] input: Logitech USB Receiver System Control as /devices/platform/scb/fd500000.pcie/pci0000:00/0000:00:00.0/0000:01:00.0/usb1/1-1/1-1.4/1-1.4:1.1/0003:046D:C52B.0002/input/input3 [ 2.436900] hid-generic 0003:046D:C52B.0002: input,hiddev96,hidraw1: USB HID v1.11 Mouse [Logitech USB Receiver] on usb-0000:01:00.0-1.4/input1 [ 2.447001] hid-generic 0003:046D:C52B.0003: hiddev97,hidraw2: USB HID v1.11 Device [Logitech USB Receiver] on usb-0000:01:00.0-1.4/input2 [ 3.032462] scsi 0:0:0:0: Direct-Access sobetter EXT 0204 PQ: 0 ANSI: 6 [ 3.035930] sd 0:0:0:0: [sda] 62533296 512-byte logical blocks: (32.0 GB/29.8 GiB) [ 3.039114] sd 0:0:0:0: [sda] Write Protect is off [ 3.041622] sd 0:0:0:0: [sda] Mode Sense: 47 00 00 08 [ 3.042372] sd 0:0:0:0: [sda] Disabling FUA [ 3.044855] sd 0:0:0:0: [sda] Write cache: enabled, read cache: enabled, doesn't support DPO or FUA [ 3.051442] sda: sda1 sda2 sda3 [ 3.057243] sd 0:0:0:0: [sda] Attached SCSI disk [ 3.066894] EXT4-fs (sda2): mounted filesystem with ordered data mode. Opts: (null) [ 3.069548] VFS: Mounted root (ext4 filesystem) readonly on device 8:2. [ 3.072654] devtmpfs: mounted [ 3.083334] Freeing unused kernel memory: 2048K [ 3.122006] Run /sbin/init as init process [ 3.282379] systemd[1]: System time before build time, advancing clock. [ 3.344491] NET: Registered protocol family 10 [ 3.348449] Segment Routing with IPv6 [ 3.371904] systemd[1]: systemd 237 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) [ 3.377901] systemd[1]: Detected architecture arm. [ 3.434267] systemd[1]: Set hostname to . [ 4.013841] random: systemd: uninitialized urandom read (16 bytes read) [ 4.017292] systemd[1]: Set up automount Arbitrary Executable File Formats File System Automount Point. [ 4.024168] random: systemd: uninitialized urandom read (16 bytes read) [ 4.027032] systemd[1]: Reached target System Time Synchronized. [ 4.033686] random: systemd: uninitialized urandom read (16 bytes read) [ 4.038823] systemd[1]: Created slice System Slice. [ 4.045809] systemd[1]: Listening on fsck to fsckd communication Socket. [ 4.052788] systemd[1]: Listening on udev Kernel Socket. [ 4.059176] systemd[1]: Listening on Syslog Socket. [ 4.065458] systemd[1]: Listening on Network Service Netlink Socket. [ 4.160566] EXT4-fs (sda2): re-mounted. Opts: (null) [ 4.316337] snd_bcm2835: module is from the staging directory, the quality is unknown, you have been warned. [ 4.336762] iscsi: registered transport (tcp) [ 4.703338] systemd-journald[126]: Received request to flush runtime journal from PID 1 [ 4.708655] systemd-journald[126]: File /var/log/journal/b4cb685b89b74378965027ec1164c459/system.journal corrupted or uncleanly shut down, renaming and replacing. [ 5.180673] rpivid-mem feb00000.hevc-decoder: rpivid-hevcmem initialised: Registers at 0xfeb00000 length 0x00010000 [ 5.181153] rpivid-mem feb10000.rpivid-local-intc: rpivid-intcmem initialised: Registers at 0xfeb10000 length 0x00001000 [ 5.181568] rpivid-mem feb20000.h264-decoder: rpivid-h264mem initialised: Registers at 0xfeb20000 length 0x00010000 [ 5.182112] rpivid-mem feb30000.vp9-decoder: rpivid-vp9mem initialised: Registers at 0xfeb30000 length 0x00010000 [ 5.285625] sd 0:0:0:0: Attached scsi generic sg0 type 0 [ 5.310022] vc_sm_cma: module is from the staging directory, the quality is unknown, you have been warned. [ 5.317557] bcm2835_vc_sm_cma_probe: Videocore shared memory driver

[ 5.322337] [vc_sm_connected_init]: installed successfully [ 5.336887] mc: Linux media interface: v0.10 [ 5.432388] videodev: Linux video capture interface: v2.00 [ 5.452804] bcm2835_mmal_vchiq: module is from the staging directory, the quality is unknown, you have been warned. [ 5.460839] bcm2835_isp: module is from the staging directory, the quality is unknown, you have been warned. [ 5.462174] bcm2835_codec: module is from the staging directory, the quality is unknown, you have been warned. [ 5.467181] bcm2835_v4l2: module is from the staging directory, the quality is unknown, you have been warned. [ 5.501917] bcm2835-codec bcm2835-codec: Device registered as /dev/video10 [ 5.501963] bcm2835-codec bcm2835-codec: Loaded V4L2 decode [ 5.502456] bcm2835-isp bcm2835-isp: Device node output[0] registered as /dev/video13 [ 5.503049] bcm2835-isp bcm2835-isp: Device node capture[0] registered as /dev/video14 [ 5.505280] bcm2835-isp bcm2835-isp: Device node capture[1] registered as /dev/video15 [ 5.514158] bcm2835-isp bcm2835-isp: Device node stats[2] registered as /dev/video16 [ 5.514188] bcm2835-isp bcm2835-isp: Register output node 0 with media controller [ 5.514215] bcm2835-isp bcm2835-isp: Register capture node 1 with media controller [ 5.514237] bcm2835-isp bcm2835-isp: Register capture node 2 with media controller [ 5.514261] bcm2835-isp bcm2835-isp: Register capture node 3 with media controller [ 5.514488] bcm2835-isp bcm2835-isp: Loaded V4L2 bcm2835-isp [ 5.517713] bcm2835-codec bcm2835-codec: Device registered as /dev/video11 [ 5.517767] bcm2835-codec bcm2835-codec: Loaded V4L2 encode [ 5.542481] bcm2835-codec bcm2835-codec: Device registered as /dev/video12 [ 5.542606] bcm2835-codec bcm2835-codec: Loaded V4L2 isp [ 5.625084] cfg80211: Loading compiled-in X.509 certificates for regulatory database [ 5.698745] cfg80211: Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7' [ 5.762025] brcmfmac: F1 signature read @0x18000000=0x15264345 [ 5.775175] brcmfmac: brcmf_fw_alloc_request: using brcm/brcmfmac43455-sdio for chip BCM4345/6 [ 5.778121] usbcore: registered new interface driver brcmfmac [ 5.977108] logitech-djreceiver 0003:046D:C52B.0003: hiddev96,hidraw0: USB HID v1.11 Device [Logitech USB Receiver] on usb-0000:01:00.0-1.4/input2 [ 5.980049] brcmfmac: brcmf_fw_alloc_request: using brcm/brcmfmac43455-sdio for chip BCM4345/6 [ 5.998997] brcmfmac: brcmf_c_preinit_dcmds: Firmware: BCM4345/6 wl0: Mar 1 2015 07:29:38 version 7.45.18 (r538002) FWID 01-6a2c8ad4 [ 6.118759] input: Logitech Unifying Device. Wireless PID:4002 Keyboard as /devices/platform/scb/fd500000.pcie/pci0000:00/0000:00:00.0/0000:01:00.0/usb1/1-1/1-1.4/1-1.4:1.2/0003:046D:C52B.0003/0003:046D:4002.0004/input/input5 [ 6.120015] input: Logitech Unifying Device. Wireless PID:4002 Consumer Control as /devices/platform/scb/fd500000.pcie/pci0000:00/0000:00:00.0/0000:01:00.0/usb1/1-1/1-1.4/1-1.4:1.2/0003:046D:C52B.0003/0003:046D:4002.0004/input/input6 [ 6.120395] input: Logitech Unifying Device. Wireless PID:4002 System Control as /devices/platform/scb/fd500000.pcie/pci0000:00/0000:00:00.0/0000:01:00.0/usb1/1-1/1-1.4/1-1.4:1.2/0003:046D:C52B.0003/0003:046D:4002.0004/input/input7 [ 6.120796] hid-generic 0003:046D:4002.0004: input,hidraw1: USB HID v1.11 Keyboard [Logitech Unifying Device. Wireless PID:4002] on usb-0000:01:00.0-1.4/input2:1 [ 6.256287] EXT4-fs (sda3): mounted filesystem with ordered data mode. Opts: (null) [ 7.062136] Adding 2097148k swap on /mnt/data/swapfile. Priority:-2 extents:4 across:2244604k FS [ 7.076636] bcmgenet fd580000.ethernet: configuring instance for external RGMII [ 7.076990] bcmgenet fd580000.ethernet eth0: Link is Up - 1Gbps/Full - flow control rx/tx [ 7.077917] IPv6: ADDRCONF(NETDEV_CHANGE): eth0: link becomes ready [ 7.268574] input: Logitech K750 as /devices/platform/scb/fd500000.pcie/pci0000:00/0000:00:00.0/0000:01:00.0/usb1/1-1/1-1.4/1-1.4:1.2/0003:046D:C52B.0003/0003:046D:4002.0004/input/input11 [ 7.278752] logitech-hidpp-device 0003:046D:4002.0004: input,hidraw1: USB HID v1.11 Keyboard [Logitech K750] on usb-0000:01:00.0-1.4/input2:1 [ 7.369505] new mount options do not match the existing superblock, will be ignored [ 7.395151] fuse: init (API version 7.31) [ 7.548734] uart-pl011 fe201000.serial: no DMA platform data [ 7.597790] random: crng init done [ 7.597805] random: 7 urandom warning(s) missed due to ratelimiting [ 7.644601] Bluetooth: Core ver 2.22 [ 7.644691] NET: Registered protocol family 31 [ 7.644702] Bluetooth: HCI device and connection manager initialized [ 7.644729] Bluetooth: HCI socket layer initialized [ 7.644747] Bluetooth: L2CAP socket layer initialized [ 7.644776] Bluetooth: SCO socket layer initialized [ 7.658821] Bluetooth: HCI UART driver ver 2.3 [ 7.658858] Bluetooth: HCI UART protocol H4 registered [ 7.658967] Bluetooth: HCI UART protocol Three-wire (H5) registered [ 7.659298] Bluetooth: HCI UART protocol Broadcom registered [ 7.918152] Bluetooth: BNEP (Ethernet Emulation) ver 1.3 [ 7.918171] Bluetooth: BNEP filters: protocol multicast [ 7.918203] Bluetooth: BNEP socket layer initialized [ 8.642831] FS-Cache: Netfs 'cifs' registered for caching [ 8.651724] Key type cifs.spnego registered [ 8.651755] Key type cifs.idmap registered [ 8.652939] CIFS: Attempting to mount //10.0.1.6/sda1-ata-ST2000DM001-1ER1 [ 8.733075] tun: Universal TUN/TAP device driver, 1.6 [ 12.649790] bcmgenet fd580000.ethernet eth0: Link is Down [ 15.912122] CIFS VFS: Error connecting to socket. Aborting operation. [ 15.918786] CIFS VFS: cifs_mount failed w/return code = -2 [ 17.511917] bcmgenet fd580000.ethernet eth0: Link is Up - 1Gbps/Full - flow control rx/tx [ 17.644495] CIFS: Attempting to mount //10.0.1.6/sda1-ata-ST2000DM001-1ER1 [ 17.852983] CIFS: Attempting to mount //10.0.1.6/sda1-ata-ST2000DM001-1ER1 [ 17.993275] FS-Cache: Duplicate cookie detected [ 17.993325] FS-Cache: O-cookie c=6a44f907 [p=ac058af1 fl=222 nc=0 na=1] [ 17.993360] FS-Cache: O-cookie d=cde84cbe n=541d3106 [ 17.993387] FS-Cache: O-key=[8] '020001bd0a000106' [ 17.993426] FS-Cache: N-cookie c=173d3cbc [p=ac058af1 fl=2 nc=0 na=1] [ 17.993460] FS-Cache: N-cookie d=cde84cbe n=f1029bb4 [ 17.993488] FS-Cache: N-key=[8] '020001bd0a000106' [ 31.832063] vcc-sd: disabling [ 4974.777176] nf_conntrack: default automatic helper assignment has been turned off for security reasons and CT-based firewall rule not found. Use the iptables CT target to attach helpers instead. [ 5991.167718] CIFS VFS: \10.0.1.6 Cancelling wait for mid 97 cmd: 14 [ 5991.170839] CIFS VFS: Close unmatched open [ 5991.171049] CIFS VFS: Close unmatched open [ 5991.171388] CIFS VFS: Close unmatched open [ 5991.171741] CIFS VFS: Close unmatched open

EEPROM

BCM2711 detected Dedicated VL805 EEPROM detected BOOTLOADER: up-to-date CURRENT: Fri Jul 31 13:43:39 UTC 2020 (1596203019) LATEST: Fri Jul 31 13:43:39 UTC 2020 (1596203019) FW DIR: /lib/firmware/raspberrypi/bootloader/stable VL805: up-to-date CURRENT: 000138a1 LATEST: 000138a1 `

Logs `

journalctl -e | grep ureadahead

Sep 05 23:21:24 server ureadahead[115]: ureadahead: Error while tracing: No such file or directory Sep 05 23:21:37 server systemd[1]: Started Stop ureadahead data collection 45s after completed startup. Sep 05 23:22:22 server systemd[1]: Starting Stop ureadahead data collection... Sep 05 23:22:22 server systemd[1]: Started Stop ureadahead data collection. Sep 06 01:09:11 server polkitd(authority=local)[5319]: Operator of unix-process:5314:644408 successfully authenticated as unix-user:xxxx to gain ONE-SHOT authorization for action org.freedesktop.systemd1.manage-units for system-bus-name::1.86 [systemctl start ureadahead] (owned by unix-user:marcho) Sep 06 01:09:11 server ureadahead[5327]: ureadahead: Error while tracing: No such file or directory Sep 06 01:09:11 server systemd[1]: ureadahead.service: Main process exited, code=exited, status=5/NOTINSTALLED Sep 06 01:09:11 server systemd[1]: ureadahead.service: Failed with result 'exit-code'. `

Additional context Created PR: #3837 adapted from: patch

marchom commented 4 years ago

3837