early console in setup code
early console in extract_kernel
input_data: 0x0000000002efc295
input_len: 0x00000000004f3ecb
output: 0x0000000001000000
output_len: 0x00000000013caa98
kernel_total_size: 0x0000000002416000
trampoline_32bit: 0x000000000009d000

Decompressing Linux... Parsing ELF... done.
Booting the kernel.
[    0.000000] Linux version 4.16.0-10623-ge979e5a (kbuild@lkp-wsm-ep1) (gcc version 7.3.0 (Debian 7.3.0-1)) #1 Tue Apr 10 02:31:10 CST 2018
[    0.000000] Command line: ip=::::vm-vp-quantal-x86_64-55::dhcp root=/dev/ram0 user=lkp job=/lkp/scheduled/vm-vp-quantal-x86_64-55/boot-1-quantal-core-x86_64.cgz-e979e5a0591e70ad0b41cf876ee987de468a220e-20180410-85306-1wybswc-1.yaml ARCH=x86_64 kconfig=x86_64-randconfig-s4-04092351 branch=linux-devel/devel-catchup-201804100006 commit=e979e5a0591e70ad0b41cf876ee987de468a220e BOOT_IMAGE=/pkg/linux/x86_64-randconfig-s4-04092351/gcc-7/e979e5a0591e70ad0b41cf876ee987de468a220e/vmlinuz-4.16.0-10623-ge979e5a max_uptime=600 RESULT_ROOT=/result/boot/1/vm-vp-quantal-x86_64/quantal-core-x86_64.cgz/x86_64-randconfig-s4-04092351/gcc-7/e979e5a0591e70ad0b41cf876ee987de468a220e/0 LKP_SERVER=inn debug apic=debug sysrq_always_enabled rcupdate.rcu_cpu_stall_timeout=100 net.ifnames=0 printk.devkmsg=on panic=-1 softlockup_panic=1 nmi_watchdog=panic oops=panic load_ramdisk=2 prompt_ramdisk=0 drbd.minor_count=8 systemd.log_level=err ignore_loglevel console=tty0 earlyprintk=ttyS0,115200 console=ttyS0,115200 vga=
[    0.000000] x86/fpu: x87 FPU will use FXSAVE
[    0.000000] e820: BIOS-provided physical RAM map:
[    0.000000] BIOS-e820: [mem 0x0000000000000000-0x000000000009fbff] usable
[    0.000000] BIOS-e820: [mem 0x000000000009fc00-0x000000000009ffff] reserved
[    0.000000] BIOS-e820: [mem 0x00000000000f0000-0x00000000000fffff] reserved
[    0.000000] BIOS-e820: [mem 0x0000000000100000-0x000000001ffdffff] usable
[    0.000000] BIOS-e820: [mem 0x000000001ffe0000-0x000000001fffffff] reserved
[    0.000000] BIOS-e820: [mem 0x00000000feffc000-0x00000000feffffff] reserved
[    0.000000] BIOS-e820: [mem 0x00000000fffc0000-0x00000000ffffffff] reserved
[    0.000000] debug: ignoring loglevel setting.
[    0.000000] bootconsole [earlyser0] enabled
[    0.000000] NX (Execute Disable) protection: active
[    0.000000] Hypervisor detected: KVM
[    0.000000] e820: update [mem 0x00000000-0x00000fff] usable ==> reserved
[    0.000000] e820: remove [mem 0x000a0000-0x000fffff] usable
[    0.000000] e820: last_pfn = 0x1ffe0 max_arch_pfn = 0x400000000
[    0.000000] x86/PAT: Configuration [0-7]: WB  WT  UC- UC  WB  WT  UC- UC  
[    0.000000] Scan for SMP in [mem 0x00000000-0x000003ff]
[    0.000000] Scan for SMP in [mem 0x0009fc00-0x0009ffff]
[    0.000000] Scan for SMP in [mem 0x000f0000-0x000fffff]
[    0.000000] found SMP MP-table at [mem 0x000f6a80-0x000f6a8f] mapped at [        (ptrval)]
[    0.000000]   mpc: f6a90-f6b74
[    0.000000] Scanning 1 areas for low memory corruption
[    0.000000] Base memory trampoline at [        (ptrval)] 99000 size 24576
[    0.000000] BRK [0x03400000, 0x03400fff] PGTABLE
[    0.000000] BRK [0x03401000, 0x03401fff] PGTABLE
[    0.000000] BRK [0x03402000, 0x03402fff] PGTABLE
[    0.000000] BRK [0x03403000, 0x03403fff] PGTABLE
[    0.000000] RAMDISK: [mem 0x1d082000-0x1ffdffff]
[    0.000000] ACPI: Early table checksum verification disabled
[    0.000000] ACPI: RSDP 0x00000000000F6870 000014 (v00 BOCHS )
[    0.000000] ACPI: RSDT 0x000000001FFE1628 000030 (v01 BOCHS  BXPCRSDT 00000001 BXPC 00000001)
[    0.000000] ACPI: FACP 0x000000001FFE147C 000074 (v01 BOCHS  BXPCFACP 00000001 BXPC 00000001)
[    0.000000] ACPI: DSDT 0x000000001FFE0040 00143C (v01 BOCHS  BXPCDSDT 00000001 BXPC 00000001)
[    0.000000] ACPI: FACS 0x000000001FFE0000 000040
[    0.000000] ACPI: APIC 0x000000001FFE1570 000080 (v01 BOCHS  BXPCAPIC 00000001 BXPC 00000001)
[    0.000000] ACPI: HPET 0x000000001FFE15F0 000038 (v01 BOCHS  BXPCHPET 00000001 BXPC 00000001)
[    0.000000] ACPI: Local APIC address 0xfee00000
[    0.000000] mapped APIC to ffffffffff5fd000 (        fee00000)
[    0.000000] kvm-clock: cpu 0, msr 0:1d080001, primary cpu clock
[    0.000000] kvm-clock: Using msrs 4b564d01 and 4b564d00
[    0.000000] kvm-clock: using sched offset of 327100689 cycles
[    0.000000] clocksource: kvm-clock: mask: 0xffffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns
[    0.000000] Zone ranges:
[    0.000000]   DMA      [mem 0x0000000000001000-0x0000000000ffffff]
[    0.000000]   DMA32    [mem 0x0000000001000000-0x000000001ffdffff]
[    0.000000]   Normal   empty
[    0.000000] Movable zone start for each node
[    0.000000] Early memory node ranges
[    0.000000]   node   0: [mem 0x0000000000001000-0x000000000009efff]
[    0.000000]   node   0: [mem 0x0000000000100000-0x000000001ffdffff]
[    0.000000] Initmem setup node 0 [mem 0x0000000000001000-0x000000001ffdffff]
[    0.000000] On node 0 totalpages: 130942
[    0.000000]   DMA zone: 64 pages used for memmap
[    0.000000]   DMA zone: 21 pages reserved
[    0.000000]   DMA zone: 3998 pages, LIFO batch:0
[    0.000000]   DMA32 zone: 1984 pages used for memmap
[    0.000000]   DMA32 zone: 126944 pages, LIFO batch:31
[    0.000000] Reserved but unavailable: 98 pages
[    0.000000] ACPI: PM-Timer IO Port: 0x608
[    0.000000] ACPI: Local APIC address 0xfee00000
[    0.000000] APIC: NR_CPUS/possible_cpus limit of 1 reached. Processor 1/0x1 ignored.
[    0.000000] ACPI: LAPIC_NMI (acpi_id[0xff] dfl dfl lint[0x1])
[    0.000000] IOAPIC[0]: apic_id 0, version 17, address 0xfec00000, GSI 0-23
[    0.000000] ACPI: INT_SRC_OVR (bus 0 bus_irq 0 global_irq 2 dfl dfl)
[    0.000000] Int: type 0, pol 0, trig 0, bus 00, IRQ 00, APIC ID 0, APIC INT 02
[    0.000000] ACPI: INT_SRC_OVR (bus 0 bus_irq 5 global_irq 5 high level)
[    0.000000] Int: type 0, pol 1, trig 3, bus 00, IRQ 05, APIC ID 0, APIC INT 05
[    0.000000] ACPI: INT_SRC_OVR (bus 0 bus_irq 9 global_irq 9 high level)
[    0.000000] Int: type 0, pol 1, trig 3, bus 00, IRQ 09, APIC ID 0, APIC INT 09
[    0.000000] ACPI: INT_SRC_OVR (bus 0 bus_irq 10 global_irq 10 high level)
[    0.000000] Int: type 0, pol 1, trig 3, bus 00, IRQ 0a, APIC ID 0, APIC INT 0a
[    0.000000] ACPI: INT_SRC_OVR (bus 0 bus_irq 11 global_irq 11 high level)
[    0.000000] Int: type 0, pol 1, trig 3, bus 00, IRQ 0b, APIC ID 0, APIC INT 0b
[    0.000000] ACPI: IRQ0 used by override.
[    0.000000] Int: type 0, pol 0, trig 0, bus 00, IRQ 01, APIC ID 0, APIC INT 01
[    0.000000] Int: type 0, pol 0, trig 0, bus 00, IRQ 03, APIC ID 0, APIC INT 03
[    0.000000] Int: type 0, pol 0, trig 0, bus 00, IRQ 04, APIC ID 0, APIC INT 04
[    0.000000] ACPI: IRQ5 used by override.
[    0.000000] Int: type 0, pol 0, trig 0, bus 00, IRQ 06, APIC ID 0, APIC INT 06
[    0.000000] Int: type 0, pol 0, trig 0, bus 00, IRQ 07, APIC ID 0, APIC INT 07
[    0.000000] Int: type 0, pol 0, trig 0, bus 00, IRQ 08, APIC ID 0, APIC INT 08
[    0.000000] ACPI: IRQ9 used by override.
[    0.000000] ACPI: IRQ10 used by override.
[    0.000000] ACPI: IRQ11 used by override.
[    0.000000] Int: type 0, pol 0, trig 0, bus 00, IRQ 0c, APIC ID 0, APIC INT 0c
[    0.000000] Int: type 0, pol 0, trig 0, bus 00, IRQ 0d, APIC ID 0, APIC INT 0d
[    0.000000] Int: type 0, pol 0, trig 0, bus 00, IRQ 0e, APIC ID 0, APIC INT 0e
[    0.000000] Int: type 0, pol 0, trig 0, bus 00, IRQ 0f, APIC ID 0, APIC INT 0f
[    0.000000] Using ACPI (MADT) for SMP configuration information
[    0.000000] ACPI: HPET id: 0x8086a201 base: 0xfed00000
[    0.000000] mapped IOAPIC to ffffffffff5fc000 (fec00000)
[    0.000000] KVM setup async PF for cpu 0
[    0.000000] kvm-stealtime: cpu 0, msr 1e47d00
[    0.000000] e820: [mem 0x20000000-0xfeffbfff] available for PCI devices
[    0.000000] Booting paravirtualized kernel on KVM
[    0.000000] clocksource: refined-jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 19112604462750000 ns
[    0.000000] random: fast init done
[    0.000000] pcpu-alloc: s0 r0 d32768 u32768 alloc=1*32768
[    0.000000] pcpu-alloc: [0] 0 
[    0.000000] Built 1 zonelists, mobility grouping on.  Total pages: 128873
[    0.000000] Kernel command line: ip=::::vm-vp-quantal-x86_64-55::dhcp root=/dev/ram0 user=lkp job=/lkp/scheduled/vm-vp-quantal-x86_64-55/boot-1-quantal-core-x86_64.cgz-e979e5a0591e70ad0b41cf876ee987de468a220e-20180410-85306-1wybswc-1.yaml ARCH=x86_64 kconfig=x86_64-randconfig-s4-04092351 branch=linux-devel/devel-catchup-201804100006 commit=e979e5a0591e70ad0b41cf876ee987de468a220e BOOT_IMAGE=/pkg/linux/x86_64-randconfig-s4-04092351/gcc-7/e979e5a0591e70ad0b41cf876ee987de468a220e/vmlinuz-4.16.0-10623-ge979e5a max_uptime=600 RESULT_ROOT=/result/boot/1/vm-vp-quantal-x86_64/quantal-core-x86_64.cgz/x86_64-randconfig-s4-04092351/gcc-7/e979e5a0591e70ad0b41cf876ee987de468a220e/0 LKP_SERVER=inn debug apic=debug sysrq_always_enabled rcupdate.rcu_cpu_stall_timeout=100 net.ifnames=0 printk.devkmsg=on panic=-1 softlockup_panic=1 nmi_watchdog=panic oops=panic load_ramdisk=2 prompt_ramdisk=0 drbd.minor_count=8 systemd.log_level=err ignore_loglevel console=tty0 earlyprintk=ttyS0,115200 console=ttyS0,1152
[    0.000000] sysrq: sysrq always enabled.
[    0.000000] Dentry cache hash table entries: 65536 (order: 7, 524288 bytes)
[    0.000000] Inode-cache hash table entries: 32768 (order: 6, 262144 bytes)
[    0.000000] Memory: 429236K/523768K available (8204K kernel code, 1112K rwdata, 3224K rodata, 940K init, 18644K bss, 94532K reserved, 0K cma-reserved)
[    0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=1
[    0.000000] Kernel/User page tables isolation: enabled
[    0.010000] NR_IRQS: 4352, nr_irqs: 48, preallocated irqs: 16
[    0.010000] console [ttyS0] enabled
[    0.010000] console [ttyS0] enabled
[    0.010000] bootconsole [earlyser0] disabled
[    0.010000] bootconsole [earlyser0] disabled
[    0.010000] Lock dependency validator: Copyright (c) 2006 Red Hat, Inc., Ingo Molnar
[    0.010000] ... MAX_LOCKDEP_SUBCLASSES:  8
[    0.010000] ... MAX_LOCK_DEPTH:          48
[    0.010000] ... MAX_LOCKDEP_KEYS:        8191
[    0.010000] ... CLASSHASH_SIZE:          4096
[    0.010000] ... MAX_LOCKDEP_ENTRIES:     32768
[    0.010000] ... MAX_LOCKDEP_CHAINS:      65536
[    0.010000] ... CHAINHASH_SIZE:          32768
[    0.010000]  memory used by lock dependency info: 7359 kB
[    0.010000]  per task-struct memory footprint: 1920 bytes
[    0.010000] ACPI: Core revision 20180313
[    0.010000] clocksource: hpet: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 19112604467 ns
[    0.010000] hpet clockevent registered
[    0.010019] APIC: Switch to symmetric I/O mode setup
[    0.010770] enabled ExtINT on CPU#0
[    0.012081] ENABLING IO-APIC IRQs
[    0.012557] init IO_APIC IRQs
[    0.012992]  apic 0 pin 0 not connected
[    0.013549] IOAPIC[0]: Set routing entry (0-1 -> 0xef -> IRQ 1 Mode:0 Active:0 Dest:1)
[    0.014658] IOAPIC[0]: Set routing entry (0-2 -> 0x30 -> IRQ 0 Mode:0 Active:0 Dest:1)
[    0.015762] IOAPIC[0]: Set routing entry (0-3 -> 0xef -> IRQ 3 Mode:0 Active:0 Dest:1)
[    0.016874] IOAPIC[0]: Set routing entry (0-4 -> 0xef -> IRQ 4 Mode:0 Active:0 Dest:1)
[    0.017982] IOAPIC[0]: Set routing entry (0-5 -> 0xef -> IRQ 5 Mode:1 Active:0 Dest:1)
[    0.019107] IOAPIC[0]: Set routing entry (0-6 -> 0xef -> IRQ 6 Mode:0 Active:0 Dest:1)
[    0.020000] IOAPIC[0]: Set routing entry (0-7 -> 0xef -> IRQ 7 Mode:0 Active:0 Dest:1)
[    0.020000] IOAPIC[0]: Set routing entry (0-8 -> 0xef -> IRQ 8 Mode:0 Active:0 Dest:1)
[    0.020000] IOAPIC[0]: Set routing entry (0-9 -> 0xef -> IRQ 9 Mode:1 Active:0 Dest:1)
[    0.020000] IOAPIC[0]: Set routing entry (0-10 -> 0xef -> IRQ 10 Mode:1 Active:0 Dest:1)
[    0.020000] IOAPIC[0]: Set routing entry (0-11 -> 0xef -> IRQ 11 Mode:1 Active:0 Dest:1)
[    0.020000] IOAPIC[0]: Set routing entry (0-12 -> 0xef -> IRQ 12 Mode:0 Active:0 Dest:1)
[    0.020000] IOAPIC[0]: Set routing entry (0-13 -> 0xef -> IRQ 13 Mode:0 Active:0 Dest:1)
[    0.020000] IOAPIC[0]: Set routing entry (0-14 -> 0xef -> IRQ 14 Mode:0 Active:0 Dest:1)
[    0.020000] IOAPIC[0]: Set routing entry (0-15 -> 0xef -> IRQ 15 Mode:0 Active:0 Dest:1)
[    0.020000]  apic 0 pin 16 not connected
[    0.020000]  apic 0 pin 17 not connected
[    0.020000]  apic 0 pin 18 not connected
[    0.020000]  apic 0 pin 19 not connected
[    0.020000]  apic 0 pin 20 not connected
[    0.020000]  apic 0 pin 21 not connected
[    0.020000]  apic 0 pin 22 not connected
[    0.020000]  apic 0 pin 23 not connected
[    0.020000] ..TIMER: vector=0x30 apic1=0 pin1=2 apic2=-1 pin2=-1
[    0.020000] tsc: Detected 2693.508 MHz processor
[    0.020000] clocksource: tsc-early: mask: 0xffffffffffffffff max_cycles: 0x26d349e8249, max_idle_ns: 440795288087 ns
[    0.020011] Calibrating delay loop (skipped) preset value.. 5387.01 BogoMIPS (lpj=26935080)
[    0.021803] pid_max: default: 32768 minimum: 301
[    0.022865] Security Framework initialized
[    0.023750] Yama: becoming mindful.
[    0.024556] Mount-cache hash table entries: 1024 (order: 1, 8192 bytes)
[    0.025855] Mountpoint-cache hash table entries: 1024 (order: 1, 8192 bytes)
[    0.027308] mce: CPU supports 10 MCE banks
[    0.028020] Last level iTLB entries: 4KB 0, 2MB 0, 4MB 0
[    0.030005] Last level dTLB entries: 4KB 0, 2MB 0, 4MB 0, 1GB 0
[    0.030955] CPU: Intel QEMU Virtual CPU version 2.5+ (family: 0x6, model: 0x6, stepping: 0x3)
[    0.032315] Spectre V2 : Mitigation: Full generic retpoline
[    0.034489] Performance Events: PMU not available due to virtualization, using software events only.
[    0.042417] Using local APIC timer interrupts.
[    0.042417] calibrating APIC timer ...
[    0.060000] ... lapic delta = 6250130
[    0.060000] ... PM-Timer delta = 357953
[    0.060000] ... PM-Timer result ok
[    0.060000] ..... delta 6250130
[    0.060000] ..... mult: 268441039
[    0.060000] ..... calibration result: 10000208
[    0.060000] ..... CPU clock speed is 2693.5011 MHz.
[    0.060000] ..... host bus clock speed is 1000.0208 MHz.
[    0.060000] devtmpfs: initialized
[    0.060000] evm: security.capability
[    0.060000] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 19112604462750000 ns
[    0.060000] futex hash table entries: 256 (order: 2, 20480 bytes)
[    0.060000] pinctrl core: initialized pinctrl subsystem
[    0.060000] NET: Registered protocol family 16
[    0.060317] cpuidle: using governor menu
[    0.061490] ACPI: bus type PCI registered
[    0.062248] PCI: Using configuration type 1 for base access
[    0.068814] HugeTLB registered 2.00 MiB page size, pre-allocated 0 pages
[    0.070109] cryptd: max_cpu_qlen set to 1000
[    0.070943] ACPI: Added _OSI(Module Device)
[    0.071646] ACPI: Added _OSI(Processor Device)
[    0.072381] ACPI: Added _OSI(3.0 _SCP Extensions)
[    0.073159] ACPI: Added _OSI(Processor Aggregator Device)
[    0.074063] ACPI: Added _OSI(Linux-Dell-Video)
[    0.077049] ACPI: 1 ACPI AML tables successfully acquired and loaded
[    0.080306] ACPI: Interpreter enabled
[    0.080918] ACPI: (supports S0 S5)
[    0.081461] ACPI: Using IOAPIC for interrupt routing
[    0.082261] PCI: Using host bridge windows from ACPI; if necessary, use "pci=nocrs" and report a bug
[    0.083837] ACPI: Enabled 2 GPEs in block 00 to 0F
[    0.090559] ACPI: PCI Root Bridge [PCI0] (domain 0000 [bus 00-ff])
[    0.091548] acpi PNP0A03:00: _OSC: OS supports [Segments]
[    0.092401] acpi PNP0A03:00: _OSC failed (AE_NOT_FOUND); disabling ASPM
[    0.093520] PCI host bridge to bus 0000:00
[    0.094177] pci_bus 0000:00: root bus resource [io  0x0000-0x0cf7 window]
[    0.095226] pci_bus 0000:00: root bus resource [io  0x0d00-0xffff window]
[    0.096274] pci_bus 0000:00: root bus resource [mem 0x000a0000-0x000bffff window]
[    0.097428] pci_bus 0000:00: root bus resource [mem 0x20000000-0xfebfffff window]
[    0.098582] pci_bus 0000:00: root bus resource [bus 00-ff]
[    0.099474] pci 0000:00:00.0: [8086:1237] type 00 class 0x060000
[    0.100555] pci 0000:00:01.0: [8086:7000] type 00 class 0x060100
[    0.102088] pci 0000:00:01.1: [8086:7010] type 00 class 0x010180
[    0.105563] pci 0000:00:01.1: reg 0x20: [io  0xc040-0xc04f]
[    0.107636] pci 0000:00:01.1: legacy IDE quirk: reg 0x10: [io  0x01f0-0x01f7]
[    0.108748] pci 0000:00:01.1: legacy IDE quirk: reg 0x14: [io  0x03f6]
[    0.110005] pci 0000:00:01.1: legacy IDE quirk: reg 0x18: [io  0x0170-0x0177]
[    0.111114] pci 0000:00:01.1: legacy IDE quirk: reg 0x1c: [io  0x0376]
[    0.112404] pci 0000:00:01.3: [8086:7113] type 00 class 0x068000
[    0.114086] pci 0000:00:01.3: quirk: [io  0x0600-0x063f] claimed by PIIX4 ACPI
[    0.115222] pci 0000:00:01.3: quirk: [io  0x0700-0x070f] claimed by PIIX4 SMB
[    0.116634] pci 0000:00:02.0: [1234:1111] type 00 class 0x030000
[    0.119254] pci 0000:00:02.0: reg 0x10: [mem 0xfd000000-0xfdffffff pref]
[    0.122342] pci 0000:00:02.0: reg 0x18: [mem 0xfebf0000-0xfebf0fff]
[    0.129269] pci 0000:00:02.0: reg 0x30: [mem 0xfebe0000-0xfebeffff pref]
[    0.130332] pci 0000:00:03.0: [8086:100e] type 00 class 0x020000
[    0.132460] pci 0000:00:03.0: reg 0x10: [mem 0xfebc0000-0xfebdffff]
[    0.134986] pci 0000:00:03.0: reg 0x14: [io  0xc000-0xc03f]
[    0.141064] pci 0000:00:03.0: reg 0x30: [mem 0xfeb80000-0xfebbffff pref]
[    0.142440] pci 0000:00:04.0: [8086:25ab] type 00 class 0x088000
[    0.144028] pci 0000:00:04.0: reg 0x10: [mem 0xfebf1000-0xfebf100f]
[    0.148969] pci_bus 0000:00: on NUMA node 0
[    0.150276] ACPI: PCI Interrupt Link [LNKA] (IRQs 5 *10 11)
[    0.151318] ACPI: PCI Interrupt Link [LNKB] (IRQs 5 *10 11)
[    0.152147] ACPI: PCI Interrupt Link [LNKC] (IRQs 5 10 *11)
[    0.152961] ACPI: PCI Interrupt Link [LNKD] (IRQs 5 10 *11)
[    0.153707] ACPI: PCI Interrupt Link [LNKS] (IRQs *9)
[    0.154807] pci 0000:00:02.0: vgaarb: setting as boot VGA device
[    0.155560] pci 0000:00:02.0: vgaarb: VGA device added: decodes=io+mem,owns=io+mem,locks=none
[    0.156803] pci 0000:00:02.0: vgaarb: bridge control possible
[    0.157492] vgaarb: loaded
[    0.158040] pps_core: LinuxPPS API ver. 1 registered
[    0.158632] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti <giometti@linux.it>
[    0.160065] PCI: Using ACPI for IRQ routing
[    0.160565] PCI: pci_cache_line_size set to 64 bytes
[    0.161260] e820: reserve RAM buffer [mem 0x0009fc00-0x0009ffff]
[    0.161969] e820: reserve RAM buffer [mem 0x1ffe0000-0x1fffffff]
[    0.163220] clocksource: Switched to clocksource kvm-clock
[    0.175560] =============================================================================
[    0.176568] BUG hugetlbfs_inode_cache (Not tainted): Objects remaining in hugetlbfs_inode_cache on __kmem_cache_shutdown()
[    0.176640] -----------------------------------------------------------------------------
[    0.176640] 
[    0.176640] Disabling lock debugging due to kernel taint
[    0.176640] INFO: Slab 0x000000006376557a objects=17 used=1 fp=0x00000000154e780a flags=0x4000000000008100
[    0.176640] CPU: 0 PID: 1 Comm: swapper Tainted: G    B            4.16.0-10623-ge979e5a #1
[    0.176640] Call Trace:
[    0.176640]  slab_err+0xad/0xcf
[    0.176640]  ? __kmem_cache_shutdown+0x93/0x301
[    0.176640]  ? __need_fs_reclaim+0x5/0x4e
[    0.176640]  ? prefetch_freepointer+0x5/0x14
[    0.176640]  ? __kmalloc+0x122/0x1c4
[    0.176640]  __kmem_cache_shutdown+0x163/0x301
[    0.176640]  shutdown_cache+0x14/0xf7
[    0.176640]  kmem_cache_destroy+0x15c/0x1a5
[    0.176640]  init_hugetlbfs_fs+0x85/0x15c
[    0.176640]  ? init_ramfs_fs+0x1f/0x1f
[    0.176640]  ? set_debug_rodata+0x11/0x11
[    0.176640]  do_one_initcall+0x9c/0x148
[    0.176640]  kernel_init_freeable+0x11b/0x1a8
[    0.176640]  ? rest_init+0x119/0x119
[    0.176640]  kernel_init+0xa/0xe1
[    0.176640]  ret_from_fork+0x3a/0x50
[    0.176640] INFO: Object 0x00000000e4f03853 @offset=12768
[    0.190206] kmem_cache_destroy hugetlbfs_inode_cache: Slab cache still has objects
[    0.191091] CPU: 0 PID: 1 Comm: swapper Tainted: G    B            4.16.0-10623-ge979e5a #1
[    0.192084] Call Trace:
[    0.192383]  kmem_cache_destroy+0x175/0x1a5
[    0.192889]  init_hugetlbfs_fs+0x85/0x15c
[    0.193362]  ? init_ramfs_fs+0x1f/0x1f
[    0.193809]  ? set_debug_rodata+0x11/0x11
[    0.194282]  do_one_initcall+0x9c/0x148
[    0.194738]  kernel_init_freeable+0x11b/0x1a8
[    0.195249]  ? rest_init+0x119/0x119
[    0.195673]  kernel_init+0xa/0xe1
[    0.196091]  ret_from_fork+0x3a/0x50
[    0.196575] pnp: PnP ACPI init
[    0.197162] pnp 00:00: Plug and Play ACPI device, IDs PNP0b00 (active)
[    0.198248] pnp 00:01: Plug and Play ACPI device, IDs PNP0303 (active)
[    0.199306] pnp 00:02: Plug and Play ACPI device, IDs PNP0f13 (active)
[    0.200357] pnp 00:03: [dma 2]
[    0.200871] pnp 00:03: Plug and Play ACPI device, IDs PNP0700 (active)
[    0.201972] pnp 00:04: Plug and Play ACPI device, IDs PNP0400 (active)
[    0.203059] pnp 00:05: Plug and Play ACPI device, IDs PNP0501 (active)
[    0.204145] pnp 00:06: Plug and Play ACPI device, IDs PNP0501 (active)
[    0.205417] pnp: PnP ACPI: found 7 devices
[    0.210946] clocksource: acpi_pm: mask: 0xffffff max_cycles: 0xffffff, max_idle_ns: 2085701024 ns
[    0.212379] pci_bus 0000:00: resource 4 [io  0x0000-0x0cf7 window]
[    0.213345] pci_bus 0000:00: resource 5 [io  0x0d00-0xffff window]
[    0.214305] pci_bus 0000:00: resource 6 [mem 0x000a0000-0x000bffff window]
[    0.215369] pci_bus 0000:00: resource 7 [mem 0x20000000-0xfebfffff window]
[    0.216528] NET: Registered protocol family 2
[    0.217377] tcp_listen_portaddr_hash hash table entries: 256 (order: 2, 18432 bytes)
[    0.218612] TCP established hash table entries: 4096 (order: 3, 32768 bytes)
[    0.219715] TCP bind hash table entries: 4096 (order: 6, 262144 bytes)
[    0.220834] TCP: Hash tables configured (established 4096 bind 4096)
[    0.221871] UDP hash table entries: 256 (order: 3, 40960 bytes)
[    0.222821] UDP-Lite hash table entries: 256 (order: 3, 40960 bytes)
[    0.223878] NET: Registered protocol family 1
[    0.224727] RPC: Registered named UNIX socket transport module.
[    0.225655] RPC: Registered udp transport module.
[    0.226380] RPC: Registered tcp transport module.
[    0.227129] RPC: Registered tcp NFSv4.1 backchannel transport module.
[    0.228133] pci 0000:00:00.0: Limiting direct PCI/PCI transfers
[    0.229068] pci 0000:00:01.0: PIIX3: Enabling Passive Release
[    0.229981] pci 0000:00:01.0: Activating ISA DMA hang workarounds
[    0.230980] pci 0000:00:02.0: Video device with shadowed ROM at [mem 0x000c0000-0x000dffff]
[    0.232297] PCI: CLS 0 bytes, default 64
[    0.233020] Unpacking initramfs...
[    0.974986] Freeing initrd memory: 48504K
[    0.977560] Scanning for low memory corruption every 60 seconds
[    0.978804] AVX or AES-NI instructions are not detected.
[    0.979656] CPU feature 'AVX registers' is not supported.
[    0.980501] CPU feature 'AVX registers' is not supported.
[    0.981348] AVX2 or AES-NI instructions are not detected.
[    0.982193] AVX2 instructions are not detected.
[    0.982929] rcu-torture:--- Start of test: nreaders=1 nfakewriters=4 stat_interval=60 verbose=1 test_no_idle_hz=1 shuffle_interval=3 stutter=5 irqreader=1 fqs_duration=0 fqs_holdoff=0 fqs_stutter=3 test_boost=1/0 test_boost_interval=7 test_boost_duration=4 shutdown_secs=0 stall_cpu=0 stall_cpu_holdoff=10 stall_cpu_irqsoff=0 n_barrier_cbs=0 onoff_interval=0 onoff_holdoff=0
[    0.988006] rcu-torture: Creating rcu_torture_writer task
[    0.988889] rcu-torture: Creating rcu_torture_fakewriter task
[    0.989798] rcu-torture: rcu_torture_writer task started
[    0.990630] rcu-torture: GP expediting controlled from boot/sysfs for rcu.
[    0.991694] rcu_torture_writer: Testing conditional GPs.
[    0.992531] rcu_torture_writer: Testing expedited GPs.
[    0.993328] rcu_torture_writer: Testing asynchronous GPs.
[    0.994172] rcu_torture_writer: Testing normal GPs.
[    0.994950] rcu-torture: Creating rcu_torture_fakewriter task
[    0.995878] rcu-torture: rcu_torture_fakewriter task started
[    0.996782] rcu-torture: Creating rcu_torture_fakewriter task
[    0.997702] rcu-torture: rcu_torture_fakewriter task started
[    0.998603] rcu-torture: Creating rcu_torture_fakewriter task
[    0.999510] rcu-torture: rcu_torture_fakewriter task started
[    1.000393] rcu-torture: Creating rcu_torture_reader task
[    1.001248] rcu-torture: rcu_torture_fakewriter task started
[    1.002136] rcu-torture: Creating rcu_torture_stats task
[    1.002977] rcu-torture: rcu_torture_reader task started
[    1.003812] rcu-torture: Creating torture_shuffle task
[    1.004645] rcu-torture: rcu_torture_stats task started
[    1.005460] rcu-torture: Creating torture_stutter task
[    1.006271] rcu-torture: torture_shuffle task started
[    1.007943] rcu-torture: Creating rcu_torture_cbflood task
[    1.008818] rcu-torture: torture_stutter task started
[    1.009952] Initialise system trusted keyrings
[    1.010734] rcu-torture: rcu_torture_cbflood task started
[    1.011616] workingset: timestamp_bits=46 max_order=17 bucket_order=0
[    1.014931] fuse init (API version 7.26)
[    1.015647] pstore: using deflate compression
[    1.017988] Key type asymmetric registered
[    1.018646] Asymmetric key parser 'x509' registered
[    1.199721] String selftests succeeded
[    1.200358] 
[    1.200358] Start testing find_bit() with random-filled bitmap
[    1.202928] find_next_bit:                 1064343 ns, 163599 iterations
[    1.205514] find_next_zero_bit:            1102812 ns, 164082 iterations
[    1.207667] find_last_bit:                 1083948 ns, 163599 iterations
[    1.643857] find_first_bit:              435113868 ns, 163599 iterations
[    1.644697] find_next_and_bit:		29529 cycles, 1 iterations
[    1.645349] 
[    1.645349] Start testing find_bit() with sparse bitmap
[    1.646175] find_next_bit:                   12429 ns,    654 iterations
[    1.649136] find_next_zero_bit:            2132542 ns, 327027 iterations
[    1.649955] find_last_bit:                   13912 ns,    654 iterations
[    1.652435] find_first_bit:                1659543 ns,    654 iterations
[    1.653237] find_next_and_bit:		21063 cycles, 1 iterations
[    1.653919] interval tree insert/remove
[    1.658608]  -> 12609 cycles
[    1.659420] interval tree search
[    1.685930]  -> 71379 cycles (2692 results)
[    1.686972] gpio_it87: no device
[    1.687678] hgafb: HGA card not detected.
[    1.688168] hgafb: probe of hgafb.0 failed with error -22
[    1.688959] input: Power Button as /devices/LNXSYSTM:00/LNXPWRBN:00/input/input0
[    1.689845] ACPI: Power Button [PWRF]
[    1.705216] r3964: Philips r3964 Driver $Revision: 1.10 $
[    1.705864] Serial: 8250/16550 driver, 4 ports, IRQ sharing disabled
[    1.731597] 00:05: ttyS0 at I/O 0x3f8 (irq = 4, base_baud = 115200) is a 16550A
[    1.757407] 00:06: ttyS1 at I/O 0x2f8 (irq = 3, base_baud = 115200) is a 16550A
[    1.758806] ppdev: user-space parallel port driver
[    1.759611] dummy-irq: no IRQ given.  Use irq=N
[    1.760363] slram: not enough parameters.
[    1.760904] [nandsim] warning: read_byte: unexpected data output cycle, state is STATE_READY return 0x0
[    1.762022] [nandsim] warning: read_byte: unexpected data output cycle, state is STATE_READY return 0x0
[    1.763137] [nandsim] warning: read_byte: unexpected data output cycle, state is STATE_READY return 0x0
[    1.764253] [nandsim] warning: read_byte: unexpected data output cycle, state is STATE_READY return 0x0
[    1.765363] [nandsim] warning: read_byte: unexpected data output cycle, state is STATE_READY return 0x0
[    1.766473] [nandsim] warning: read_byte: unexpected data output cycle, state is STATE_READY return 0x0
[    1.767603] nand: device found, Manufacturer ID: 0x98, Chip ID: 0x39
[    1.768367] nand: Toshiba NAND 128MiB 1,8V 8-bit
[    1.768930] nand: 128 MiB, SLC, erase size: 16 KiB, page size: 512, OOB size: 16
[    1.769827] flash size: 128 MiB
[    1.770207] page size: 512 bytes
[    1.770603] OOB area size: 16 bytes
[    1.771020] sector size: 16 KiB
[    1.771397] pages number: 262144
[    1.771790] pages per sector: 32
[    1.772178] bus width: 8
[    1.772493] bits in sector size: 14
[    1.772919] bits in page size: 9
[    1.773308] bits in OOB size: 4
[    1.773692] flash size with OOB: 135168 KiB
[    1.774194] page address bytes: 4
[    1.774600] sector address bytes: 3
[    1.775022] options: 0x42
[    1.775809] Scanning device for bad blocks
[    1.791544] Creating 1 MTD partitions on "NAND 128MiB 1,8V 8-bit":
[    1.792291] 0x000000000000-0x000008000000 : "NAND simulator partition 0"
[    1.795690] e1000: Intel(R) PRO/1000 Network Driver - version 7.3.21-k8-NAPI
[    1.796527] e1000: Copyright (c) 1999-2006 Intel Corporation.
[    1.849411] PCI Interrupt Link [LNKC] enabled at IRQ 11
[    2.048910] tsc: Refined TSC clocksource calibration: 2693.504 MHz
[    2.049668] clocksource: tsc: mask: 0xffffffffffffffff max_cycles: 0x26d345dbcd4, max_idle_ns: 440795302414 ns
[    2.248981] e1000 0000:00:03.0 eth0: (PCI:33MHz:32-bit) 52:54:00:12:34:56
[    2.249834] e1000 0000:00:03.0 eth0: Intel(R) PRO/1000 Network Connection
[    2.250872] i8042: PNP: PS/2 Controller [PNP0303:KBD,PNP0f13:MOU] at 0x60,0x64 irq 1,12
[    2.252489] serio: i8042 KBD port at 0x60,0x64 irq 1
[    2.253099] serio: i8042 AUX port at 0x60,0x64 irq 12
[    2.253793] pps_parport: parallel port PPS client
[    2.254691] input: AT Translated Set 2 keyboard as /devices/platform/i8042/serio0/input/input1
[    2.257423] sdhci: Secure Digital Host Controller Interface driver
[    2.258188] sdhci: Copyright(c) Pierre Ossman
[    2.258726] sdhci-pltfm: SDHCI platform and OF driver helper
[    2.260182] NET: Registered protocol family 10
[    2.261002] Segment Routing with IPv6
[    2.261474] sit: IPv6, IPv4 and MPLS over IPv4 tunneling driver
[    2.262342] start plist test
[    2.264692] end plist test
[    2.265510] ... APIC ID:      00000000 (0)
[    2.266001] ... APIC VERSION: 01050014
[    2.266476] 0000000000000000000000000000000000000000000000000000000000000000
[    2.266690] 0000000000000000000000000000000000000000000000000000000000000000
[    2.266690] 0000000000000000000000000000000000000000000000000000000000001000
[    2.269037] number of MP IRQ sources: 15.
[    2.269519] number of IO-APIC #0 registers: 24.
[    2.270053] testing the IO APIC.......................
[    2.270702] IO APIC #0......
[    2.271046] .... register #00: 00000000
[    2.271495] .......    : physical APIC id: 00
[    2.272009] .......    : Delivery Type: 0
[    2.272480] .......    : LTS          : 0
[    2.272958] .... register #01: 00170011
[    2.273410] .......     : max redirection entries: 17
[    2.274007] .......     : PRQ implemented: 0
[    2.274534] .......     : IO APIC version: 11
[    2.275048] .... register #02: 00000000
[    2.275500] .......     : arbitration: 00
[    2.275977] .... IRQ redirection table:
[    2.276429] IOAPIC 0:
[    2.276726]  pin00, disabled, edge , high, V(00), IRR(0), S(0), physical, D(00), M(0)
[    2.277660]  pin01, enabled , edge , high, V(22), IRR(0), S(0), logical , D(01), M(0)
[    2.278610]  pin02, enabled , edge , high, V(30), IRR(0), S(0), logical , D(01), M(0)
[    2.279528]  pin03, disabled, edge , high, V(00), IRR(0), S(0), physical, D(00), M(0)
[    2.280441]  pin04, disabled, edge , high, V(00), IRR(0), S(0), physical, D(00), M(0)
[    2.281362]  pin05, disabled, edge , high, V(00), IRR(0), S(0), physical, D(00), M(0)
[    2.282308]  pin06, disabled, edge , high, V(00), IRR(0), S(0), physical, D(00), M(0)
[    2.283234]  pin07, disabled, edge , high, V(00), IRR(0), S(0), physical, D(00), M(0)
[    2.284154]  pin08, disabled, edge , high, V(00), IRR(0), S(0), physical, D(00), M(0)
[    2.285079]  pin09, enabled , level, high, V(20), IRR(0), S(0), logical , D(01), M(0)
[    2.285999]  pin0a, disabled, edge , high, V(00), IRR(0), S(0), physical, D(00), M(0)
[    2.286949]  pin0b, disabled, edge , high, V(00), IRR(0), S(0), physical, D(00), M(0)
[    2.287873]  pin0c, enabled , edge , high, V(21), IRR(0), S(0), logical , D(01), M(0)
[    2.288805]  pin0d, disabled, edge , high, V(00), IRR(0), S(0), physical, D(00), M(0)
[    2.289737]  pin0e, disabled, edge , high, V(00), IRR(0), S(0), physical, D(00), M(0)
[    2.290684]  pin0f, disabled, edge , high, V(00), IRR(0), S(0), physical, D(00), M(0)
[    2.291604]  pin10, disabled, edge , high, V(00), IRR(0), S(0), physical, D(00), M(0)
[    2.292517]  pin11, disabled, edge , high, V(00), IRR(0), S(0), physical, D(00), M(0)
[    2.293432]  pin12, disabled, edge , high, V(00), IRR(0), S(0), physical, D(00), M(0)
[    2.294377]  pin13, disabled, edge , high, V(00), IRR(0), S(0), physical, D(00), M(0)
[    2.295298]  pin14, disabled, edge , high, V(00), IRR(0), S(0), physical, D(00), M(0)
[    2.296222]  pin15, disabled, edge , high, V(00), IRR(0), S(0), physical, D(00), M(0)
[    2.297154]  pin16, disabled, edge , high, V(00), IRR(0), S(0), physical, D(00), M(0)
[    2.298073]  pin17, disabled, edge , high, V(00), IRR(0), S(0), physical, D(00), M(0)
[    2.299008] IRQ to pin mappings:
[    2.299389] IRQ0 -> 0:2
[    2.299689] IRQ1 -> 0:1
[    2.299985] IRQ3 -> 0:3
[    2.300280] IRQ4 -> 0:4
[    2.300581] IRQ5 -> 0:5
[    2.300876] IRQ6 -> 0:6
[    2.301171] IRQ7 -> 0:7
[    2.301467] IRQ8 -> 0:8
[    2.301769] IRQ9 -> 0:9
[    2.302065] IRQ10 -> 0:10
[    2.302403] IRQ11 -> 0:11
[    2.302723] IRQ12 -> 0:12
[    2.303038] IRQ13 -> 0:13
[    2.303354] IRQ14 -> 0:14
[    2.303673] IRQ15 -> 0:15
[    2.303989] .................................... done.
[    2.304625] sched_clock: Marking stable (2297143279, 0)->(2595402238, -298258959)
[    2.305738] Loading compiled-in X.509 certificates
[    2.306582] Key type encrypted registered
[    2.307075] evm: HMAC attrs: 0x1
[    2.307929] Duplicate name in testcase-data, renamed to "duplicate-name#1"
[    2.309169] ### dt-test ### start of unittest - you will see error messages
[    2.310074] OF: /testcase-data/phandle-tests/consumer-a: could not get #phandle-cells-missing for /testcase-data/phandle-tests/provider1
[    2.311538] OF: /testcase-data/phandle-tests/consumer-a: could not get #phandle-cells-missing for /testcase-data/phandle-tests/provider1
[    2.312971] OF: /testcase-data/phandle-tests/consumer-a: could not find phandle
[    2.313830] OF: /testcase-data/phandle-tests/consumer-a: could not find phandle
[    2.314714] OF: /testcase-data/phandle-tests/consumer-a: arguments longer than property
[    2.315653] OF: /testcase-data/phandle-tests/consumer-a: arguments longer than property
[    2.316637] OF: /testcase-data/phandle-tests/consumer-b: could not get #phandle-missing-cells for /testcase-data/phandle-tests/provider1
[    2.318098] OF: /testcase-data/phandle-tests/consumer-b: could not find phandle
[    2.318987] OF: /testcase-data/phandle-tests/consumer-b: arguments longer than property
[    2.321559] OF: overlay: node_overlaps_later_cs: #6 overlaps with #7 @/testcase-data/overlay-node/test-bus/test-unittest8
[    2.322872] OF: overlay: overlay #6 is not topmost
[    2.324833] ### dt-test ### FAIL of_unittest_overlay_high_level():2304 overlay_base_root not initialized
[    2.325962] ### dt-test ### end of unittest - 206 passed, 1 failed
[    2.329379] IPv6: ADDRCONF(NETDEV_UP): eth0: link is not ready
[    2.887730] input: ImExPS/2 Generic Explorer Mouse as /devices/platform/i8042/serio1/input/input3
[    4.367304] e1000: eth0 NIC Link is Up 1000 Mbps Full Duplex, Flow Control: RX
[    4.369386] IPv6: ADDRCONF(NETDEV_CHANGE): eth0: link becomes ready
[    4.396916] Sending DHCP requests ., OK
[    4.417593] IP-Config: Got DHCP answer from 10.0.2.2, my address is 10.0.2.15
[    4.418702] IP-Config: Complete:
[    4.419202]      device=eth0, hwaddr=52:54:00:12:34:56, ipaddr=10.0.2.15, mask=255.255.255.0, gw=10.0.2.2
[    4.420671]      host=vm-vp-quantal-x86_64-55, domain=, nis-domain=(none)
[    4.421707]      bootserver=10.0.2.2, rootserver=10.0.2.2, rootpath=     nameserver0=10.0.2.3
[    4.423839] integrity: Unable to open file: /etc/keys/x509_evm.der (-2)
[    4.424672] Freeing unused kernel memory: 940K
[    4.426054] Write protecting the kernel read-only data: 14336k
[    4.427887] Freeing unused kernel memory: 2016K
[    4.432055] Freeing unused kernel memory: 872K
[    4.433069] x86/mm: Checked W+X mappings: passed, no W+X pages found.
[    4.434198] x86/mm: Checking user space page tables
[    4.435141] x86/mm: Checked W+X mappings: passed, no W+X pages found.
[    4.456413] process 1 (init) attempted a POSIX timer syscall while CONFIG_POSIX_TIMERS is not set
[    4.524457] init: Failed to create pty - disabling logging for job
[    4.525595] init: Temporary process spawn error: No such file or directory
[    4.536192] init: Failed to create pty - disabling logging for job
[    4.537495] init: Temporary process spawn error: No such file or directory
[    4.562690] init: Failed to create pty - disabling logging for job
[    4.564027] init: Temporary process spawn error: No such file or directory
[    4.568576] init: Failed to create pty - disabling logging for job
[    4.569926] init: Temporary process spawn error: No such file or directory
[    4.614206] init: Failed to create pty - disabling logging for job
[    4.615290] init: Temporary process spawn error: No such file or directory
[    4.620935] init: Failed to create pty - disabling logging for job
[    4.622261] init: Temporary process spawn error: No such file or directory
[    4.636437] init: Failed to create pty - disabling logging for job
[    4.637816] init: Temporary process spawn error: No such file or directory
[    4.643525] udevd[168]: starting version 175
[    4.650285] init: Failed to create pty - disabling logging for job
[    4.652939] init: Temporary process spawn error: No such file or directory
[    4.658310] init: Failed to create pty - disabling logging for job
[    4.659673] init: Temporary process spawn error: No such file or directory
[    4.665561] init: Failed to create pty - disabling logging for job
[    4.666837] init: Temporary process spawn error: No such file or directory
[    4.688259] init: Failed to create pty - disabling logging for job
[    4.689616] init: Temporary process spawn error: No such file or directory
[    4.696940] init: Failed to create pty - disabling logging for job
[    4.698232] init: Temporary process spawn error: No such file or directory
udevd[179]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:LNXSYSTM:': No such file or directory
udevd[200]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv pci:v00008086d00007010sv00001AF4sd00001100bc01sc01i80': No such file or directory
udevd[202]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv pci:v00001234d00001111sv00001AF4sd00001100bc03sc00i00': No such file or directory
udevd[201]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv pci:v00008086d00007113sv00001AF4sd00001100bc06sc80i00': No such file or directory
udevd[203]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv pci:v00008086d00001237sv00001AF4sd00001100bc06sc00i00': No such file or directory
udevd[199]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv pci:v00008086d00007000sv00001AF4sd00001100bc06sc01i00': No such file or directory
udevd[181]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv input:b0019v0000p0001e0000-e0,1,k74,ramlsfw': No such file or directory
udevd[204]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv pci:v00008086d000025ABsv00001AF4sd00001100bc08sc80i00': No such file or directory
udevd[205]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:PNP0103:': No such file or directory
udevd[206]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:LNXSYBUS:': No such file or directory
udevd[208]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv platform:hgafb': No such file or directory
udevd[209]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv platform:platform-framebuffer': No such file or directory
udevd[210]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:LNXSYBUS:': No such file or directory
[    4.823216] init: Failed to create pty - disabling logging for job
[    4.824610] init: Temporary process spawn error: No such file or directory
udevd[220]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:PNP0C0F:': No such file or directory
[    4.833500] init: Failed to create pty - disabling logging for job
[    4.834898] init: Temporary process spawn error: No such file or directory
udevd[216]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:PNP0C0F:': No such file or directory
udevd[213]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:PNP0103:': No such file or directory
udevd[214]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:PNP0A03:': No such file or directory
udevd[215]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:PNP0C0F:': No such file or directory
udevd[217]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:PNP0C0F:': No such file or directory
udevd[218]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:ACPI0010:PNP0A05:': No such file or directory
udevd[219]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:PNP0C0F:': No such file or directory
udevd[225]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv input:b0011v0002p0006e0000-e0,1,2,k110,111,112,113,114,r0,1,6,8,amlsfw': No such file or directory
udevd[224]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv input:b0011v0001p0001eAB41-e0,1,4,11,14,k71,72,73,74,75,76,77,79,7A,7B,7C,7D,7E,7F,80,8C,8E,8F,9B,9C,9D,9E,9F,A3,A4,A5,A6,AC,AD,B7,B8,B9,D9,E2,ram4,l0,1,2,sfw': No such file or directory
udevd[227]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:LNXCPU:': No such file or directory
udevd[226]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:LNXCPU:': No such file or directory
udevd[228]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:PNP0A06:': No such file or directory
udevd[229]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:PNP0A06:': No such file or directory
udevd[230]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:PNP0A06:': No such file or directory
udevd[231]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:QEMU0002:': No such file or directory
udevd[257]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:PNP0303:': No such file or directory
udevd[260]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:PNP0501:': No such file or directory
udevd[259]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:PNP0501:': No such file or directory
udevd[261]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:PNP0700:': No such file or directory
udevd[262]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:PNP0B00:': No such file or directory
udevd[258]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:PNP0400:': No such file or directory
udevd[265]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv of:Ntestcase-device1T<NULL>Ctestcase-device': No such file or directory
udevd[263]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv acpi:PNP0F13:': No such file or directory
udevd[264]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv of:Ni2c-test-busT<NULL>Cunittest-i2c-bus': No such file or directory
udevd[266]: failed to execute '/sbin/modprobe' '/sbin/modprobe -bv of:Ntestcase-device2T<NULL>Ctestcase-device': No such file or directory
[    4.996185] init: Failed to create pty - disabling logging for job
[    4.997047] init: Temporary process spawn error: No such file or directory
[    5.015328] init: Failed to create pty - disabling logging for job
[    5.016572] init: Temporary process spawn error: No such file or directory
[    5.097490] init: failsafe main process (279) killed by TERM signal
[    5.185753] init: Failed to create pty - disabling logging for job
[    5.186638] init: Temporary process spawn error: No such file or directory
[    5.197427] init: Failed to create pty - disabling logging for job
[    5.198326] init: Temporary process spawn error: No such file or directory
[    5.205050] init: Failed to create pty - disabling logging for job
[    5.205900] init: Temporary process spawn error: No such file or directory
[    5.215941] init: Failed to create pty - disabling logging for job
[    5.216789] init: Temporary process spawn error: No such file or directory
[    5.222744] init: Failed to create pty - disabling logging for job
[    5.223567] init: Temporary process spawn error: No such file or directory
start: Job is already running: rc
PATH=/sbin:/usr/sbin:/bin:/usr/bin:/lkp/lkp/src/bin
Kernel tests: Boot OK!
Kernel tests: Boot OK!
umount: /tmp: device is busy.
        (In some cases useful info about processes that use
         the device is found by lsof(8) or fuser(1))
Trinity v1.4pre  Dave Jones <davej@redhat.com>
[init] Marking syscall get_robust_list (64bit:274 32bit:312) as to be disabled.
Done parsing arguments.
Marking all syscalls as enabled.
[init] Disabling syscalls marked as disabled by command line options
[init] Marked 64-bit syscall get_robust_list (274) as deactivated.
[init] Marked 32-bit syscall get_robust_list (312) as deactivated.
[    5.645965] init: Failed to create pty - disabling logging for job
[    5.647396] init: Temporary process spawn error: No such file or directory
[    5.654911] init: udev-fallback-graphics main process (375) terminated with status 127
[    5.656829] init: Failed to create pty - disabling logging for job
[    5.657652] init: Temporary process spawn error: No such file or directory
[    5.661599] init: Failed to create pty - disabling logging for job
[    5.662426] init: Temporary process spawn error: No such file or directory
LKP: HOSTNAME vm-vp-quantal-x86_64-55, MAC 52:54:00:12:34:56, kernel 4.16.0-10623-ge979e5a 1, serial console /dev/ttyS0
[    5.670058] init: Failed to create pty - disabling logging for job
[    5.670888] init: Temporary process spawn error: No such file or directory
[init] 32-bit syscalls: 350 enabled, 1 disabled.  64-bit syscalls: 313 enabled, 1 disabled.
DANGER: RUNNING AS ROOT.
Unless you are running in a virtual machine, this could cause serious problems such as overwriting CMOS
or similar which could potentially make this machine unbootable without a firmware reset.

ctrl-c now unless you really know what you are doing.
[    5.691361] init: networking main process (382) terminated with status 1
[    5.795336] 
[    5.803455] hostname: the specified hostname is invalid
[    5.803462] 
[    5.809270] /lkp/lkp/src/bin/run-lkp
[    5.809275] 
[    5.864698] RESULT_ROOT=/result/boot/1/vm-vp-quantal-x86_64/quantal-core-x86_64.cgz/x86_64-randconfig-s4-04092351/gcc-7/e979e5a0591e70ad0b41cf876ee987de468a220e/0
[    5.864704] 
[    5.879197] job=/lkp/scheduled/vm-vp-quantal-x86_64-55/boot-1-quantal-core-x86_64.cgz-e979e5a0591e70ad0b41cf876ee987de468a220e-20180410-85306-1wybswc-1.yaml
[    5.879202] 
[    5.886040] run-job /lkp/scheduled/vm-vp-quantal-x86_64-55/boot-1-quantal-core-x86_64.cgz-e979e5a0591e70ad0b41cf876ee987de468a220e-20180410-85306-1wybswc-1.yaml
[    5.886044] 
[    5.890931] Cannot find wget/curl.
[    5.890935] 
[    5.901214] skip microcode check for virtual machine
[    5.901223] 
[    8.081372] 
[    8.085327] /lkp/lkp/src/lib/job-init.sh: line 167:   408 Terminated              tail -n 0 -f $* > $file
[    8.085331] 
[    8.098743] /lkp/lkp/src/lib/job-init.sh: line 167:   409 Terminated              tail -n 0 -f $* > $file
[    8.098747] 
[    8.106807] Cannot find wget/curl.
[    8.106811] 
[    9.143772] 
[    9.151925] wait for background monitors: 451 oom-killer
[    9.151931] 
[   11.276350] 
[   11.296107] Cannot find wget/curl.
[   11.296112] 
[   11.306059] LKP: rebooting
[   11.306064] 
[   11.307792] sysrq: SysRq : Emergency Sync
[   11.308321] Emergency Sync complete
[   11.308821] sysrq: SysRq : Resetting

Elapsed time: 10

#!/bin/bash

# To reproduce,
# 1) save job-script and this script (both are attached in 0day report email)
# 2) run this script with your compiled kernel and optional env $INSTALL_MOD_PATH

kernel=$1

initrds=(
	/osimage/quantal/quantal-core-x86_64.cgz
	/lkp/lkp/lkp-x86_64.cgz
)

HTTP_PREFIX=https://github.com/0day-ci/lkp-qemu/raw/master
wget --timestamping "${initrds[@]/#/$HTTP_PREFIX}"

{
	cat "${initrds[@]//*\//}"
	[[ $INSTALL_MOD_PATH ]] && (
		cd "$INSTALL_MOD_PATH"
		find lib | cpio -o -H newc --quiet | gzip
	)
	echo  job-script | cpio -o -H newc --quiet | gzip
} > initrd.img

kvm=(
	qemu-system-x86_64
	-enable-kvm
	-kernel $kernel
	-initrd initrd.img
	-m 512
	-smp 2
	-device e1000,netdev=net0
	-netdev user,id=net0
	-boot order=nc
	-no-reboot
	-watchdog i6300esb
	-watchdog-action debug
	-rtc base=localtime
	-serial stdio
	-display none
	-monitor null
)

append=(
	ip=::::vm-vp-quantal-x86_64-55::dhcp
	root=/dev/ram0
	user=lkp
	job=/job-script
	ARCH=x86_64
	kconfig=x86_64-randconfig-s4-04092351
	branch=linux-devel/devel-catchup-201804100006
	commit=e979e5a0591e70ad0b41cf876ee987de468a220e
	BOOT_IMAGE=/pkg/linux/x86_64-randconfig-s4-04092351/gcc-7/e979e5a0591e70ad0b41cf876ee987de468a220e/vmlinuz-4.16.0-10623-ge979e5a
	max_uptime=600
	RESULT_ROOT=/result/boot/1/vm-vp-quantal-x86_64/quantal-core-x86_64.cgz/x86_64-randconfig-s4-04092351/gcc-7/e979e5a0591e70ad0b41cf876ee987de468a220e/0
	result_service=tmpfs
	debug
	apic=debug
	sysrq_always_enabled
	rcupdate.rcu_cpu_stall_timeout=100
	net.ifnames=0
	printk.devkmsg=on
	panic=-1
	softlockup_panic=1
	nmi_watchdog=panic
	oops=panic
	load_ramdisk=2
	prompt_ramdisk=0
	drbd.minor_count=8
	systemd.log_level=err
	ignore_loglevel
	console=tty0
	earlyprintk=ttyS0,115200
	console=ttyS0,115200
	vga=normal
	rw
	drbd.minor_count=8
	rcuperf.shutdown=0
)

"${kvm[@]}" -append "${append[*]}"
