Boots (a few screens of messages) but fails to run first boot user setup.
There appears to be some confusion about the output display (HDMI connection) though it worked through u-boot and beyond the switch to framebuffer for additional line output.
Journalctl output (from the 2016.10.18 nightly) is available at:
http://ryniker.org/Fedora/arm/
with the tail of the journal (1315 lines) at:
http://ryniker.org/Fedora/arm/pi-2016.10.18-journal_4-end
Most obvious suspicious messages:
Oct 20 12:27:01 localhost.localdomain gnome-shell[1068]: JS ERROR: TypeError: this.primaryMonitor is undefined LayoutManager<._updateBoxes@resource:///org/gnome/shell/ui/layout.js:461 wrapper@resource:///org/gnome/gjs/modules/lang.js:178 LayoutManager<._monitorsChanged@resource:///org/gnome/shell/ui/layout.js:495 wrapper@resource:///org/gnome/gjs/modules/lang.js:178 LayoutManager<._init@resource:///org/gnome/shell/ui/layout.js:277 wrapper@resource:///org/gnome/gjs/modules/lang.js:178 _Base.prototype._construct@resource:///org/gnome/gjs/modules/lang.js:110 Class.prototype._construct/newClass@resource:///org/gnome/gjs/modules/lang.js:213 _initializeUI@resource:///org/gnome/shell/ui/main.js:151 start@resource:///org/gnome/shell/ui/main.js:125 @<main>:1 Oct 20 12:27:01 localhost.localdomain gnome-shell[1068]: Execution of main.js threw exception: JS_EvaluateScript() failed Oct 20 12:27:01 localhost.localdomain gnome-session[999]: gnome-session-binary[999]: WARNING: App 'setup-shell.desktop' exited with code 1 Oct 20 12:27:01 localhost.localdomain gnome-session-binary[999]: WARNING: App 'setup-shell.desktop' exited with code 1
but I also wonder about multiple earlier messages that say:
Oct 20 12:26:56 localhost.localdomain kernel: i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100
On Thu, Oct 20, 2016 at 8:01 PM, Richard Ryniker ryniker@alum.mit.edu wrote:
Boots (a few screens of messages) but fails to run first boot user setup.
There appears to be some confusion about the output display (HDMI connection) though it worked through u-boot and beyond the switch to framebuffer for additional line output.
Journalctl output (from the 2016.10.18 nightly) is available at:
http://ryniker.org/Fedora/arm/
with the tail of the journal (1315 lines) at:
Can you just provide the output of dmesg?
Most obvious suspicious messages:
Oct 20 12:27:01 localhost.localdomain gnome-shell[1068]: JS ERROR: TypeError: this.primaryMonitor is undefined LayoutManager<._updateBoxes@resource:///org/gnome/shell/ui/layout.js:461 wrapper@resource:///org/gnome/gjs/modules/lang.js:178 LayoutManager<._monitorsChanged@resource:///org/gnome/shell/ui/layout.js:495 wrapper@resource:///org/gnome/gjs/modules/lang.js:178 LayoutManager<._init@resource:///org/gnome/shell/ui/layout.js:277 wrapper@resource:///org/gnome/gjs/modules/lang.js:178 _Base.prototype._construct@resource:///org/gnome/gjs/modules/lang.js:110 Class.prototype._construct/newClass@resource:///org/gnome/gjs/modules/lang.js:213 _initializeUI@resource:///org/gnome/shell/ui/main.js:151 start@resource:///org/gnome/shell/ui/main.js:125 @<main>:1 Oct 20 12:27:01 localhost.localdomain gnome-shell[1068]: Execution of main.js threw exception: JS_EvaluateScript() failed Oct 20 12:27:01 localhost.localdomain gnome-session[999]: gnome-session-binary[999]: WARNING: App 'setup-shell.desktop' exited with code 1 Oct 20 12:27:01 localhost.localdomain gnome-session-binary[999]: WARNING: App 'setup-shell.desktop' exited with code 1
but I also wonder about multiple earlier messages that say:
Oct 20 12:26:56 localhost.localdomain kernel: i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100
Just spurious messages and can be ignored.
Peter Robinson pbrobinson@gmail.com wrote on Sat, 22 Oct 2016 15:18:00:
Can you just provide the output of dmesg?
Yes, below, but it was a chore. How does one execute dmesg when there is no accessible user? The system boots far enough to initialize the Ethernet connection, and sshd is active, but all of the defined users have no (or unknown) passwords. There are very good reasons for this, I agree with them, it just makes strange cases like mine more difficult.
Failed solution 1: edit /etc/passwd to allow login without a password. Either sshd or login is unhappy and forbids login.
Failed solution 2: use pwunconv on another machine. Did not work (I do not know why; probably some configuration parameter.) pwunconv did not complain; it simply did nothing.
Working solution 3: manually add a new user to /etc/passwd and /etc/shadow with a real password. Add this user to /etc/sudoers. Now sshd is happy, and remote login can acquire root privilege.
With this capability, I performed a dnf upgrade (On October 22) to install the latest X server and the newest kernel.
The original problem continues: post-installation user setup (gdm?) fails - dark screen. This is an intriguing problem, because I would expect the Raspberry Pi to be a far less variable environment that other machines that have many different BIOS and hardware configurations. For RPi 3, just plug in an HDMI cable and go...
My RPi board is functional: it boots Raspbian without problem.
I do not see any smoking gun in the dmesg output, but I do not have an example of F25 working that might direct attention to something different in this case.
-bash-4.3$ dmesg [ 0.000000] Booting Linux on physical CPU 0x0 [ 0.000000] Linux version 4.8.3-300.fc25.armv7hl (mockbuild@arm04-builder05.arm.fedoraproject.org) (gcc version 6.2.1 20160916 (Red Hat 6.2.1-2) (GCC) ) #1 SMP Thu Oct 20 16:49:07 UTC 2016 [ 0.000000] CPU: ARMv7 Processor [410fd034] revision 4 (ARMv7), cr=10c5383d [ 0.000000] CPU: div instructions available: patching division code [ 0.000000] CPU: PIPT / VIPT nonaliasing data cache, VIPT aliasing instruction cache [ 0.000000] OF: fdt:Machine model: Raspberry Pi 3 Model B [ 0.000000] efi: Getting EFI parameters from FDT: [ 0.000000] efi: UEFI not found. [ 0.000000] cma: Reserved 256 MiB at 0x20000000 [ 0.000000] Memory policy: Data cache writealloc [ 0.000000] On node 0 totalpages: 253952 [ 0.000000] free_area_init_node: node 0, pgdat c0e66b00, node_mem_map df6c1000 [ 0.000000] Normal zone: 1728 pages used for memmap [ 0.000000] Normal zone: 0 pages reserved [ 0.000000] Normal zone: 196608 pages, LIFO batch:31 [ 0.000000] HighMem zone: 57344 pages, LIFO batch:15 [ 0.000000] percpu: Embedded 15 pages/cpu @df67a000 s31500 r8192 d21748 u61440 [ 0.000000] pcpu-alloc: s31500 r8192 d21748 u61440 alloc=15*4096 [ 0.000000] pcpu-alloc: [0] 0 [0] 1 [0] 2 [0] 3 [ 0.000000] Built 1 zonelists in Zone order, mobility grouping on. Total pages: 252224 [ 0.000000] Kernel command line: ro root=UUID=6ce3f499-c222-4d7b-a3d6-a0a4e28340a5 cma=192MB cma=256MB LANG=en_US.UTF-8 [ 0.000000] PID hash table entries: 4096 (order: 2, 16384 bytes) [ 0.000000] Dentry cache hash table entries: 131072 (order: 7, 524288 bytes) [ 0.000000] Inode-cache hash table entries: 65536 (order: 6, 262144 bytes) [ 0.000000] Memory: 715000K/1015808K available (7032K kernel code, 1092K rwdata, 3288K rodata, 1160K init, 853K bss, 38664K reserved, 262144K cma-reserved, 229376K highmem) [ 0.000000] Virtual kernel memory layout: vector : 0xffff0000 - 0xffff1000 ( 4 kB) fixmap : 0xffc00000 - 0xfff00000 (3072 kB) vmalloc : 0xf0800000 - 0xff800000 ( 240 MB) lowmem : 0xc0000000 - 0xf0000000 ( 768 MB) pkmap : 0xbfe00000 - 0xc0000000 ( 2 MB) modules : 0xbf000000 - 0xbfe00000 ( 14 MB) .text : 0xc0208000 - 0xc08e62b4 (7033 kB) .init : 0xc0c56000 - 0xc0d78000 (1160 kB) .data : 0xc0d78000 - 0xc0e89104 (1093 kB) .bss : 0xc0e89104 - 0xc0f5e6b0 ( 854 kB) [ 0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=4, Nodes=1 [ 0.000000] Hierarchical RCU implementation. [ 0.000000] Build-time adjustment of leaf fanout to 32. [ 0.000000] RCU restricting CPUs from NR_CPUS=32 to nr_cpu_ids=4. [ 0.000000] RCU: Adjusting geometry for rcu_fanout_leaf=32, nr_cpu_ids=4 [ 0.000000] NR_IRQS:16 nr_irqs:16 16 [ 0.000017] sched_clock: 32 bits at 1000kHz, resolution 1000ns, wraps every 2147483647500ns [ 0.000044] clocksource: timer: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1911260446275 ns [ 0.000122] bcm2835: system timer (irq = 33) [ 0.001393] arm_arch_timer: WARNING: Invalid trigger for IRQ16, assuming level low [ 0.001403] arm_arch_timer: WARNING: Please fix your firmware [ 0.001418] arm_arch_timer: WARNING: Invalid trigger for IRQ17, assuming level low [ 0.001426] arm_arch_timer: WARNING: Please fix your firmware [ 0.001556] arm_arch_timer: Architected cp15 timer(s) running at 19.20MHz (phys). [ 0.001576] clocksource: arch_sys_counter: mask: 0xffffffffffffff max_cycles: 0x46d987e47, max_idle_ns: 440795202767 ns [ 0.001597] sched_clock: 56 bits at 19MHz, resolution 52ns, wraps every 4398046511078ns [ 0.001615] Switching to timer-based delay loop, resolution 52ns [ 0.002079] Console: colour dummy device 80x30 [ 0.003727] console [tty0] enabled [ 0.003815] Calibrating delay loop (skipped), value calculated using timer frequency.. 38.40 BogoMIPS (lpj=96000) [ 0.003901] pid_max: default: 32768 minimum: 301 [ 0.004426] Security Framework initialized [ 0.004475] Yama: becoming mindful. [ 0.004538] SELinux: Initializing. [ 0.004830] SELinux: Starting in permissive mode [ 0.005217] Mount-cache hash table entries: 2048 (order: 1, 8192 bytes) [ 0.005271] Mountpoint-cache hash table entries: 2048 (order: 1, 8192 bytes) [ 0.006903] CPU: Testing write buffer coherency: ok [ 0.006987] ftrace: allocating 30363 entries in 60 pages [ 0.099158] CPU0: thread -1, cpu 0, socket 0, mpidr 80000000 [ 0.099303] Setting up static identity map for 0x208280 - 0x208318 [ 0.105259] EFI services will not be available. [ 0.106508] arm_arch_timer: WARNING: Invalid trigger for IRQ16, assuming level low [ 0.106512] arm_arch_timer: WARNING: Please fix your firmware [ 0.106521] arm_arch_timer: WARNING: Invalid trigger for IRQ17, assuming level low [ 0.106523] arm_arch_timer: WARNING: Please fix your firmware [ 0.106543] CPU1: thread -1, cpu 1, socket 0, mpidr 80000001 [ 0.107356] arm_arch_timer: WARNING: Invalid trigger for IRQ16, assuming level low [ 0.107359] arm_arch_timer: WARNING: Please fix your firmware [ 0.107365] arm_arch_timer: WARNING: Invalid trigger for IRQ17, assuming level low [ 0.107368] arm_arch_timer: WARNING: Please fix your firmware [ 0.107381] CPU2: thread -1, cpu 2, socket 0, mpidr 80000002 [ 0.108115] arm_arch_timer: WARNING: Invalid trigger for IRQ16, assuming level low [ 0.108119] arm_arch_timer: WARNING: Please fix your firmware [ 0.108124] arm_arch_timer: WARNING: Invalid trigger for IRQ17, assuming level low [ 0.108126] arm_arch_timer: WARNING: Please fix your firmware [ 0.108139] CPU3: thread -1, cpu 3, socket 0, mpidr 80000003 [ 0.108230] Brought up 4 CPUs [ 0.108946] SMP: Total of 4 processors activated (153.60 BogoMIPS). [ 0.108984] CPU: All CPU(s) started in HYP mode. [ 0.109019] CPU: Virtualization extensions available. [ 0.110502] devtmpfs: initialized [ 0.115711] VFP support v0.3: implementor 41 architecture 3 part 40 variant 3 rev 4 [ 0.116155] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 9556302231375000 ns [ 0.128249] atomic64_test: passed [ 0.128398] pinctrl core: initialized pinctrl subsystem [ 0.129985] NET: Registered protocol family 16 [ 0.131671] DMA: preallocated 256 KiB pool for atomic coherent allocations [ 0.148661] cpuidle: using governor menu [ 0.148951] No ATAGs? [ 0.148986] hw-breakpoint: found 5 (+1 reserved) breakpoint and 4 watchpoint registers. [ 0.149071] hw-breakpoint: maximum watchpoint size is 8 bytes. [ 0.149898] Serial: AMBA PL011 UART driver [ 0.193390] vgaarb: loaded [ 0.194407] SCSI subsystem initialized [ 0.194625] libata version 3.00 loaded. [ 0.194994] usbcore: registered new interface driver usbfs [ 0.195120] usbcore: registered new interface driver hub [ 0.195263] usbcore: registered new device driver usb [ 0.196910] NetLabel: Initializing [ 0.196947] NetLabel: domain hash size = 128 [ 0.196982] NetLabel: protocols = UNLABELED CIPSOv4 [ 0.197095] NetLabel: unlabeled traffic allowed by default [ 0.197516] clocksource: Switched to clocksource arch_sys_counter [ 0.258438] VFS: Disk quotas dquot_6.6.0 [ 0.258594] VFS: Dquot-cache hash table entries: 1024 (order 0, 4096 bytes) [ 0.259166] simple-framebuffer 3e699000.framebuffer: framebuffer at 0x3e699000, 0x35d540 bytes, mapped to 0xf0880000 [ 0.259242] simple-framebuffer 3e699000.framebuffer: format=r5g6b5, mode=1680x1050x16, linelength=3360 [ 0.284792] Console: switching to colour frame buffer device 210x65 [ 0.308468] simple-framebuffer 3e699000.framebuffer: fb0: simplefb registered! [ 0.323002] NET: Registered protocol family 2 [ 0.324259] TCP established hash table entries: 8192 (order: 3, 32768 bytes) [ 0.324554] TCP bind hash table entries: 8192 (order: 4, 65536 bytes) [ 0.324892] TCP: Hash tables configured (established 8192 bind 8192) [ 0.325145] UDP hash table entries: 512 (order: 2, 16384 bytes) [ 0.325329] UDP-Lite hash table entries: 512 (order: 2, 16384 bytes) [ 0.325885] NET: Registered protocol family 1 [ 0.326028] PCI: CLS 0 bytes, default 64 [ 0.326479] Unpacking initramfs... [ 1.829906] Freeing initrd memory: 14444K (c2100000 - c2f1b000) [ 1.838173] futex hash table entries: 1024 (order: 4, 65536 bytes) [ 1.838490] audit: initializing netlink subsys (disabled) [ 1.838735] audit: type=2000 audit(1.779:1): initialized [ 1.839528] Initialise system trusted keyrings [ 1.840068] workingset: timestamp_bits=14 max_order=18 bucket_order=4 [ 1.852189] zbud: loaded [ 1.856462] Key type big_key registered [ 1.856566] SELinux: Registering netfilter hooks [ 2.387179] NET: Registered protocol family 38 [ 2.387330] Key type asymmetric registered [ 2.387436] Asymmetric key parser 'x509' registered [ 2.387723] bounce: pool size: 64 pages [ 2.388223] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 250) [ 2.388547] io scheduler noop registered [ 2.388652] io scheduler deadline registered [ 2.389134] io scheduler cfq registered (default) [ 2.395486] pci_hotplug: PCI Hot Plug PCI Core version: 0.5 [ 2.395672] pciehp: PCI Express Hot Plug Controller Driver version: 0.4 [ 2.398439] Serial: 8250/16550 driver, 32 ports, IRQ sharing enabled [ 2.409352] bcm2835-aux-uart 3f215040.serial: could not get clk: -517 [ 2.409983] Serial: AMBA driver [ 2.417035] msm_serial: driver initialized [ 2.426185] libphy: Fixed MDIO Bus: probed [ 2.432845] ehci_hcd: USB 2.0 'Enhanced' Host Controller (EHCI) Driver [ 2.439177] ehci-pci: EHCI PCI platform driver [ 2.445535] ohci_hcd: USB 1.1 'Open' Host Controller (OHCI) Driver [ 2.451876] ohci-pci: OHCI PCI platform driver [ 2.458214] uhci_hcd: USB Universal Host Controller Interface driver [ 2.464871] usbcore: registered new interface driver usbserial [ 2.471263] usbcore: registered new interface driver usbserial_generic [ 2.477590] usbserial: USB Serial support registered for generic [ 2.484071] mousedev: PS/2 mouse device common for all mice [ 2.492903] device-mapper: uevent: version 1.0.3 [ 2.499646] device-mapper: ioctl: 4.35.0-ioctl (2016-06-23) initialised: dm-devel@redhat.com [ 2.506691] ledtrig-cpu: registered to indicate activity on CPUs [ 2.513316] hidraw: raw HID events driver (C) Jiri Kosina [ 2.519965] usbcore: registered new interface driver usbhid [ 2.526406] usbhid: USB HID core driver [ 2.535803] bcm2835-mbox 3f00b880.mailbox: mailbox enabled [ 2.543146] drop_monitor: Initializing network drop monitor service [ 2.550079] ip_tables: (C) 2000-2006 Netfilter Core Team [ 2.556784] Initializing XFRM netlink socket [ 2.564648] NET: Registered protocol family 10 [ 2.572716] mip6: Mobile IPv6 [ 2.579233] NET: Registered protocol family 17 [ 2.585919] Registering SWP/SWPB emulation handler [ 2.593342] registered taskstats version 1 [ 2.599733] Loading compiled-in X.509 certificates [ 2.618709] alg: No test for pkcs1pad(rsa,sha256) (pkcs1pad(rsa-generic,sha256)) [ 2.634747] Loaded X.509 cert 'Fedora kernel signing key: 1eb05d5db80ed03f8d40e0d4dbb9aa020b646a42' [ 2.641408] zswap: loaded using pool lzo/zbud [ 2.758587] 3f201000.serial: ttyAMA0 at MMIO 0x3f201000 (irq = 87, base_baud = 0) is a PL011 rev2 [ 2.767027] 3f215040.serial: ttyS0 at MMIO 0x0 (irq = 59, base_baud = 31224999) is a 16550 [ 2.774465] raspberrypi-firmware soc:firmware: Attached to firmware from 2016-09-13 17:02 [ 2.781492] hctosys: unable to open rtc device (rtc0) [ 2.788363] sr_init: No PMIC hook to init smartreflex [ 2.794954] sr_init: platform driver register failed for SR [ 2.805270] PM: Hibernation image not present or could not be loaded. [ 2.808805] Freeing unused kernel memory: 1160K (c0c56000 - c0d78000) [ 2.815337] This architecture does not have kernel memory protection. [ 2.850698] systemd[1]: System time before build time, advancing clock. [ 2.863671] random: systemd: uninitialized urandom read (16 bytes read) [ 2.871938] random: systemd: uninitialized urandom read (16 bytes read) [ 2.904935] systemd[1]: systemd 231 running in system mode. (+PAM +AUDIT +SELINUX +IMA -APPARMOR +SMACK +SYSVINIT +UTMP +LIBCRYPTSETUP +GCRYPT +GNUTLS +ACL +XZ +LZ4 +SECCOMP +BLKID +ELFUTILS +KMOD +IDN) [ 2.912668] systemd[1]: Detected architecture arm. [ 2.919648] systemd[1]: Running in initial RAM disk. [ 2.949126] systemd[1]: No hostname configured. [ 2.956171] systemd[1]: Set hostname to <localhost>. [ 3.265019] random: systemd: uninitialized urandom read (16 bytes read) [ 3.272459] random: systemd: uninitialized urandom read (16 bytes read) [ 3.279946] random: systemd: uninitialized urandom read (16 bytes read) [ 3.292244] random: systemd: uninitialized urandom read (16 bytes read) [ 3.302687] random: systemd: uninitialized urandom read (16 bytes read) [ 3.309838] random: systemd: uninitialized urandom read (16 bytes read) [ 3.318019] random: systemd: uninitialized urandom read (16 bytes read) [ 3.334002] random: systemd: uninitialized urandom read (16 bytes read) [ 3.369527] systemd[1]: Listening on Journal Socket (/dev/log). [ 3.384082] systemd[1]: Listening on Journal Audit Socket. [ 3.398218] systemd[1]: Listening on udev Control Socket. [ 3.412167] systemd[1]: Reached target Swap. [ 3.425965] systemd[1]: Reached target Timers. [ 3.675929] audit: type=1130 audit(1469476187.819:2): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-journald comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 3.704051] audit: type=1130 audit(1469476187.849:3): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=kmod-static-nodes comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 3.733209] audit: type=1130 audit(1469476187.879:4): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-sysctl comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 3.801434] audit: type=1130 audit(1469476187.944:5): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-tmpfiles-setup-dev comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 4.143887] audit: type=1130 audit(1469476188.289:6): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-vconsole-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 4.175892] audit: type=1130 audit(1469476188.319:7): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-cmdline comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 4.437205] audit: type=1130 audit(1469476188.579:8): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-udev comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 4.524527] audit: type=1130 audit(1469476188.669:9): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-udevd comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 4.916974] audit: type=1130 audit(1469476189.059:10): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-udev-trigger comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 4.970000] i2c-bcm2835 3f805000.i2c: Could not read clock-frequency property [ 5.028818] sdhci: Secure Digital Host Controller Interface driver [ 5.040080] sdhci: Copyright(c) Pierre Ossman [ 5.052348] sdhci-pltfm: SDHCI platform and OF driver helper [ 5.107780] mmc0: SDHCI controller on 3f300000.sdhci [3f300000.sdhci] using PIO [ 5.155553] mmc0: new SDHC card at address 0001 [ 5.214385] mmcblk0: mmc0:0001 00000 29.8 GiB [ 5.230199] mmcblk0: p1 p2 p3 p4 [ 5.255274] random: fast init done [ 6.117152] random: crng init done [ 8.641661] audit_printk_skb: 6 callbacks suppressed [ 8.653615] audit: type=1130 audit(1469476192.784:13): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-fsck-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 8.841345] EXT4-fs (mmcblk0p4): mounted filesystem with ordered data mode. Opts: (null) [ 9.570905] audit: type=1130 audit(1469476193.714:14): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-parse-etc comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 9.571031] audit: type=1131 audit(1469476193.714:15): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-parse-etc comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 10.086919] audit: type=1130 audit(1469476194.229:16): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-pivot comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 10.212377] audit: type=1130 audit(1469476194.354:17): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-cleanup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 10.212499] audit: type=1131 audit(1469476194.354:18): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-cleanup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 10.270316] audit: type=1131 audit(1469476194.414:19): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-pivot comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 10.333161] audit: type=1130 audit(1469476194.479:20): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-initqueue comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 10.357968] audit: type=1131 audit(1469476194.504:21): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-initqueue comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 10.479928] audit: type=1130 audit(1469476194.624:22): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-udev-trigger comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 10.809937] systemd-journald[164]: Received SIGTERM from PID 1 (systemd). [ 10.960229] systemd: 12 output lines suppressed due to ratelimiting [ 12.128549] SELinux: 32768 avtab hash slots, 106608 rules. [ 12.275707] SELinux: 32768 avtab hash slots, 106608 rules. [ 12.671865] SELinux: 8 users, 14 roles, 5063 types, 305 bools, 1 sens, 1024 cats [ 12.671882] SELinux: 94 classes, 106608 rules [ 12.707116] SELinux: Permission validate_trans in class security not defined in policy. [ 12.717895] SELinux: Permission module_load in class system not defined in policy. [ 12.729363] SELinux: the above unknown classes and permissions will be allowed [ 12.740167] SELinux: Completing initialization. [ 12.740170] SELinux: Setting up existing superblocks. [ 12.819226] systemd[1]: Successfully loaded SELinux policy in 1.115132s. [ 13.238140] systemd[1]: Relabelled /dev and /run in 182.550ms. [ 14.720378] audit_printk_skb: 57 callbacks suppressed [ 14.730805] audit: type=1130 audit(1469476198.864:42): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=systemd-journald comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 14.751844] audit: type=1131 audit(1469476198.894:43): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=systemd-journald comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 14.776696] audit: type=1130 audit(1469476198.919:44): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=initrd-switch-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 14.776817] audit: type=1131 audit(1469476198.919:45): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=initrd-switch-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 14.822335] audit: type=1130 audit(1469476198.964:46): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=systemd-journald comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 14.822454] audit: type=1131 audit(1469476198.964:47): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=systemd-journald comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 14.950382] audit: type=1305 audit(1469476199.094:48): audit_enabled=1 old=1 auid=4294967295 ses=4294967295 subj=system_u:system_r:syslogd_t:s0 res=1 [ 15.098910] audit: type=1130 audit(1469476199.244:49): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=systemd-fsck-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 15.121875] audit: type=1131 audit(1469476199.269:50): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=systemd-fsck-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 15.371038] RPC: Registered named UNIX socket transport module. [ 15.382544] RPC: Registered udp transport module. [ 15.382557] RPC: Registered tcp transport module. [ 15.382561] RPC: Registered tcp NFSv4.1 backchannel transport module. [ 15.442159] audit: type=1130 audit(1469476199.584:51): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=systemd-journald comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 15.482495] EXT4-fs (mmcblk0p4): re-mounted. Opts: (null) [ 15.715778] Installing knfsd (copyright (C) 1996 okir@monad.swb.de). [ 15.912836] systemd-journald[409]: Received request to flush runtime journal from PID 1 [ 16.160745] systemd-journald[409]: File /var/log/journal/3dad117e20a544249d4fa3919c15f9ac/system.journal corrupted or uncleanly shut down, renaming and replacing. [ 17.847110] bcm2835-wdt 3f100000.watchdog: Broadcom BCM2835 watchdog timer [ 18.699263] [drm] Initialized drm 1.1.0 20060810 [ 18.785895] bcm2835-rng 3f104000.rng: hwrng registered [ 18.842662] 3f980000.usb supply vusb_d not found, using dummy regulator [ 18.876823] 3f980000.usb supply vusb_a not found, using dummy regulator [ 18.899346] EXT4-fs (mmcblk0p2): mounting ext3 file system using the ext4 subsystem [ 18.954948] EXT4-fs (mmcblk0p2): recovery complete [ 18.964074] EXT4-fs (mmcblk0p2): mounted filesystem with ordered data mode. Opts: (null) [ 19.170453] dwc2 3f980000.usb: Specified GNPTXFDEP=1024 > 256 [ 19.170496] dwc2 3f980000.usb: EPs: 8, dedicated fifos, 4080 entries in SPRAM [ 19.203396] dwc2 3f980000.usb: DWC OTG Controller [ 19.204696] dwc2 3f980000.usb: new USB bus registered, assigned bus number 1 [ 19.204881] dwc2 3f980000.usb: irq 39, io mem 0x00000000 [ 19.205160] usb usb1: New USB device found, idVendor=1d6b, idProduct=0002 [ 19.205169] usb usb1: New USB device strings: Mfr=3, Product=2, SerialNumber=1 [ 19.205176] usb usb1: Product: DWC OTG Controller [ 19.205184] usb usb1: Manufacturer: Linux 4.8.3-300.fc25.armv7hl dwc2_hsotg [ 19.205190] usb usb1: SerialNumber: 3f980000.usb [ 19.210964] hub 1-0:1.0: USB hub found [ 19.211013] hub 1-0:1.0: 1 port detected [ 19.242559] vc4-drm soc:gpu: bound 3f902000.hdmi (ops vc4_hdmi_ops [vc4]) [ 19.248401] vc4-drm soc:gpu: bound 3f400000.hvs (ops vc4_hvs_ops [vc4]) [ 19.248726] vc4-drm soc:gpu: bound 3f206000.pixelvalve (ops vc4_crtc_ops [vc4]) [ 19.248936] vc4-drm soc:gpu: bound 3f207000.pixelvalve (ops vc4_crtc_ops [vc4]) [ 19.249130] vc4-drm soc:gpu: bound 3f807000.pixelvalve (ops vc4_crtc_ops [vc4]) [ 19.249244] vc4-drm soc:gpu: bound 3fc00000.v3d (ops vc4_v3d_ops [vc4]) [ 19.249255] checking generic (3e699000 35d540) vs hw (0 ffffffff) [ 19.249258] fb: switching to vc4drmfb from simple [ 19.268501] Adding 499708k swap on /dev/mmcblk0p3. Priority:-1 extents:1 across:499708k SSFS [ 19.395958] Console: switching to colour dummy device 80x30 [ 19.399231] [drm] Supports vblank timestamp caching Rev 2 (21.10.2013). [ 19.399292] [drm] Driver supports precise vblank timestamp query. [ 19.399576] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 19.399772] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 19.399967] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 19.400171] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 19.400370] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 19.400440] vc4-drm soc:gpu: No connectors reported connected with modes [ 19.400504] [drm] Cannot find any crtc or sizes - going 1024x768 [ 19.409368] Console: switching to colour frame buffer device 128x48 [ 19.439839] vc4-drm soc:gpu: fb0: frame buffer device [ 19.627883] usb 1-1: new high-speed USB device number 2 using dwc2 [ 19.832957] usb 1-1: New USB device found, idVendor=0424, idProduct=9514 [ 19.833249] usb 1-1: New USB device strings: Mfr=0, Product=0, SerialNumber=0 [ 19.834949] hub 1-1:1.0: USB hub found [ 19.835208] hub 1-1:1.0: 5 ports detected [ 19.905878] audit_printk_skb: 51 callbacks suppressed [ 19.906093] audit: type=1130 audit(1469476204.049:69): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=systemd-tmpfiles-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 20.147927] usb 1-1.1: new high-speed USB device number 3 using dwc2 [ 20.264031] usb 1-1.1: New USB device found, idVendor=0424, idProduct=ec00 [ 20.272020] usb 1-1.1: New USB device strings: Mfr=0, Product=0, SerialNumber=0 [ 20.353396] audit: type=1305 audit(1469476204.499:70): audit_enabled=1 old=1 auid=4294967295 ses=4294967295 subj=system_u:system_r:auditd_t:s0 res=1 [ 20.370906] audit: type=1305 audit(1469476204.514:71): audit_pid=513 old=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:auditd_t:s0 res=1 [ 20.393673] usb 1-1.5: new full-speed USB device number 4 using dwc2 [ 20.510819] usb 1-1.5: New USB device found, idVendor=046d, idProduct=c52b [ 20.527040] usb 1-1.5: New USB device strings: Mfr=1, Product=2, SerialNumber=0 [ 20.536040] usb 1-1.5: Product: USB Receiver [ 20.536048] usb 1-1.5: Manufacturer: Logitech [ 20.622401] smsc95xx v1.0.4 [ 20.707480] smsc95xx 1-1.1:1.0 eth0: register 'smsc95xx' at usb-3f980000.usb-1.1, smsc95xx USB 2.0 Ethernet, b8:27:eb:dd:7f:d3 [ 20.726226] usbcore: registered new interface driver smsc95xx [ 20.738276] logitech-djreceiver 0003:046D:C52B.0003: hiddev0,hidraw0: USB HID v1.11 Device [Logitech USB Receiver] on usb-3f980000.usb-1.5/input2 [ 20.919282] input: Logitech K360 as /devices/platform/soc/3f980000.usb/usb1/1-1/1-1.5/1-1.5:1.2/0003:046D:C52B.0003/0003:046D:4004.0004/input/input0 [ 20.921162] logitech-hidpp-device 0003:046D:4004.0004: input,hidraw1: USB HID v1.11 Keyboard [Logitech K360] on usb-3f980000.usb-1.5:1 [ 20.926741] input: Logitech Anywhere MX as /devices/platform/soc/3f980000.usb/usb1/1-1/1-1.5/1-1.5:1.2/0003:046D:C52B.0003/0003:046D:1017.0005/input/input1 [ 20.927901] logitech-hidpp-device 0003:046D:1017.0005: input,hidraw2: USB HID v1.11 Mouse [Logitech Anywhere MX] on usb-3f980000.usb-1.5:2 [ 29.652818] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 29.669353] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 29.678056] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 29.686652] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 29.695116] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 29.703532] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 29.712026] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 29.720460] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 29.728781] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 29.736771] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 30.157705] ip6_tables: (C) 2000-2006 Netfilter Core Team [ 30.528170] Ebtables v2.0 registered [ 30.656108] nf_conntrack version 0.5.0 (16384 buckets, 65536 max) [ 31.703202] bridge: automatic filtering via arp/ip/ip6tables has been deprecated. Update your scripts to load br_netfilter if you need this. [ 32.021471] Netfilter messages via NETLINK v0.30. [ 32.087915] ip_set: protocol 6 [ 33.193115] IPv6: ADDRCONF(NETDEV_UP): eth0: link is not ready [ 33.272344] smsc95xx 1-1.1:1.0 eth0: hardware isn't capable of remote wakeup [ 34.803225] smsc95xx 1-1.1:1.0 eth0: link up, 100Mbps, full-duplex, lpa 0xC5E1 [ 39.892841] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 39.893233] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 39.893609] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 39.893985] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 39.894372] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 50.135774] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 50.136166] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 50.136548] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 50.136916] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 50.137286] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 60.375829] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 60.376219] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 60.376601] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 60.376969] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 60.377337] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 70.615896] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 70.616290] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 70.616665] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 70.617036] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 70.617407] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 80.855948] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 80.856345] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 80.856720] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 80.857090] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 80.857458] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 91.096008] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 91.096392] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 91.096766] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 91.097141] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 91.097519] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 -bash-4.3$
On Mon, Oct 24, 2016 at 9:00 PM, Richard Ryniker ryniker@alum.mit.edu wrote:
Peter Robinson pbrobinson@gmail.com wrote on Sat, 22 Oct 2016 15:18:00:
Can you just provide the output of dmesg?
Yes, below, but it was a chore. How does one execute dmesg when there is no accessible user? The system boots far enough to initialize the Ethernet connection, and sshd is active, but all of the defined users have no (or unknown) passwords. There are very good reasons for this, I agree with them, it just makes strange cases like mine more difficult.
Failed solution 1: edit /etc/passwd to allow login without a password. Either sshd or login is unhappy and forbids login.
Updating the /etc/shadow line for root to add a known password hash is all I usually do and it has worked in the past.
There's a new 4.8.4-301.fc25 kernel that I think should fix this issue so you can grab that from koji [1] or it'll be going out to updates-testing probably today and should be stable by the end of the week.
Also for reference what is the monitor, the type of connector used and the resolution it runs at?
Peter
[1] http://koji.fedoraproject.org/koji/buildinfo?buildID=812331
Peter Robinson pbrobinson@gmail.com on Tue, 25 Oct 2016 10:23:13 wrote:
There's a new 4.8.4-301.fc25 kernel that I think should fix this issue
No improvement with this new kernel. I set default to multi-user.target in an attempt to avoid any X11 confusion. After several screens of boot messages scroll past, the display goes dark (no loss of input signal - the monitor would report that.)
Display device is Viewsonic model VX2235wm (native resolution 1680x1050) with DVI-D input connected to my RPi HDMI port.
Is this kernel supposed to avoid the "i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100" messages that clutter dmesg and the journal?
I have not tried to perform any direct measurement, but the time when the display goes dark seems to be near 27 seconds when these messages first appear.
dmesg output:
[ 0.000000] Booting Linux on physical CPU 0x0 [ 0.000000] Linux version 4.8.4-301.fc25.armv7hl (mockbuild@arm04-builder06.arm.fedoraproject.org) (gcc version 6.2.1 20160916 (Red Hat 6.2.1-2) (GCC) ) #1 SMP Tue Oct 25 02:01:39 UTC 2016 [ 0.000000] CPU: ARMv7 Processor [410fd034] revision 4 (ARMv7), cr=10c5383d [ 0.000000] CPU: div instructions available: patching division code [ 0.000000] CPU: PIPT / VIPT nonaliasing data cache, VIPT aliasing instruction cache [ 0.000000] OF: fdt:Machine model: Raspberry Pi 3 Model B [ 0.000000] efi: Getting EFI parameters from FDT: [ 0.000000] efi: UEFI not found. [ 0.000000] cma: Reserved 256 MiB at 0x20000000 [ 0.000000] Memory policy: Data cache writealloc [ 0.000000] On node 0 totalpages: 253952 [ 0.000000] free_area_init_node: node 0, pgdat c0e66b80, node_mem_map df6c1000 [ 0.000000] Normal zone: 1728 pages used for memmap [ 0.000000] Normal zone: 0 pages reserved [ 0.000000] Normal zone: 196608 pages, LIFO batch:31 [ 0.000000] HighMem zone: 57344 pages, LIFO batch:15 [ 0.000000] percpu: Embedded 15 pages/cpu @df67a000 s31500 r8192 d21748 u61440 [ 0.000000] pcpu-alloc: s31500 r8192 d21748 u61440 alloc=15*4096 [ 0.000000] pcpu-alloc: [0] 0 [0] 1 [0] 2 [0] 3 [ 0.000000] Built 1 zonelists in Zone order, mobility grouping on. Total pages: 252224 [ 0.000000] Kernel command line: ro root=UUID=6ce3f499-c222-4d7b-a3d6-a0a4e28340a5 cma=192MB cma=256MB LANG=en_US.UTF-8 [ 0.000000] PID hash table entries: 4096 (order: 2, 16384 bytes) [ 0.000000] Dentry cache hash table entries: 131072 (order: 7, 524288 bytes) [ 0.000000] Inode-cache hash table entries: 65536 (order: 6, 262144 bytes) [ 0.000000] Memory: 715032K/1015808K available (7032K kernel code, 1092K rwdata, 3288K rodata, 1160K init, 853K bss, 38632K reserved, 262144K cma-reserved, 229376K highmem) [ 0.000000] Virtual kernel memory layout: vector : 0xffff0000 - 0xffff1000 ( 4 kB) fixmap : 0xffc00000 - 0xfff00000 (3072 kB) vmalloc : 0xf0800000 - 0xff800000 ( 240 MB) lowmem : 0xc0000000 - 0xf0000000 ( 768 MB) pkmap : 0xbfe00000 - 0xc0000000 ( 2 MB) modules : 0xbf000000 - 0xbfe00000 ( 14 MB) .text : 0xc0208000 - 0xc08e6534 (7034 kB) .init : 0xc0c56000 - 0xc0d78000 (1160 kB) .data : 0xc0d78000 - 0xc0e89184 (1093 kB) .bss : 0xc0e89184 - 0xc0f5e730 ( 854 kB) [ 0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=4, Nodes=1 [ 0.000000] Hierarchical RCU implementation. [ 0.000000] Build-time adjustment of leaf fanout to 32. [ 0.000000] RCU restricting CPUs from NR_CPUS=32 to nr_cpu_ids=4. [ 0.000000] RCU: Adjusting geometry for rcu_fanout_leaf=32, nr_cpu_ids=4 [ 0.000000] NR_IRQS:16 nr_irqs:16 16 [ 0.000016] sched_clock: 32 bits at 1000kHz, resolution 1000ns, wraps every 2147483647500ns [ 0.000040] clocksource: timer: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1911260446275 ns [ 0.000122] bcm2835: system timer (irq = 33) [ 0.001390] arm_arch_timer: WARNING: Invalid trigger for IRQ16, assuming level low [ 0.001400] arm_arch_timer: WARNING: Please fix your firmware [ 0.001415] arm_arch_timer: WARNING: Invalid trigger for IRQ17, assuming level low [ 0.001424] arm_arch_timer: WARNING: Please fix your firmware [ 0.001555] arm_arch_timer: Architected cp15 timer(s) running at 19.20MHz (phys). [ 0.001575] clocksource: arch_sys_counter: mask: 0xffffffffffffff max_cycles: 0x46d987e47, max_idle_ns: 440795202767 ns [ 0.001597] sched_clock: 56 bits at 19MHz, resolution 52ns, wraps every 4398046511078ns [ 0.001614] Switching to timer-based delay loop, resolution 52ns [ 0.002080] Console: colour dummy device 80x30 [ 0.003737] console [tty0] enabled [ 0.003827] Calibrating delay loop (skipped), value calculated using timer frequency.. 38.40 BogoMIPS (lpj=96000) [ 0.003914] pid_max: default: 32768 minimum: 301 [ 0.004440] Security Framework initialized [ 0.004487] Yama: becoming mindful. [ 0.004549] SELinux: Initializing. [ 0.004841] SELinux: Starting in permissive mode [ 0.005225] Mount-cache hash table entries: 2048 (order: 1, 8192 bytes) [ 0.005279] Mountpoint-cache hash table entries: 2048 (order: 1, 8192 bytes) [ 0.006903] CPU: Testing write buffer coherency: ok [ 0.006988] ftrace: allocating 30365 entries in 60 pages [ 0.098482] CPU0: thread -1, cpu 0, socket 0, mpidr 80000000 [ 0.098618] Setting up static identity map for 0x208280 - 0x208318 [ 0.104454] EFI services will not be available. [ 0.105715] arm_arch_timer: WARNING: Invalid trigger for IRQ16, assuming level low [ 0.105718] arm_arch_timer: WARNING: Please fix your firmware [ 0.105727] arm_arch_timer: WARNING: Invalid trigger for IRQ17, assuming level low [ 0.105730] arm_arch_timer: WARNING: Please fix your firmware [ 0.105749] CPU1: thread -1, cpu 1, socket 0, mpidr 80000001 [ 0.106567] arm_arch_timer: WARNING: Invalid trigger for IRQ16, assuming level low [ 0.106571] arm_arch_timer: WARNING: Please fix your firmware [ 0.106576] arm_arch_timer: WARNING: Invalid trigger for IRQ17, assuming level low [ 0.106579] arm_arch_timer: WARNING: Please fix your firmware [ 0.106592] CPU2: thread -1, cpu 2, socket 0, mpidr 80000002 [ 0.107337] arm_arch_timer: WARNING: Invalid trigger for IRQ16, assuming level low [ 0.107340] arm_arch_timer: WARNING: Please fix your firmware [ 0.107346] arm_arch_timer: WARNING: Invalid trigger for IRQ17, assuming level low [ 0.107349] arm_arch_timer: WARNING: Please fix your firmware [ 0.107361] CPU3: thread -1, cpu 3, socket 0, mpidr 80000003 [ 0.107454] Brought up 4 CPUs [ 0.108167] SMP: Total of 4 processors activated (153.60 BogoMIPS). [ 0.108205] CPU: All CPU(s) started in HYP mode. [ 0.108239] CPU: Virtualization extensions available. [ 0.109727] devtmpfs: initialized [ 0.114910] VFP support v0.3: implementor 41 architecture 3 part 40 variant 3 rev 4 [ 0.115357] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 9556302231375000 ns [ 0.127440] atomic64_test: passed [ 0.127586] pinctrl core: initialized pinctrl subsystem [ 0.129165] NET: Registered protocol family 16 [ 0.130841] DMA: preallocated 256 KiB pool for atomic coherent allocations [ 0.143002] cpuidle: using governor menu [ 0.143289] No ATAGs? [ 0.143324] hw-breakpoint: found 5 (+1 reserved) breakpoint and 4 watchpoint registers. [ 0.143409] hw-breakpoint: maximum watchpoint size is 8 bytes. [ 0.144233] Serial: AMBA PL011 UART driver [ 0.182716] vgaarb: loaded [ 0.183714] SCSI subsystem initialized [ 0.183928] libata version 3.00 loaded. [ 0.184293] usbcore: registered new interface driver usbfs [ 0.184418] usbcore: registered new interface driver hub [ 0.184562] usbcore: registered new device driver usb [ 0.186203] NetLabel: Initializing [ 0.186240] NetLabel: domain hash size = 128 [ 0.186275] NetLabel: protocols = UNLABELED CIPSOv4 [ 0.186386] NetLabel: unlabeled traffic allowed by default [ 0.186792] clocksource: Switched to clocksource arch_sys_counter [ 0.248420] VFS: Disk quotas dquot_6.6.0 [ 0.248575] VFS: Dquot-cache hash table entries: 1024 (order 0, 4096 bytes) [ 0.249137] simple-framebuffer 3e699000.framebuffer: framebuffer at 0x3e699000, 0x35d540 bytes, mapped to 0xf0880000 [ 0.249212] simple-framebuffer 3e699000.framebuffer: format=r5g6b5, mode=1680x1050x16, linelength=3360 [ 0.274771] Console: switching to colour frame buffer device 210x65 [ 0.298449] simple-framebuffer 3e699000.framebuffer: fb0: simplefb registered! [ 0.312947] NET: Registered protocol family 2 [ 0.314205] TCP established hash table entries: 8192 (order: 3, 32768 bytes) [ 0.314503] TCP bind hash table entries: 8192 (order: 4, 65536 bytes) [ 0.314841] TCP: Hash tables configured (established 8192 bind 8192) [ 0.315096] UDP hash table entries: 512 (order: 2, 16384 bytes) [ 0.315280] UDP-Lite hash table entries: 512 (order: 2, 16384 bytes) [ 0.315838] NET: Registered protocol family 1 [ 0.315980] PCI: CLS 0 bytes, default 64 [ 0.316433] Unpacking initramfs... [ 1.813829] Freeing initrd memory: 14412K (c2100000 - c2f13000) [ 1.822145] futex hash table entries: 1024 (order: 4, 65536 bytes) [ 1.822461] audit: initializing netlink subsys (disabled) [ 1.822662] audit: type=2000 audit(1.764:1): initialized [ 1.823410] Initialise system trusted keyrings [ 1.823940] workingset: timestamp_bits=14 max_order=18 bucket_order=4 [ 1.835996] zbud: loaded [ 1.840306] Key type big_key registered [ 1.840411] SELinux: Registering netfilter hooks [ 2.369025] NET: Registered protocol family 38 [ 2.369176] Key type asymmetric registered [ 2.369283] Asymmetric key parser 'x509' registered [ 2.369508] bounce: pool size: 64 pages [ 2.370000] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 250) [ 2.370322] io scheduler noop registered [ 2.370426] io scheduler deadline registered [ 2.370903] io scheduler cfq registered (default) [ 2.377313] pci_hotplug: PCI Hot Plug PCI Core version: 0.5 [ 2.377500] pciehp: PCI Express Hot Plug Controller Driver version: 0.4 [ 2.380220] Serial: 8250/16550 driver, 32 ports, IRQ sharing enabled [ 2.391178] bcm2835-aux-uart 3f215040.serial: could not get clk: -517 [ 2.391832] Serial: AMBA driver [ 2.398856] msm_serial: driver initialized [ 2.408036] libphy: Fixed MDIO Bus: probed [ 2.414670] ehci_hcd: USB 2.0 'Enhanced' Host Controller (EHCI) Driver [ 2.421003] ehci-pci: EHCI PCI platform driver [ 2.427361] ohci_hcd: USB 1.1 'Open' Host Controller (OHCI) Driver [ 2.433700] ohci-pci: OHCI PCI platform driver [ 2.440031] uhci_hcd: USB Universal Host Controller Interface driver [ 2.446663] usbcore: registered new interface driver usbserial [ 2.453050] usbcore: registered new interface driver usbserial_generic [ 2.459353] usbserial: USB Serial support registered for generic [ 2.465818] mousedev: PS/2 mouse device common for all mice [ 2.474628] device-mapper: uevent: version 1.0.3 [ 2.481388] device-mapper: ioctl: 4.35.0-ioctl (2016-06-23) initialised: dm-devel@redhat.com [ 2.488421] ledtrig-cpu: registered to indicate activity on CPUs [ 2.495042] hidraw: raw HID events driver (C) Jiri Kosina [ 2.501674] usbcore: registered new interface driver usbhid [ 2.508101] usbhid: USB HID core driver [ 2.517577] bcm2835-mbox 3f00b880.mailbox: mailbox enabled [ 2.524885] drop_monitor: Initializing network drop monitor service [ 2.531822] ip_tables: (C) 2000-2006 Netfilter Core Team [ 2.538515] Initializing XFRM netlink socket [ 2.546368] NET: Registered protocol family 10 [ 2.554414] mip6: Mobile IPv6 [ 2.560927] NET: Registered protocol family 17 [ 2.567605] Registering SWP/SWPB emulation handler [ 2.575010] registered taskstats version 1 [ 2.581391] Loading compiled-in X.509 certificates [ 2.600211] alg: No test for pkcs1pad(rsa,sha256) (pkcs1pad(rsa-generic,sha256)) [ 2.616249] Loaded X.509 cert 'Fedora kernel signing key: d40a0c829cfc19df12767ad4d16167d3c4a2d206' [ 2.622894] zswap: loaded using pool lzo/zbud [ 2.735670] 3f201000.serial: ttyAMA0 at MMIO 0x3f201000 (irq = 87, base_baud = 0) is a PL011 rev2 [ 2.744119] 3f215040.serial: ttyS0 at MMIO 0x0 (irq = 59, base_baud = 31224999) is a 16550 [ 2.751539] raspberrypi-firmware soc:firmware: Attached to firmware from 2016-09-13 17:02 [ 2.758571] hctosys: unable to open rtc device (rtc0) [ 2.765479] sr_init: No PMIC hook to init smartreflex [ 2.772053] sr_init: platform driver register failed for SR [ 2.782503] PM: Hibernation image not present or could not be loaded. [ 2.786016] Freeing unused kernel memory: 1160K (c0c56000 - c0d78000) [ 2.792530] This architecture does not have kernel memory protection. [ 2.827941] systemd[1]: System time before build time, advancing clock. [ 2.840726] random: systemd: uninitialized urandom read (16 bytes read) [ 2.849045] random: systemd: uninitialized urandom read (16 bytes read) [ 2.879134] systemd[1]: systemd 231 running in system mode. (+PAM +AUDIT +SELINUX +IMA -APPARMOR +SMACK +SYSVINIT +UTMP +LIBCRYPTSETUP +GCRYPT +GNUTLS +ACL +XZ +LZ4 +SECCOMP +BLKID +ELFUTILS +KMOD +IDN) [ 2.886879] systemd[1]: Detected architecture arm. [ 2.893862] systemd[1]: Running in initial RAM disk. [ 2.923297] systemd[1]: Set hostname to <RPi3-1>. [ 3.233174] random: systemd: uninitialized urandom read (16 bytes read) [ 3.240619] random: systemd: uninitialized urandom read (16 bytes read) [ 3.248223] random: systemd: uninitialized urandom read (16 bytes read) [ 3.260543] random: systemd: uninitialized urandom read (16 bytes read) [ 3.270966] random: systemd: uninitialized urandom read (16 bytes read) [ 3.278056] random: systemd: uninitialized urandom read (16 bytes read) [ 3.286187] random: systemd: uninitialized urandom read (16 bytes read) [ 3.302187] random: systemd: uninitialized urandom read (16 bytes read) [ 3.337606] systemd[1]: Listening on udev Kernel Socket. [ 3.351772] systemd[1]: Reached target Local File Systems. [ 3.365869] systemd[1]: Listening on Journal Socket (/dev/log). [ 3.382720] systemd[1]: Created slice System Slice. [ 3.396775] systemd[1]: Reached target Slices. [ 3.410908] systemd[1]: Listening on udev Control Socket. [ 3.631506] audit: type=1130 audit(1469476187.794:2): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=kmod-static-nodes comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 3.658305] audit: type=1130 audit(1469476187.824:3): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-sysctl comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 3.710375] audit: type=1130 audit(1469476187.874:4): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-journald comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 3.744219] audit: type=1130 audit(1469476187.909:5): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-tmpfiles-setup-dev comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 4.085219] audit: type=1130 audit(1469476188.249:6): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-vconsole-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 4.125283] audit: type=1130 audit(1469476188.289:7): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-cmdline comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 4.399871] audit: type=1130 audit(1469476188.564:8): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-udev comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 4.478742] audit: type=1130 audit(1469476188.644:9): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-udevd comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 4.904865] audit: type=1130 audit(1469476189.069:10): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-udev-trigger comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 4.921442] i2c-bcm2835 3f805000.i2c: Could not read clock-frequency property [ 4.963074] sdhci: Secure Digital Host Controller Interface driver [ 4.973988] sdhci: Copyright(c) Pierre Ossman [ 4.996883] sdhci-pltfm: SDHCI platform and OF driver helper [ 5.067012] mmc0: SDHCI controller on 3f300000.sdhci [3f300000.sdhci] using PIO [ 5.114968] mmc0: new SDHC card at address 0001 [ 5.133235] mmcblk0: mmc0:0001 00000 29.8 GiB [ 5.136071] mmcblk0: p1 p2 p3 p4 [ 5.159922] random: fast init done [ 6.122842] random: crng init done [ 15.565970] audit_printk_skb: 6 callbacks suppressed [ 15.565978] audit: type=1130 audit(1469476199.729:13): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-fsck-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 15.768510] EXT4-fs (mmcblk0p4): mounted filesystem with ordered data mode. Opts: (null) [ 16.469045] audit: type=1130 audit(1469476200.634:14): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-parse-etc comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 16.494092] audit: type=1131 audit(1469476200.664:15): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-parse-etc comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 16.996148] audit: type=1130 audit(1469476201.159:16): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-pivot comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 17.123745] audit: type=1130 audit(1469476201.289:17): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-cleanup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 17.123865] audit: type=1131 audit(1469476201.289:18): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-cleanup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 17.181003] audit: type=1131 audit(1469476201.344:19): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-pivot comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 17.243329] audit: type=1130 audit(1469476201.409:20): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-initqueue comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 17.243448] audit: type=1131 audit(1469476201.409:21): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-initqueue comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 17.387837] audit: type=1130 audit(1469476201.554:22): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-udev-trigger comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 17.743779] systemd-journald[170]: Received SIGTERM from PID 1 (systemd). [ 17.894190] systemd: 14 output lines suppressed due to ratelimiting [ 19.017378] SELinux: 32768 avtab hash slots, 106608 rules. [ 19.164487] SELinux: 32768 avtab hash slots, 106608 rules. [ 19.559695] SELinux: 8 users, 14 roles, 5063 types, 305 bools, 1 sens, 1024 cats [ 19.559712] SELinux: 94 classes, 106608 rules [ 19.595070] SELinux: Permission validate_trans in class security not defined in policy. [ 19.605868] SELinux: Permission module_load in class system not defined in policy. [ 19.617392] SELinux: the above unknown classes and permissions will be allowed [ 19.628252] SELinux: Completing initialization. [ 19.628256] SELinux: Setting up existing superblocks. [ 19.708295] systemd[1]: Successfully loaded SELinux policy in 1.094249s. [ 20.126989] systemd[1]: Relabelled /dev and /run in 182.498ms. [ 21.613503] audit_printk_skb: 54 callbacks suppressed [ 21.623712] audit: type=1130 audit(1469476205.779:41): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=systemd-journald comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 21.644762] audit: type=1131 audit(1469476205.809:42): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=systemd-journald comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 21.669668] audit: type=1130 audit(1469476205.834:43): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=initrd-switch-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 21.669787] audit: type=1131 audit(1469476205.834:44): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=initrd-switch-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 21.715341] audit: type=1130 audit(1469476205.879:45): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=systemd-journald comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 21.715459] audit: type=1131 audit(1469476205.879:46): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=systemd-journald comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 21.862317] audit: type=1305 audit(1469476206.029:47): audit_enabled=1 old=1 auid=4294967295 ses=4294967295 subj=system_u:system_r:syslogd_t:s0 res=1 [ 21.879997] audit: type=1130 audit(1469476206.049:48): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=systemd-fsck-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 21.880132] audit: type=1131 audit(1469476206.049:49): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=systemd-fsck-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 22.061695] EXT4-fs (mmcblk0p4): re-mounted. Opts: (null) [ 22.186416] RPC: Registered named UNIX socket transport module. [ 22.197470] RPC: Registered udp transport module. [ 22.208474] RPC: Registered tcp transport module. [ 22.219577] RPC: Registered tcp NFSv4.1 backchannel transport module. [ 22.422803] Installing knfsd (copyright (C) 1996 okir@monad.swb.de). [ 22.439075] audit: type=1130 audit(1469476206.604:50): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=systemd-journald comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 22.724150] systemd-journald[414]: Received request to flush runtime journal from PID 1 [ 22.894755] systemd-journald[414]: File /var/log/journal/3dad117e20a544249d4fa3919c15f9ac/system.journal corrupted or uncleanly shut down, renaming and replacing. [ 25.577217] bcm2835-wdt 3f100000.watchdog: Broadcom BCM2835 watchdog timer [ 26.091545] [drm] Initialized drm 1.1.0 20060810 [ 26.582892] bcm2835-rng 3f104000.rng: hwrng registered [ 26.595982] 3f980000.usb supply vusb_d not found, using dummy regulator [ 26.652933] EXT4-fs (mmcblk0p2): mounting ext3 file system using the ext4 subsystem [ 26.660246] 3f980000.usb supply vusb_a not found, using dummy regulator [ 26.755876] Adding 499708k swap on /dev/mmcblk0p3. Priority:-1 extents:1 across:499708k SSFS [ 26.916852] dwc2 3f980000.usb: Specified GNPTXFDEP=1024 > 256 [ 26.925092] dwc2 3f980000.usb: EPs: 8, dedicated fifos, 4080 entries in SPRAM [ 26.934528] dwc2 3f980000.usb: DWC OTG Controller [ 26.943777] dwc2 3f980000.usb: new USB bus registered, assigned bus number 1 [ 26.952069] dwc2 3f980000.usb: irq 39, io mem 0x00000000 [ 26.960560] usb usb1: New USB device found, idVendor=1d6b, idProduct=0002 [ 26.968868] usb usb1: New USB device strings: Mfr=3, Product=2, SerialNumber=1 [ 26.977103] usb usb1: Product: DWC OTG Controller [ 26.985216] usb usb1: Manufacturer: Linux 4.8.4-301.fc25.armv7hl dwc2_hsotg [ 26.993371] usb usb1: SerialNumber: 3f980000.usb [ 27.003011] hub 1-0:1.0: USB hub found [ 27.011258] hub 1-0:1.0: 1 port detected [ 27.028752] vc4-drm soc:gpu: bound 3f902000.hdmi (ops vc4_hdmi_ops [vc4]) [ 27.037305] vc4-drm soc:gpu: bound 3f400000.hvs (ops vc4_hvs_ops [vc4]) [ 27.045946] vc4-drm soc:gpu: bound 3f206000.pixelvalve (ops vc4_crtc_ops [vc4]) [ 27.054599] vc4-drm soc:gpu: bound 3f207000.pixelvalve (ops vc4_crtc_ops [vc4]) [ 27.063115] vc4-drm soc:gpu: bound 3f807000.pixelvalve (ops vc4_crtc_ops [vc4]) [ 27.071465] vc4-drm soc:gpu: bound 3fc00000.v3d (ops vc4_v3d_ops [vc4]) [ 27.079727] checking generic (3e699000 35d540) vs hw (0 ffffffff) [ 27.079735] fb: switching to vc4drmfb from simple [ 27.088155] Console: switching to colour dummy device 80x30 [ 27.090873] [drm] Supports vblank timestamp caching Rev 2 (21.10.2013). [ 27.090926] [drm] Driver supports precise vblank timestamp query. [ 27.091185] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 27.091372] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 27.091554] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 27.091733] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 27.091918] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 27.091980] vc4-drm soc:gpu: No connectors reported connected with modes [ 27.092029] [drm] Cannot find any crtc or sizes - going 1024x768 [ 27.097355] Console: switching to colour frame buffer device 128x48 [ 27.116348] vc4-drm soc:gpu: fb0: frame buffer device [ 27.344631] EXT4-fs (mmcblk0p2): recovery complete [ 27.354188] EXT4-fs (mmcblk0p2): mounted filesystem with ordered data mode. Opts: (null) [ 27.426939] usb 1-1: new high-speed USB device number 2 using dwc2 [ 27.506851] audit_printk_skb: 33 callbacks suppressed [ 27.507087] audit: type=1130 audit(1469476211.669:62): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=dracut-shutdown comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 27.524450] audit: type=1130 audit(1469476211.689:63): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=plymouth-read-write comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 27.525517] audit: type=1131 audit(1469476211.689:64): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=plymouth-read-write comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 27.548829] audit: type=1130 audit(1469476211.714:65): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=nfs-config comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 27.569584] audit: type=1131 audit(1469476211.734:66): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=nfs-config comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 27.637173] usb 1-1: New USB device found, idVendor=0424, idProduct=9514 [ 27.647752] usb 1-1: New USB device strings: Mfr=0, Product=0, SerialNumber=0 [ 27.661417] hub 1-1:1.0: USB hub found [ 27.672453] hub 1-1:1.0: 5 ports detected [ 27.756865] audit: type=1130 audit(1469476211.919:67): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=fedora-import-state comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 27.971879] usb 1-1.1: new high-speed USB device number 3 using dwc2 [ 28.092264] usb 1-1.1: New USB device found, idVendor=0424, idProduct=ec00 [ 28.092274] usb 1-1.1: New USB device strings: Mfr=0, Product=0, SerialNumber=0 [ 28.176877] usb 1-1.5: new full-speed USB device number 4 using dwc2 [ 28.240399] audit: type=1130 audit(1469476212.404:68): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:init_t:s0 msg='unit=systemd-tmpfiles-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' [ 28.290710] usb 1-1.5: New USB device found, idVendor=046d, idProduct=c52b [ 28.302414] usb 1-1.5: New USB device strings: Mfr=1, Product=2, SerialNumber=0 [ 28.314170] usb 1-1.5: Product: USB Receiver [ 28.325964] usb 1-1.5: Manufacturer: Logitech [ 28.429561] smsc95xx v1.0.4 [ 28.536609] smsc95xx 1-1.1:1.0 eth0: register 'smsc95xx' at usb-3f980000.usb-1.1, smsc95xx USB 2.0 Ethernet, b8:27:eb:dd:7f:d3 [ 28.562007] usbcore: registered new interface driver smsc95xx [ 28.700288] audit: type=1305 audit(1469476212.864:69): audit_enabled=1 old=1 auid=4294967295 ses=4294967295 subj=system_u:system_r:auditd_t:s0 res=1 [ 28.727031] audit: type=1305 audit(1469476212.894:70): audit_pid=527 old=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:auditd_t:s0 res=1 [ 28.736866] logitech-djreceiver 0003:046D:C52B.0003: hiddev0,hidraw0: USB HID v1.11 Device [Logitech USB Receiver] on usb-3f980000.usb-1.5/input2 [ 28.916752] input: Logitech K360 as /devices/platform/soc/3f980000.usb/usb1/1-1/1-1.5/1-1.5:1.2/0003:046D:C52B.0003/0003:046D:4004.0004/input/input0 [ 28.947837] logitech-hidpp-device 0003:046D:4004.0004: input,hidraw1: USB HID v1.11 Keyboard [Logitech K360] on usb-3f980000.usb-1.5:1 [ 28.985026] input: Logitech Anywhere MX as /devices/platform/soc/3f980000.usb/usb1/1-1/1-1.5/1-1.5:1.2/0003:046D:C52B.0003/0003:046D:1017.0005/input/input1 [ 28.986394] logitech-hidpp-device 0003:046D:1017.0005: input,hidraw2: USB HID v1.11 Mouse [Logitech Anywhere MX] on usb-3f980000.usb-1.5:2 [ 37.332049] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 37.346890] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 37.353827] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 37.360570] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 37.367082] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 37.373272] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 37.379057] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 37.384737] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 37.390257] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 37.395546] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 38.514031] ip6_tables: (C) 2000-2006 Netfilter Core Team [ 38.832833] Ebtables v2.0 registered [ 39.087235] nf_conntrack version 0.5.0 (16384 buckets, 65536 max) [ 39.839130] bridge: automatic filtering via arp/ip/ip6tables has been deprecated. Update your scripts to load br_netfilter if you need this. [ 40.324553] Netfilter messages via NETLINK v0.30. [ 40.406397] ip_set: protocol 6 [ 41.612459] IPv6: ADDRCONF(NETDEV_UP): eth0: link is not ready [ 41.689301] smsc95xx 1-1.1:1.0 eth0: hardware isn't capable of remote wakeup [ 43.206500] smsc95xx 1-1.1:1.0 eth0: link up, 100Mbps, full-duplex, lpa 0xC5E1 [ 47.572088] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 47.572473] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 47.572836] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 47.573200] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 47.573558] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 57.807333] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 57.807739] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 57.808120] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 57.808502] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 57.808883] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 68.047381] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 68.047761] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 68.048125] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 68.048488] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 68.048850] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 78.287447] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 78.287829] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 78.288190] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 78.288551] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 78.288919] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 88.527498] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 88.527876] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 88.528238] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 88.528601] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 88.528963] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 98.767555] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 98.767934] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 98.768299] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 98.768660] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 98.769022] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 109.007612] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 109.007989] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 109.008352] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 109.008715] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 109.009075] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 119.247707] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 119.248101] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 119.248466] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 119.248827] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 119.249190] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 129.487937] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 129.488319] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 129.488682] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 129.490897] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 129.493058] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 139.728160] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 139.730079] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 139.731714] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 139.733087] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 139.734466] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 149.968383] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 149.969803] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 149.971188] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 149.972563] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 149.973981] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 160.208607] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 160.210038] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 160.211442] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 160.212834] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 160.214271] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 168.516125] fuse init (API version 7.25) [ 170.448876] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 170.450730] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 170.452474] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 170.454257] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 170.456021] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 180.689071] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 180.690842] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 180.692563] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 180.694322] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 180.696052] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 190.923252] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 190.925015] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 190.926731] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 190.928487] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 190.930211] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 201.163343] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 201.165120] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 201.166848] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 201.168635] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 201.170386] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 211.403382] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 211.405178] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 211.406911] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 211.408680] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 211.410431] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 221.643646] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 221.645462] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 221.647216] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 221.649007] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 221.650766] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 231.883501] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 231.885311] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 231.887059] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 231.888836] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 231.890584] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 242.123535] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 242.125342] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 242.127091] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 242.128886] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 242.130649] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 251.435363] FS-Cache: Loaded [ 251.501128] FS-Cache: Netfs 'nfs' registered for caching [ 251.527939] Key type dns_resolver registered [ 251.628706] NFS: Registering the id_resolver key type [ 251.630863] Key type id_resolver registered [ 251.634410] Key type id_legacy registered [ 252.363633] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 252.366083] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 252.368313] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 252.370577] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 252.372811] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 262.603724] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 262.606014] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 262.608238] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 262.610504] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 262.612749] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 272.843833] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 272.846122] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 272.848357] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 272.850632] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100 [ 272.852885] i2c-bcm2835 3f805000.i2c: i2c transfer failed: 100
Two more trials without any improvement:
Using kernel-4.9.0-0.rc2.git0.2.fc26 does not help. I had no reason to think it would, but now that ssh to my RPi3 works well, it was easy to try.
Changing the display to a Dell P2415Q (3840x2160 resolution, HDMI input) does not help. Again, no reason to think it would, but the world has a lot of quirky hardware and this helps me believe it is not a display device issue.
The last line I see before the display goes blank is:
fb: switching to vc4drmfb from simple
which is no surprise.
Journal and dmesg files are at: http://ryniker.org/Fedora/arm/
I've been chasing this same issue and reported it (albeit lacking details) on previous LXDE spin beta [1]. I can reproduce on latest image, using same kernel as Richard, however sshd doesn't appear to be up for me so I'm having trouble getting a dmesg off the device. If I have any luck I'll put it up here. I was also using HDMI out, to a ASUS VX238 (1920x1080 native)
Dexter