Hi Kees,
I got the below dmesg and the first bad commit is
git://git.kernel.org/pub/scm/linux/kernel/git/tip/tip.git x86/kaslr
commit e2b32e6785138d92d2a40e0d0473575c8c7310a2
Author: Kees Cook <keescook@chromium.org>
AuthorDate: Tue Feb 25 16:59:17 2014 -0800
Commit: H. Peter Anvin <hpa@linux.intel.com>
CommitDate: Tue Feb 25 17:07:26 2014 -0800
x86, kaslr: randomize module base load address
+----------------------------------------------------+-----------+------------+---------------+
| | v3.14-rc4 | e2b32e6785 | next-20140307 |
+----------------------------------------------------+-----------+------------+---------------+
| boot_successes | 86 | 9 | 5 |
| boot_failures | 4 | 21 | 14 |
| BUG:kernel_boot_hang | 4 | 1 | |
| INFO:possible_circular_locking_dependency_detected | 0 | 20 | 13 |
| backtrace:register_kprobe | 0 | 20 | 13 |
| backtrace:init_test_probes | 0 | 20 | 13 |
| backtrace:init_kprobes | 0 | 20 | 13 |
| backtrace:kernel_init_freeable | 0 | 20 | 13 |
| backtrace:kprobe_optimizer | 0 | 20 | 13 |
| BUG:kernel_test_crashed | 0 | 0 | 1 |
+----------------------------------------------------+-----------+------------+---------------+
[ 0.489404] Kprobe smoke test started
[ 0.514663]
[ 0.515287] ======================================================
[ 0.515561] [ INFO: possible circular locking dependency detected ]
[ 0.515561] 3.14.0-rc5-next-20140307-07129-g1b0a7e3 #1 Not tainted
[ 0.515561] -------------------------------------------------------
[ 0.515561] kworker/0:1/25 is trying to acquire lock:
[ 0.515561] (text_mutex){+.+.+.}, at: [<ffffffff855c2531>] kprobe_optimizer+0x121/0x23c
[ 0.515561]
[ 0.515561] but task is already holding lock:
[ 0.515561] (module_mutex){+.+...}, at: [<ffffffff855c2435>] kprobe_optimizer+0x25/0x23c
[ 0.515561]
[ 0.515561] which lock already depends on the new lock.
[ 0.515561]
[ 0.515561]
[ 0.515561] the existing dependency chain (in reverse order) is:
[ 0.515561]
-> #2 (module_mutex){+.+...}:
[ 0.515561] [<ffffffff850b3a65>] __lock_acquire+0x910/0xa03
[ 0.515561] [<ffffffff850b4043>] lock_acquire+0xa4/0xc4
[ 0.515561] [<ffffffff855ba2fe>] mutex_lock_nested+0x65/0x34a
[ 0.515561] [<ffffffff8502f954>] module_alloc+0x42/0xb5
[ 0.515561] [<ffffffff850db8e5>] alloc_insn_page+0xe/0x10
[ 0.515561] [<ffffffff855c272c>] __get_insn_slot+0xe0/0x165
[ 0.515561] [<ffffffff855bfa73>] arch_prepare_kprobe+0x36/0xb7
[ 0.515561] [<ffffffff855c3401>] register_kprobe+0x330/0x490
[ 0.515561] [<ffffffff850d6ff2>] init_test_probes+0x4e/0x489
[ 0.515561] [<ffffffff85b7017c>] init_kprobes+0x17b/0x189
[ 0.515561] [<ffffffff850020fb>] do_one_initcall+0x9f/0x135
[ 0.515561] [<ffffffff85b54f65>] kernel_init_freeable+0x104/0x196
[ 0.515561] [<ffffffff855adbe9>] kernel_init+0x9/0xd5
[ 0.515561] [<ffffffff855c3c8c>] ret_from_fork+0x7c/0xb0
[ 0.515561]
-> #1 (kprobe_insn_slots.mutex){+.+.+.}:
[ 0.515561] [<ffffffff850b3a65>] __lock_acquire+0x910/0xa03
[ 0.515561] [<ffffffff850b4043>] lock_acquire+0xa4/0xc4
[ 0.515561] [<ffffffff855ba2fe>] mutex_lock_nested+0x65/0x34a
[ 0.515561] [<ffffffff855c2668>] __get_insn_slot+0x1c/0x165
[ 0.515561] [<ffffffff855bfa73>] arch_prepare_kprobe+0x36/0xb7
[ 0.515561] [<ffffffff855c3401>] register_kprobe+0x330/0x490
[ 0.515561] [<ffffffff850d6ff2>] init_test_probes+0x4e/0x489
[ 0.515561] [<ffffffff85b7017c>] init_kprobes+0x17b/0x189
[ 0.515561] [<ffffffff850020fb>] do_one_initcall+0x9f/0x135
[ 0.515561] [<ffffffff85b54f65>] kernel_init_freeable+0x104/0x196
[ 0.515561] [<ffffffff855adbe9>] kernel_init+0x9/0xd5
[ 0.515561] [<ffffffff855c3c8c>] ret_from_fork+0x7c/0xb0
[ 0.515561]
-> #0 (text_mutex){+.+.+.}:
[ 0.515561] [<ffffffff850b0e0f>] validate_chain.isra.20+0x8cf/0xf2e
[ 0.515561] [<ffffffff850b3a65>] __lock_acquire+0x910/0xa03
[ 0.515561] [<ffffffff850b4043>] lock_acquire+0xa4/0xc4
[ 0.515561] [<ffffffff855ba2fe>] mutex_lock_nested+0x65/0x34a
[ 0.515561] [<ffffffff855c2531>] kprobe_optimizer+0x121/0x23c
[ 0.515561] [<ffffffff8508dfc4>] process_one_work+0x237/0x3db
[ 0.515561] [<ffffffff8508edc2>] worker_thread+0x1cb/0x2c4
[ 0.515561] [<ffffffff8509498b>] kthread+0xf1/0xf9
[ 0.515561] [<ffffffff855c3c8c>] ret_from_fork+0x7c/0xb0
[ 0.515561]
[ 0.515561] other info that might help us debug this:
[ 0.515561]
[ 0.515561] Chain exists of:
text_mutex --> kprobe_insn_slots.mutex --> module_mutex
[ 0.515561] Possible unsafe locking scenario:
[ 0.515561]
[ 0.515561] CPU0 CPU1
[ 0.515561] ---- ----
[ 0.515561] lock(module_mutex);
[ 0.515561] lock(kprobe_insn_slots.mutex);
[ 0.515561] lock(module_mutex);
[ 0.515561] lock(text_mutex);
[ 0.515561]
[ 0.515561] *** DEADLOCK ***
[ 0.515561]
[ 0.515561] 4 locks held by kworker/0:1/25:
[ 0.515561] #0: ("events"){.+.+..}, at: [<ffffffff8508df5e>] process_one_work+0x1d1/0x3db
[ 0.515561] #1: ((optimizing_work).work){+.+...}, at: [<ffffffff8508df5e>] process_one_work+0x1d1/0x3db
[ 0.515561] #2: (kprobe_mutex){+.+.+.}, at: [<ffffffff855c2427>] kprobe_optimizer+0x17/0x23c
[ 0.515561] #3: (module_mutex){+.+...}, at: [<ffffffff855c2435>] kprobe_optimizer+0x25/0x23c
[ 0.515561]
[ 0.515561] stack backtrace:
[ 0.515561] CPU: 0 PID: 25 Comm: kworker/0:1 Not tainted 3.14.0-rc5-next-20140307-07129-g1b0a7e3 #1
[ 0.515561] Hardware name: Bochs Bochs, BIOS Bochs 01/01/2011
[ 0.515561] Workqueue: events kprobe_optimizer
[ 0.515561] 0000000000000000 ffff8800137e3b60 ffffffff855b5b1d ffffffff86069110
[ 0.515561] ffff8800137e3ba0 ffffffff855b2850 ffff8800137e4650 ffff8800137e5318
[ 0.515561] ffff8800137e4650 ffff8800137e5318 0000000000000004 ffff8800137e52f0
[ 0.515561] Call Trace:
[ 0.515561] [<ffffffff855b5b1d>] dump_stack+0x4d/0x66
[ 0.515561] [<ffffffff855b2850>] print_circular_bug+0x2b4/0x2c2
[ 0.515561] [<ffffffff850b0e0f>] validate_chain.isra.20+0x8cf/0xf2e
[ 0.515561] [<ffffffff850b3a65>] __lock_acquire+0x910/0xa03
[ 0.515561] [<ffffffff850b4043>] lock_acquire+0xa4/0xc4
[ 0.515561] [<ffffffff855c2531>] ? kprobe_optimizer+0x121/0x23c
[ 0.515561] [<ffffffff855ba2fe>] mutex_lock_nested+0x65/0x34a
[ 0.515561] [<ffffffff855c2531>] ? kprobe_optimizer+0x121/0x23c
[ 0.515561] [<ffffffff850b1d8d>] ? trace_hardirqs_on+0xd/0xf
[ 0.515561] [<ffffffff855c2531>] kprobe_optimizer+0x121/0x23c
[ 0.515561] [<ffffffff8508dfc4>] process_one_work+0x237/0x3db
[ 0.515561] [<ffffffff8508df5e>] ? process_one_work+0x1d1/0x3db
[ 0.515561] [<ffffffff8508edc2>] worker_thread+0x1cb/0x2c4
[ 0.515561] [<ffffffff8508ebf7>] ? rescuer_thread+0x29b/0x29b
[ 0.515561] [<ffffffff8509498b>] kthread+0xf1/0xf9
[ 0.515561] [<ffffffff8509489a>] ? kthread_stop+0x5a/0x5a
[ 0.515561] [<ffffffff855c3c8c>] ret_from_fork+0x7c/0xb0
[ 0.515561] [<ffffffff8509489a>] ? kthread_stop+0x5a/0x5a
[ 0.679517] Kprobe smoke test passed successfully
[ 0.681393] bounce pool size: 64 pages
[ 0.682499] HugeTLB registered 2 MB page size, pre-allocated 0 pages
git bisect start 56032fc504c9ce9dd6fd697e4687441a7d0ea4a2 v3.13 --
git bisect good 7df4d0c9784117f7bbaec17e9ac7f6545049b56d # 18:32 25+ 2 Merge tag 'spi-v3.14-rc2' of git://git.kernel.org/pub/scm/linux/kernel/git/broonie/spi
git bisect good b338b822eba2fdcbad7aa4149899fb734f9f16ec # 18:45 25+ 0 Merge remote-tracking branch 'input-current/for-linus'
git bisect good 992670b5cd97fdc97e9fe15c3f8c16c218749c96 # 18:58 25+ 0 Merge remote-tracking branch 'net-next/master'
git bisect good 8b42ab5d6c5140cad34957a32fa6bdf43e7e0303 # 19:14 25+ 0 Merge remote-tracking branch 'spi/for-next'
git bisect bad 25ec37d3e3bf1f9efec6f05d79fd976bff4624cd # 19:33 2- 8 Merge remote-tracking branch 'staging/staging-next'
git bisect bad d2d275f41085c59209725f813c243d318f185d36 # 19:55 0- 2 Merge remote-tracking branch 'workqueues/for-next'
git bisect bad e88f8465cfcce042e48ff38e796b64df973c7048 # 20:07 0- 4 Merge remote-tracking branch 'ftrace/for-next'
git bisect bad f4f48a2692f9de0d1ebbeee7ba192a99e86d1773 # 20:24 0- 1 Merge remote-tracking branch 'tip/auto-latest'
git bisect good c149ec107189eeaa818dff7d97e6fe74b0d61bc2 # 20:49 25+ 2 Merge branch 'perf/core'
git bisect good d27c8438eeedb6e1367b592c101e3c87cca0b50f # 21:17 25+ 0 Merge branch 'timers/core' into sched/idle
git bisect good abb27428861a8e3fb90c063e2f2c3cdf8e20b1b7 # 21:31 25+ 0 Merge branch 'x86/asmlinkage'
git bisect bad 1a1985d4555edb30b8d807046c7c6f3ca9221217 # 21:41 0- 1 Merge branch 'x86/mm'
git bisect good 957d31ef264d0c8012dcb4a47543987bbdf2c184 # 21:50 25+ 0 Merge branch 'x86/cpu'
git bisect good ea4b5c80da79debb2d29e8c27a19a7579d2867c3 # 22:09 25+ 0 Merge branch 'x86/cpufeature'
git bisect bad d6e451515a6167b63e79612c7c107d0916d7f2b2 # 22:18 1- 1 Merge branch 'x86/kaslr'
git bisect bad e2b32e6785138d92d2a40e0d0473575c8c7310a2 # 22:25 1- 4 x86, kaslr: randomize module base load address
# first bad commit: [e2b32e6785138d92d2a40e0d0473575c8c7310a2] x86, kaslr: randomize module base load address
git bisect good cfbf8d4857c26a8a307fb7cd258074c9dcd8c691 # 22:55 90+ 4 Linux 3.14-rc4
git bisect bad 1b0a7e3263168a06d3858798e48c5a21d1c78d3c # 22:55 0- 14 Add linux-next specific files for 20140307
git bisect good ca62eec4e524591b82d9edf7a18e3ae6b691517d # 23:39 90+ 1 Merge branch 'for-3.14-fixes' of git://git.kernel.org/pub/scm/linux/kernel/git/tj/cgroup
git bisect bad 1b0a7e3263168a06d3858798e48c5a21d1c78d3c # 23:39 0- 14 Add linux-next specific files for 20140307
Thanks,
Fengguang
early console in setup code
Probing EDD (edd=off to disable)... ok
early console in decompress_kernel
KASLR using RDTSC...
Decompressing Linux... Parsing ELF... Performing relocations... done.
Booting the kernel.
[ 0.000000] Linux version 3.14.0-rc5-next-20140307-07129-g1b0a7e3 (kbuild@roam) (gcc version 4.8.1 (Debian 4.8.1-8) ) #1 SMP Sun Mar 9 13:41:01 CST 2014
[ 0.000000] Command line: hung_task_panic=1 earlyprintk=ttyS0,115200 debug apic=debug sysrq_always_enabled rcupdate.rcu_cpu_stall_timeout=100 panic=10 softlockup_panic=1 nmi_watchdog=panic prompt_ramdisk=0 console=ttyS0,115200 console=tty0 vga=normal root=/dev/ram0 rw link=/kernel-tests/run-queue/kvm/x86_64-randconfig-r5-03091328/next:master/.vmlinuz-1b0a7e3263168a06d3858798e48c5a21d1c78d3c-20140309134226-8-ivytown2 branch=next/master BOOT_IMAGE=/kernel/x86_64-randconfig-r5-03091328/1b0a7e3263168a06d3858798e48c5a21d1c78d3c/vmlinuz-3.14.0-rc5-next-20140307-07129-g1b0a7e3
[ 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-0x0000000013ffdfff] usable
[ 0.000000] BIOS-e820: [mem 0x0000000013ffe000-0x0000000013ffffff] reserved
[ 0.000000] BIOS-e820: [mem 0x00000000feffc000-0x00000000feffffff] reserved
[ 0.000000] BIOS-e820: [mem 0x00000000fffc0000-0x00000000ffffffff] reserved
[ 0.000000] bootconsole [earlyser0] enabled
[ 0.000000] NX (Execute Disable) protection: active
[ 0.000000] SMBIOS 2.4 present.
[ 0.000000] DMI: Bochs Bochs, BIOS Bochs 01/01/2011
[ 0.000000] Hypervisor detected: KVM
[ 0.000000] e820: update [mem 0x00000000-0x00000fff] usable ==> reserved
[ 0.000000] e820: remove [mem 0x000a0000-0x000fffff] usable
[ 0.000000] No AGP bridge found
[ 0.000000] e820: last_pfn = 0x13ffe max_arch_pfn = 0x400000000
[ 0.000000] MTRR default type: write-back
[ 0.000000] MTRR fixed ranges enabled:
[ 0.000000] 00000-9FFFF write-back
[ 0.000000] A0000-BFFFF uncachable
[ 0.000000] C0000-FFFFF write-protect
[ 0.000000] MTRR variable ranges enabled:
[ 0.000000] 0 base 0080000000 mask FF80000000 uncachable
[ 0.000000] 1 disabled
[ 0.000000] 2 disabled
[ 0.000000] 3 disabled
[ 0.000000] 4 disabled
[ 0.000000] 5 disabled
[ 0.000000] 6 disabled
[ 0.000000] 7 disabled
[ 0.000000] x86 PAT enabled: cpu 0, old 0x70406, new 0x7010600070106
[ 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 0x000fdae0-0x000fdaef] mapped at [ffff8800000fdae0]
[ 0.000000] mpc: fdaf0-fdbe4
[ 0.000000] Scanning 1 areas for low memory corruption
[ 0.000000] Base memory trampoline at [ffff880000099000] 99000 size 24576
[ 0.000000] init_memory_mapping: [mem 0x00000000-0x000fffff]
[ 0.000000] [mem 0x00000000-0x000fffff] page 4k
[ 0.000000] BRK [0x06691000, 0x06691fff] PGTABLE
[ 0.000000] BRK [0x06692000, 0x06692fff] PGTABLE
[ 0.000000] BRK [0x06693000, 0x06693fff] PGTABLE
[ 0.000000] init_memory_mapping: [mem 0x13a00000-0x13bfffff]
[ 0.000000] [mem 0x13a00000-0x13bfffff] page 4k
[ 0.000000] BRK [0x06694000, 0x06694fff] PGTABLE
[ 0.000000] init_memory_mapping: [mem 0x10000000-0x139fffff]
[ 0.000000] [mem 0x10000000-0x139fffff] page 4k
[ 0.000000] BRK [0x06695000, 0x06695fff] PGTABLE
[ 0.000000] BRK [0x06696000, 0x06696fff] PGTABLE
[ 0.000000] init_memory_mapping: [mem 0x00100000-0x0fffffff]
[ 0.000000] [mem 0x00100000-0x0fffffff] page 4k
[ 0.000000] init_memory_mapping: [mem 0x13c00000-0x13ffdfff]
[ 0.000000] [mem 0x13c00000-0x13ffdfff] page 4k
[ 0.000000] RAMDISK: [mem 0x13ce6000-0x13feffff]
[ 0.000000] ACPI: RSDP 0x00000000000FD950 000014 (v00 BOCHS )
[ 0.000000] ACPI: RSDT 0x0000000013FFE450 000034 (v01 BOCHS BXPCRSDT 00000001 BXPC 00000001)
[ 0.000000] ACPI: FACP 0x0000000013FFFF80 000074 (v01 BOCHS BXPCFACP 00000001 BXPC 00000001)
[ 0.000000] ACPI: DSDT 0x0000000013FFE490 0011A9 (v01 BXPC BXDSDT 00000001 INTL 20100528)
[ 0.000000] ACPI: FACS 0x0000000013FFFF40 000040
[ 0.000000] ACPI: SSDT 0x0000000013FFF7A0 000796 (v01 BOCHS BXPCSSDT 00000001 BXPC 00000001)
[ 0.000000] ACPI: APIC 0x0000000013FFF680 000080 (v01 BOCHS BXPCAPIC 00000001 BXPC 00000001)
[ 0.000000] ACPI: HPET 0x0000000013FFF640 000038 (v01 BOCHS BXPCHPET 00000001 BXPC 00000001)
[ 0.000000] ACPI: Local APIC address 0xfee00000
[ 0.000000] mapped APIC to ffffffffff57a000 ( fee00000)
[ 0.000000] kvm-clock: Using msrs 4b564d01 and 4b564d00
[ 0.000000] kvm-clock: cpu 0, msr 0:13c66001, primary cpu clock
[ 0.000000] Zone ranges:
[ 0.000000] DMA [mem 0x00001000-0x00ffffff]
[ 0.000000] DMA32 [mem 0x01000000-0xffffffff]
[ 0.000000] Normal empty
[ 0.000000] Movable zone start for each node
[ 0.000000] Early memory node ranges
[ 0.000000] node 0: [mem 0x00001000-0x0009efff]
[ 0.000000] node 0: [mem 0x00100000-0x13ffdfff]
[ 0.000000] On node 0 totalpages: 81820
[ 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: 1216 pages used for memmap
[ 0.000000] DMA32 zone: 77822 pages, LIFO batch:15
[ 0.000000] ACPI: PM-Timer IO Port: 0xb008
[ 0.000000] ACPI: Local APIC address 0xfee00000
[ 0.000000] mapped APIC to ffffffffff57a000 ( fee00000)
[ 0.000000] ACPI: LAPIC (acpi_id[0x00] lapic_id[0x00] enabled)
[ 0.000000] ACPI: LAPIC (acpi_id[0x01] lapic_id[0x01] enabled)
[ 0.000000] ACPI: LAPIC_NMI (acpi_id[0xff] dfl dfl lint[0x1])
[ 0.000000] ACPI: IOAPIC (id[0x00] address[0xfec00000] gsi_base[0])
[ 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] ACPI: IRQ2 used by override.
[ 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] smpboot: Allowing 2 CPUs, 0 hotplug CPUs
[ 0.000000] mapped IOAPIC to ffffffffff579000 (fec00000)
[ 0.000000] nr_irqs_gsi: 40
[ 0.000000] e820: [mem 0x14000000-0xfeffbfff] available for PCI devices
[ 0.000000] Booting paravirtualized kernel on KVM
[ 0.000000] setup_percpu: NR_CPUS:8192 nr_cpumask_bits:2 nr_cpu_ids:2 nr_node_ids:1
[ 0.000000] PERCPU: Embedded 27 pages/cpu @ffff880013800000 s79232 r8192 d23168 u1048576
[ 0.000000] pcpu-alloc: s79232 r8192 d23168 u1048576 alloc=1*2097152
[ 0.000000] pcpu-alloc: [0] 0 1
[ 0.000000] KVM setup async PF for cpu 0
[ 0.000000] kvm-stealtime: cpu 0, msr 1380dc40
[ 0.000000] Built 1 zonelists in Zone order, mobility grouping on. Total pages: 80519
[ 0.000000] Kernel command line: hung_task_panic=1 earlyprintk=ttyS0,115200 debug apic=debug sysrq_always_enabled rcupdate.rcu_cpu_stall_timeout=100 panic=10 softlockup_panic=1 nmi_watchdog=panic prompt_ramdisk=0 console=ttyS0,115200 console=tty0 vga=normal root=/dev/ram0 rw link=/kernel-tests/run-queue/kvm/x86_64-randconfig-r5-03091328/next:master/.vmlinuz-1b0a7e3263168a06d3858798e48c5a21d1c78d3c-20140309134226-8-ivytown2 branch=next/master BOOT_IMAGE=/kernel/x86_64-randconfig-r5-03091328/1b0a7e3263168a06d3858798e48c5a21d1c78d3c/vmlinuz-3.14.0-rc5-next-20140307-07129-g1b0a7e3
[ 0.000000] sysrq: sysrq always enabled.
[ 0.000000] PID hash table entries: 2048 (order: 2, 16384 bytes)
[ 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] Checking aperture...
[ 0.000000] No AGP bridge found
[ 0.000000] Memory: 292616K/327280K available (5911K kernel code, 1272K rwdata, 3396K rodata, 1040K init, 10520K bss, 34664K reserved)
[ 0.000000] Hierarchical RCU implementation.
[ 0.000000] RCU: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=2
[ 0.000000] NR_IRQS:524544 nr_irqs:56 16
[ 0.000000] ACPI: Core revision 20140214
[ 0.000000] ACPI: All ACPI Tables successfully acquired
[ 0.000000] Console: colour VGA+ 80x25
[ 0.000000] console [tty0] enabled
[ 0.000000] bootconsole [earlyser0] disabled
[ 0.000000] Linux version 3.14.0-rc5-next-20140307-07129-g1b0a7e3 (kbuild@roam) (gcc version 4.8.1 (Debian 4.8.1-8) ) #1 SMP Sun Mar 9 13:41:01 CST 2014
[ 0.000000] Command line: hung_task_panic=1 earlyprintk=ttyS0,115200 debug apic=debug sysrq_always_enabled rcupdate.rcu_cpu_stall_timeout=100 panic=10 softlockup_panic=1 nmi_watchdog=panic prompt_ramdisk=0 console=ttyS0,115200 console=tty0 vga=normal root=/dev/ram0 rw link=/kernel-tests/run-queue/kvm/x86_64-randconfig-r5-03091328/next:master/.vmlinuz-1b0a7e3263168a06d3858798e48c5a21d1c78d3c-20140309134226-8-ivytown2 branch=next/master BOOT_IMAGE=/kernel/x86_64-randconfig-r5-03091328/1b0a7e3263168a06d3858798e48c5a21d1c78d3c/vmlinuz-3.14.0-rc5-next-20140307-07129-g1b0a7e3
[ 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-0x0000000013ffdfff] usable
[ 0.000000] BIOS-e820: [mem 0x0000000013ffe000-0x0000000013ffffff] reserved
[ 0.000000] BIOS-e820: [mem 0x00000000feffc000-0x00000000feffffff] reserved
[ 0.000000] BIOS-e820: [mem 0x00000000fffc0000-0x00000000ffffffff] reserved
[ 0.000000] bootconsole [earlyser0] enabled
[ 0.000000] NX (Execute Disable) protection: active
[ 0.000000] SMBIOS 2.4 present.
[ 0.000000] DMI: Bochs Bochs, BIOS Bochs 01/01/2011
[ 0.000000] Hypervisor detected: KVM
[ 0.000000] e820: update [mem 0x00000000-0x00000fff] usable ==> reserved
[ 0.000000] e820: remove [mem 0x000a0000-0x000fffff] usable
[ 0.000000] No AGP bridge found
[ 0.000000] e820: last_pfn = 0x13ffe max_arch_pfn = 0x400000000
[ 0.000000] MTRR default type: write-back
[ 0.000000] MTRR fixed ranges enabled:
[ 0.000000] 00000-9FFFF write-back
[ 0.000000] A0000-BFFFF uncachable
[ 0.000000] C0000-FFFFF write-protect
[ 0.000000] MTRR variable ranges enabled:
[ 0.000000] 0 base 0080000000 mask FF80000000 uncachable
[ 0.000000] 1 disabled
[ 0.000000] 2 disabled
[ 0.000000] 3 disabled
[ 0.000000] 4 disabled
[ 0.000000] 5 disabled
[ 0.000000] 6 disabled
[ 0.000000] 7 disabled
[ 0.000000] x86 PAT enabled: cpu 0, old 0x70406, new 0x7010600070106
[ 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 0x000fdae0-0x000fdaef] mapped at [ffff8800000fdae0]
[ 0.000000] mpc: fdaf0-fdbe4
[ 0.000000] Scanning 1 areas for low memory corruption
[ 0.000000] Base memory trampoline at [ffff880000099000] 99000 size 24576
[ 0.000000] init_memory_mapping: [mem 0x00000000-0x000fffff]
[ 0.000000] [mem 0x00000000-0x000fffff] page 4k
[ 0.000000] BRK [0x06691000, 0x06691fff] PGTABLE
[ 0.000000] BRK [0x06692000, 0x06692fff] PGTABLE
[ 0.000000] BRK [0x06693000, 0x06693fff] PGTABLE
[ 0.000000] init_memory_mapping: [mem 0x13a00000-0x13bfffff]
[ 0.000000] [mem 0x13a00000-0x13bfffff] page 4k
[ 0.000000] BRK [0x06694000, 0x06694fff] PGTABLE
[ 0.000000] init_memory_mapping: [mem 0x10000000-0x139fffff]
[ 0.000000] [mem 0x10000000-0x139fffff] page 4k
[ 0.000000] BRK [0x06695000, 0x06695fff] PGTABLE
[ 0.000000] BRK [0x06696000, 0x06696fff] PGTABLE
[ 0.000000] init_memory_mapping: [mem 0x00100000-0x0fffffff]
[ 0.000000] [mem 0x00100000-0x0fffffff] page 4k
[ 0.000000] init_memory_mapping: [mem 0x13c00000-0x13ffdfff]
[ 0.000000] [mem 0x13c00000-0x13ffdfff] page 4k
[ 0.000000] RAMDISK: [mem 0x13ce6000-0x13feffff]
[ 0.000000] ACPI: RSDP 0x00000000000FD950 000014 (v00 BOCHS )
[ 0.000000] ACPI: RSDT 0x0000000013FFE450 000034 (v01 BOCHS BXPCRSDT 00000001 BXPC 00000001)
[ 0.000000] ACPI: FACP 0x0000000013FFFF80 000074 (v01 BOCHS BXPCFACP 00000001 BXPC 00000001)
[ 0.000000] ACPI: DSDT 0x0000000013FFE490 0011A9 (v01 BXPC BXDSDT 00000001 INTL 20100528)
[ 0.000000] ACPI: FACS 0x0000000013FFFF40 000040
[ 0.000000] ACPI: SSDT 0x0000000013FFF7A0 000796 (v01 BOCHS BXPCSSDT 00000001 BXPC 00000001)
[ 0.000000] ACPI: APIC 0x0000000013FFF680 000080 (v01 BOCHS BXPCAPIC 00000001 BXPC 00000001)
[ 0.000000] ACPI: HPET 0x0000000013FFF640 000038 (v01 BOCHS BXPCHPET 00000001 BXPC 00000001)
[ 0.000000] ACPI: Local APIC address 0xfee00000
[ 0.000000] mapped APIC to ffffffffff57a000 ( fee00000)
[ 0.000000] kvm-clock: Using msrs 4b564d01 and 4b564d00
[ 0.000000] kvm-clock: cpu 0, msr 0:13c66001, primary cpu clock
[ 0.000000] Zone ranges:
[ 0.000000] DMA [mem 0x00001000-0x00ffffff]
[ 0.000000] DMA32 [mem 0x01000000-0xffffffff]
[ 0.000000] Normal empty
[ 0.000000] Movable zone start for each node
[ 0.000000] Early memory node ranges
[ 0.000000] node 0: [mem 0x00001000-0x0009efff]
[ 0.000000] node 0: [mem 0x00100000-0x13ffdfff]
[ 0.000000] On node 0 totalpages: 81820
[ 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: 1216 pages used for memmap
[ 0.000000] DMA32 zone: 77822 pages, LIFO batch:15
[ 0.000000] ACPI: PM-Timer IO Port: 0xb008
[ 0.000000] ACPI: Local APIC address 0xfee00000
[ 0.000000] mapped APIC to ffffffffff57a000 ( fee00000)
[ 0.000000] ACPI: LAPIC (acpi_id[0x00] lapic_id[0x00] enabled)
[ 0.000000] ACPI: LAPIC (acpi_id[0x01] lapic_id[0x01] enabled)
[ 0.000000] ACPI: LAPIC_NMI (acpi_id[0xff] dfl dfl lint[0x1])
[ 0.000000] ACPI: IOAPIC (id[0x00] address[0xfec00000] gsi_base[0])
[ 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] ACPI: IRQ2 used by override.
[ 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] smpboot: Allowing 2 CPUs, 0 hotplug CPUs
[ 0.000000] mapped IOAPIC to ffffffffff579000 (fec00000)
[ 0.000000] nr_irqs_gsi: 40
[ 0.000000] e820: [mem 0x14000000-0xfeffbfff] available for PCI devices
[ 0.000000] Booting paravirtualized kernel on KVM
[ 0.000000] setup_percpu: NR_CPUS:8192 nr_cpumask_bits:2 nr_cpu_ids:2 nr_node_ids:1
[ 0.000000] PERCPU: Embedded 27 pages/cpu @ffff880013800000 s79232 r8192 d23168 u1048576
[ 0.000000] pcpu-alloc: s79232 r8192 d23168 u1048576 alloc=1*2097152
[ 0.000000] pcpu-alloc: [0] 0 1
[ 0.000000] KVM setup async PF for cpu 0
[ 0.000000] kvm-stealtime: cpu 0, msr 1380dc40
[ 0.000000] Built 1 zonelists in Zone order, mobility grouping on. Total pages: 80519
[ 0.000000] Kernel command line: hung_task_panic=1 earlyprintk=ttyS0,115200 debug apic=debug sysrq_always_enabled rcupdate.rcu_cpu_stall_timeout=100 panic=10 softlockup_panic=1 nmi_watchdog=panic prompt_ramdisk=0 console=ttyS0,115200 console=tty0 vga=normal root=/dev/ram0 rw link=/kernel-tests/run-queue/kvm/x86_64-randconfig-r5-03091328/next:master/.vmlinuz-1b0a7e3263168a06d3858798e48c5a21d1c78d3c-20140309134226-8-ivytown2 branch=next/master BOOT_IMAGE=/kernel/x86_64-randconfig-r5-03091328/1b0a7e3263168a06d3858798e48c5a21d1c78d3c/vmlinuz-3.14.0-rc5-next-20140307-07129-g1b0a7e3
[ 0.000000] sysrq: sysrq always enabled.
[ 0.000000] PID hash table entries: 2048 (order: 2, 16384 bytes)
[ 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] Checking aperture...
[ 0.000000] No AGP bridge found
[ 0.000000] Memory: 292616K/327280K available (5911K kernel code, 1272K rwdata, 3396K rodata, 1040K init, 10520K bss, 34664K reserved)
[ 0.000000] Hierarchical RCU implementation.
[ 0.000000] RCU: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=2
[ 0.000000] NR_IRQS:524544 nr_irqs:56 16
[ 0.000000] ACPI: Core revision 20140214
[ 0.000000] ACPI: All ACPI Tables successfully acquired
[ 0.000000] Console: colour VGA+ 80x25
[ 0.000000] console [tty0] enabled
[ 0.000000] bootconsole [earlyser0] disabled
[ 0.000000] console [ttyS0] enabled
[ 0.000000] Lock dependency validator: Copyright (c) 2006 Red Hat, Inc., Ingo Molnar
[ 0.000000] ... MAX_LOCKDEP_SUBCLASSES: 8
[ 0.000000] ... MAX_LOCK_DEPTH: 48
[ 0.000000] ... MAX_LOCKDEP_KEYS: 8191
[ 0.000000] ... CLASSHASH_SIZE: 4096
[ 0.000000] ... MAX_LOCKDEP_ENTRIES: 16384
[ 0.000000] ... MAX_LOCKDEP_CHAINS: 32768
[ 0.000000] ... CHAINHASH_SIZE: 16384
[ 0.000000] memory used by lock dependency info: 5855 kB
[ 0.000000] per task-struct memory footprint: 1920 bytes
[ 0.000000] ODEBUG: 15 of 15 active objects replaced
[ 0.000000] hpet clockevent registered
[ 0.000000] tsc: Detected 2494.168 MHz processor
[ 0.003000] Calibrating delay loop (skipped) preset value.. 4988.33 BogoMIPS (lpj=2494168)
[ 0.004008] pid_max: default: 32768 minimum: 301
[ 0.004864] Security Framework initialized
[ 0.005018] AppArmor: AppArmor initialized
[ 0.006046] Mount-cache hash table entries: 256
[ 0.008047] Last level iTLB entries: 4KB 0, 2MB 0, 4MB 0
[ 0.008047] Last level dTLB entries: 4KB 0, 2MB 0, 4MB 0, 1GB 0
[ 0.008047] tlb_flushall_shift: 6
[ 0.009084] debug: unmapping init [mem 0xffffffff85c44000-0xffffffff85c49fff]
[ 0.013868] Getting VERSION: 50014
[ 0.014035] Getting VERSION: 50014
[ 0.015011] Getting ID: 0
[ 0.016017] Getting ID: ff000000
[ 0.017017] Getting LVT0: 8700
[ 0.018011] Getting LVT1: 8400
[ 0.019030] enabled ExtINT on CPU#0
[ 0.022050] ENABLING IO-APIC IRQs
[ 0.022974] init IO_APIC IRQs
[ 0.023011] apic 0 pin 0 not connected
[ 0.024060] IOAPIC[0]: Set routing entry (0-1 -> 0x31 -> IRQ 1 Mode:0 Active:0 Dest:1)
[ 0.025042] IOAPIC[0]: Set routing entry (0-2 -> 0x30 -> IRQ 0 Mode:0 Active:0 Dest:1)
[ 0.026037] IOAPIC[0]: Set routing entry (0-3 -> 0x33 -> IRQ 3 Mode:0 Active:0 Dest:1)
[ 0.027036] IOAPIC[0]: Set routing entry (0-4 -> 0x34 -> IRQ 4 Mode:0 Active:0 Dest:1)
[ 0.028036] IOAPIC[0]: Set routing entry (0-5 -> 0x35 -> IRQ 5 Mode:1 Active:0 Dest:1)
[ 0.029036] IOAPIC[0]: Set routing entry (0-6 -> 0x36 -> IRQ 6 Mode:0 Active:0 Dest:1)
[ 0.030036] IOAPIC[0]: Set routing entry (0-7 -> 0x37 -> IRQ 7 Mode:0 Active:0 Dest:1)
[ 0.031036] IOAPIC[0]: Set routing entry (0-8 -> 0x38 -> IRQ 8 Mode:0 Active:0 Dest:1)
[ 0.032040] IOAPIC[0]: Set routing entry (0-9 -> 0x39 -> IRQ 9 Mode:1 Active:0 Dest:1)
[ 0.033035] IOAPIC[0]: Set routing entry (0-10 -> 0x3a -> IRQ 10 Mode:1 Active:0 Dest:1)
[ 0.034046] IOAPIC[0]: Set routing entry (0-11 -> 0x3b -> IRQ 11 Mode:1 Active:0 Dest:1)
[ 0.035040] IOAPIC[0]: Set routing entry (0-12 -> 0x3c -> IRQ 12 Mode:0 Active:0 Dest:1)
[ 0.036044] IOAPIC[0]: Set routing entry (0-13 -> 0x3d -> IRQ 13 Mode:0 Active:0 Dest:1)
[ 0.037036] IOAPIC[0]: Set routing entry (0-14 -> 0x3e -> IRQ 14 Mode:0 Active:0 Dest:1)
[ 0.038039] IOAPIC[0]: Set routing entry (0-15 -> 0x3f -> IRQ 15 Mode:0 Active:0 Dest:1)
[ 0.039030] apic 0 pin 16 not connected
[ 0.040008] apic 0 pin 17 not connected
[ 0.042019] apic 0 pin 18 not connected
[ 0.043008] apic 0 pin 19 not connected
[ 0.044008] apic 0 pin 20 not connected
[ 0.045009] apic 0 pin 21 not connected
[ 0.046008] apic 0 pin 22 not connected
[ 0.047008] apic 0 pin 23 not connected
[ 0.048167] ..TIMER: vector=0x30 apic1=0 pin1=2 apic2=-1 pin2=-1
[ 0.049008] smpboot: CPU0: Intel Common KVM processor (fam: 0f, model: 06, stepping: 01)
[ 0.053008] Using local APIC timer interrupts.
[ 0.053008] calibrating APIC timer ...
[ 0.055000] ... lapic delta = 6249793
[ 0.055000] ... PM-Timer delta = 357939
[ 0.055000] ... PM-Timer result ok
[ 0.055000] ..... delta 6249793
[ 0.055000] ..... mult: 268426565
[ 0.055000] ..... calibration result: 999966
[ 0.055000] ..... CPU clock speed is 2492.0586 MHz.
[ 0.055000] ..... host bus clock speed is 999.0966 MHz.
[ 0.055077] Performance Events: unsupported Netburst CPU model 6 no PMU driver, software events only.
[ 0.060981] x86: Booting SMP configuration:
[ 0.061009] .... node #0, CPUs: #1
[ 0.060251] kvm-clock: cpu 1, msr 0:13c66041, secondary cpu clock
[ 0.060251] masked ExtINT on CPU#1
[ 0.075187] KVM setup async PF for cpu 1
[ 0.075276] x86: Booted up 1 node, 2 CPUs
[ 0.075284] ----------------
[ 0.075285] | NMI testsuite:
[ 0.075285] --------------------
[ 0.075187] remote IPI:
[ 0.075187] kvm-stealtime: cpu 1, msr 1390dc40
[ 0.083035] ok |
[ 0.083824] local IPI: ok |
[ 0.090014] --------------------
[ 0.090870] Good, all 2 testcases passed! |
[ 0.091006] ---------------------------------
[ 0.092008] smpboot: Total of 2 processors activated (9976.67 BogoMIPS)
[ 0.095216] devtmpfs: initialized
[ 0.097077] EVM: security.capability
[ 0.098753] atomic64 test passed for x86-64 platform with CX8 and with SSE
[ 0.099658] regulator-dummy: no parameters
[ 0.101258] NET: Registered protocol family 16
[ 0.103159] cpuidle: using governor ladder
[ 0.104009] cpuidle: using governor menu
[ 0.106827] ACPI: bus type PCI registered
[ 0.108034] PCI: Using configuration type 1 for base access
[ 0.117521] ACPI: Added _OSI(Module Device)
[ 0.118008] ACPI: Added _OSI(Processor Device)
[ 0.119007] ACPI: Added _OSI(3.0 _SCP Extensions)
[ 0.120007] ACPI: Added _OSI(Processor Aggregator Device)
[ 0.129723] ACPI: Interpreter enabled
[ 0.130021] ACPI Exception: AE_NOT_FOUND, While evaluating Sleep State [\_S1_] (20140214/hwxface-580)
[ 0.132673] ACPI Exception: AE_NOT_FOUND, While evaluating Sleep State [\_S2_] (20140214/hwxface-580)
[ 0.135043] ACPI: (supports S0 S3)
[ 0.136006] ACPI: Using IOAPIC for interrupt routing
[ 0.137056] PCI: Using host bridge windows from ACPI; if necessary, use "pci=nocrs" and report a bug
[ 0.151695] ACPI: PCI Root Bridge [PCI0] (domain 0000 [bus 00-ff])
[ 0.152017] acpi PNP0A03:00: _OSC: OS supports [ASPM ClockPM Segments]
[ 0.153067] acpi PNP0A03:00: _OSC failed (AE_NOT_FOUND); disabling ASPM
[ 0.155679] PCI host bridge to bus 0000:00
[ 0.156011] pci_bus 0000:00: root bus resource [bus 00-ff]
[ 0.157009] pci_bus 0000:00: root bus resource [io 0x0000-0x0cf7]
[ 0.158009] pci_bus 0000:00: root bus resource [io 0x0d00-0xffff]
[ 0.159009] pci_bus 0000:00: root bus resource [mem 0x000a0000-0x000bffff]
[ 0.160009] pci_bus 0000:00: root bus resource [mem 0x80000000-0xfebfffff]
[ 0.161092] pci 0000:00:00.0: [8086:1237] type 00 class 0x060000
[ 0.163629] pci 0000:00:01.0: [8086:7000] type 00 class 0x060100
[ 0.165876] pci 0000:00:01.1: [8086:7010] type 00 class 0x010180
[ 0.169009] pci 0000:00:01.1: reg 0x20: [io 0xc040-0xc04f]
[ 0.171792] pci 0000:00:01.3: [8086:7113] type 00 class 0x068000
[ 0.172490] pci 0000:00:01.3: quirk: [io 0xb000-0xb03f] claimed by PIIX4 ACPI
[ 0.173021] pci 0000:00:01.3: quirk: [io 0xb100-0xb10f] claimed by PIIX4 SMB
[ 0.175405] pci 0000:00:02.0: [1013:00b8] type 00 class 0x030000
[ 0.178052] pci 0000:00:02.0: reg 0x10: [mem 0xfc000000-0xfdffffff pref]
[ 0.180057] pci 0000:00:02.0: reg 0x14: [mem 0xfebf0000-0xfebf0fff]
[ 0.189048] pci 0000:00:02.0: reg 0x30: [mem 0xfebe0000-0xfebeffff pref]
[ 0.191877] pci 0000:00:03.0: [8086:100e] type 00 class 0x020000
[ 0.193008] pci 0000:00:03.0: reg 0x10: [mem 0xfeba0000-0xfebbffff]
[ 0.195537] pci 0000:00:03.0: reg 0x14: [io 0xc000-0xc03f]
[ 0.202009] pci 0000:00:03.0: reg 0x30: [mem 0xfebc0000-0xfebdffff pref]
[ 0.204232] pci 0000:00:04.0: [8086:25ab] type 00 class 0x088000
[ 0.206009] pci 0000:00:04.0: reg 0x10: [mem 0xfebf1000-0xfebf100f]
[ 0.211618] pci_bus 0000:00: on NUMA node 0
[ 0.213927] ACPI: PCI Interrupt Link [LNKA] (IRQs 5 *10 11)
[ 0.216060] ACPI: PCI Interrupt Link [LNKB] (IRQs 5 *10 11)
[ 0.218108] ACPI: PCI Interrupt Link [LNKC] (IRQs 5 10 *11)
[ 0.220174] ACPI: PCI Interrupt Link [LNKD] (IRQs 5 10 *11)
[ 0.222103] ACPI: PCI Interrupt Link [LNKS] (IRQs *9)
[ 0.224732] ACPI: Enabled 16 GPEs in block 00 to 0F
[ 0.226396] vgaarb: device added: PCI:0000:00:02.0,decodes=io+mem,owns=io+mem,locks=none
[ 0.227009] vgaarb: loaded
[ 0.228006] vgaarb: bridge control possible 0000:00:02.0
[ 0.230115] SCSI subsystem initialized
[ 0.231783] PCI: Using ACPI for IRQ routing
[ 0.232011] PCI: pci_cache_line_size set to 64 bytes
[ 0.234136] e820: reserve RAM buffer [mem 0x0009fc00-0x0009ffff]
[ 0.235020] e820: reserve RAM buffer [mem 0x13ffe000-0x13ffffff]
[ 0.237628] irda_init()
[ 0.238113] NET: Registered protocol family 23
[ 0.239074] Bluetooth: Core ver 2.19
[ 0.240042] NET: Registered protocol family 31
[ 0.241006] Bluetooth: HCI device and connection manager initialized
[ 0.242035] Bluetooth: HCI socket layer initialized
[ 0.243014] Bluetooth: L2CAP socket layer initialized
[ 0.244071] Bluetooth: SCO socket layer initialized
[ 0.245027] NET: Registered protocol family 8
[ 0.246007] NET: Registered protocol family 20
[ 0.247102] nfc: nfc_init: NFC Core ver 0.1
[ 0.248092] NET: Registered protocol family 39
[ 0.250298] Switched to clocksource kvm-clock
[ 0.252003] AppArmor: AppArmor Filesystem Enabled
[ 0.253185] pnp: PnP ACPI init
[ 0.254083] ACPI: bus type PNP registered
[ 0.255157] IOAPIC[0]: Set routing entry (0-8 -> 0x38 -> IRQ 8 Mode:0 Active:0 Dest:3)
[ 0.257139] pnp 00:00: Plug and Play ACPI device, IDs PNP0b00 (active)
[ 0.258596] IOAPIC[0]: Set routing entry (0-1 -> 0x31 -> IRQ 1 Mode:0 Active:0 Dest:3)
[ 0.270258] pnp 00:01: Plug and Play ACPI device, IDs PNP0303 (active)
[ 0.271705] IOAPIC[0]: Set routing entry (0-12 -> 0x3c -> IRQ 12 Mode:0 Active:0 Dest:3)
[ 0.273655] pnp 00:02: Plug and Play ACPI device, IDs PNP0f13 (active)
[ 0.275121] IOAPIC[0]: Set routing entry (0-6 -> 0x36 -> IRQ 6 Mode:0 Active:0 Dest:3)
[ 0.276958] pnp 00:03: [dma 2]
[ 0.277888] pnp 00:03: Plug and Play ACPI device, IDs PNP0700 (active)
[ 0.279351] IOAPIC[0]: Set routing entry (0-7 -> 0x37 -> IRQ 7 Mode:0 Active:0 Dest:3)
[ 0.281278] pnp 00:04: Plug and Play ACPI device, IDs PNP0400 (active)
[ 0.282816] IOAPIC[0]: Set routing entry (0-4 -> 0x34 -> IRQ 4 Mode:0 Active:0 Dest:3)
[ 0.284761] pnp 00:05: Plug and Play ACPI device, IDs PNP0501 (active)
[ 0.286671] pnp 00:06: Plug and Play ACPI device, IDs PNP0103 (active)
[ 0.288363] pnp: PnP ACPI: found 7 devices
[ 0.289349] ACPI: bus type PNP unregistered
[ 0.307078] pci_bus 0000:00: resource 4 [io 0x0000-0x0cf7]
[ 0.308314] pci_bus 0000:00: resource 5 [io 0x0d00-0xffff]
[ 0.309545] pci_bus 0000:00: resource 6 [mem 0x000a0000-0x000bffff]
[ 0.310865] pci_bus 0000:00: resource 7 [mem 0x80000000-0xfebfffff]
[ 0.312269] NET: Registered protocol family 1
[ 0.313338] pci 0000:00:00.0: Limiting direct PCI/PCI transfers
[ 0.314633] pci 0000:00:01.0: PIIX3: Enabling Passive Release
[ 0.315926] pci 0000:00:01.0: Activating ISA DMA hang workarounds
[ 0.317273] pci 0000:00:02.0: Boot video device
[ 0.318371] PCI: CLS 0 bytes, default 64
[ 0.319790] Unpacking initramfs...
[ 0.427950] debug: unmapping init [mem 0xffff880013ce6000-0xffff880013feffff]
[ 0.431246] Scanning for low memory corruption every 60 seconds
[ 0.432875] camellia-x86_64: performance on this CPU would be suboptimal: disabling camellia-x86_64.
[ 0.435152] twofish-x86_64-3way: performance on this CPU would be suboptimal: disabling twofish-x86_64-3way.
[ 0.435267] cryptomgr_test (26) used greatest stack depth: 6552 bytes left
[ 0.438664] AVX or AES-NI instructions are not detected.
[ 0.439842] AVX instructions are not detected.
[ 0.440873] AVX instructions are not detected.
[ 0.441904] AVX instructions are not detected.
[ 0.442939] AVX2 or AES-NI instructions are not detected.
[ 0.444117] AVX2 instructions are not detected.
[ 0.446879] Initializing RT-Tester: OK
[ 0.447841] spin_lock-torture:--- Start of test: nwriters_stress=4 stat_interval=60 verbose=1 shuffle_interval=3 stutter=5 shutdown_secs=0 onoff_interval=0 onoff_holdoff=0
[ 0.451052] spin_lock-torture: Creating torture_shuffle task
[ 0.452457] spin_lock-torture: torture_shuffle task started
[ 0.452469] spin_lock-torture: Creating torture_stutter task
[ 0.452557] spin_lock-torture: Creating lock_torture_writer task
[ 0.452659] spin_lock-torture: torture_stutter task started
[ 0.457648] spin_lock-torture: Creating lock_torture_writer task
[ 0.457720] spin_lock-torture: lock_torture_writer task started
[ 0.457741] spin_lock-torture: Creating lock_torture_writer task
[ 0.457810] spin_lock-torture: lock_torture_writer task started
[ 0.457830] spin_lock-torture: Creating lock_torture_writer task
[ 0.457914] spin_lock-torture: lock_torture_writer task started
[ 0.457934] spin_lock-torture: Creating lock_torture_stats task
[ 0.457995] spin_lock-torture: lock_torture_writer task started
[ 0.458799] futex hash table entries: 512 (order: 4, 65536 bytes)
[ 0.458918] Initialise system trusted keyring
[ 0.459035] audit: initializing netlink subsys (disabled)
[ 0.459178] audit: type=2000 audit(1394343786.846:1): initialized
[ 0.476898] spin_lock-torture: lock_torture_stats task started
[ 0.489404] Kprobe smoke test started
[ 0.514663]
[ 0.515287] ======================================================
[ 0.515561] [ INFO: possible circular locking dependency detected ]
[ 0.515561] 3.14.0-rc5-next-20140307-07129-g1b0a7e3 #1 Not tainted
[ 0.515561] -------------------------------------------------------
[ 0.515561] kworker/0:1/25 is trying to acquire lock:
[ 0.515561] (text_mutex){+.+.+.}, at: [<ffffffff855c2531>] kprobe_optimizer+0x121/0x23c
[ 0.515561]
[ 0.515561] but task is already holding lock:
[ 0.515561] (module_mutex){+.+...}, at: [<ffffffff855c2435>] kprobe_optimizer+0x25/0x23c
[ 0.515561]
[ 0.515561] which lock already depends on the new lock.
[ 0.515561]
[ 0.515561]
[ 0.515561] the existing dependency chain (in reverse order) is:
[ 0.515561]
-> #2 (module_mutex){+.+...}:
[ 0.515561] [<ffffffff850b3a65>] __lock_acquire+0x910/0xa03
[ 0.515561] [<ffffffff850b4043>] lock_acquire+0xa4/0xc4
[ 0.515561] [<ffffffff855ba2fe>] mutex_lock_nested+0x65/0x34a
[ 0.515561] [<ffffffff8502f954>] module_alloc+0x42/0xb5
[ 0.515561] [<ffffffff850db8e5>] alloc_insn_page+0xe/0x10
[ 0.515561] [<ffffffff855c272c>] __get_insn_slot+0xe0/0x165
[ 0.515561] [<ffffffff855bfa73>] arch_prepare_kprobe+0x36/0xb7
[ 0.515561] [<ffffffff855c3401>] register_kprobe+0x330/0x490
[ 0.515561] [<ffffffff850d6ff2>] init_test_probes+0x4e/0x489
[ 0.515561] [<ffffffff85b7017c>] init_kprobes+0x17b/0x189
[ 0.515561] [<ffffffff850020fb>] do_one_initcall+0x9f/0x135
[ 0.515561] [<ffffffff85b54f65>] kernel_init_freeable+0x104/0x196
[ 0.515561] [<ffffffff855adbe9>] kernel_init+0x9/0xd5
[ 0.515561] [<ffffffff855c3c8c>] ret_from_fork+0x7c/0xb0
[ 0.515561]
-> #1 (kprobe_insn_slots.mutex){+.+.+.}:
[ 0.515561] [<ffffffff850b3a65>] __lock_acquire+0x910/0xa03
[ 0.515561] [<ffffffff850b4043>] lock_acquire+0xa4/0xc4
[ 0.515561] [<ffffffff855ba2fe>] mutex_lock_nested+0x65/0x34a
[ 0.515561] [<ffffffff855c2668>] __get_insn_slot+0x1c/0x165
[ 0.515561] [<ffffffff855bfa73>] arch_prepare_kprobe+0x36/0xb7
[ 0.515561] [<ffffffff855c3401>] register_kprobe+0x330/0x490
[ 0.515561] [<ffffffff850d6ff2>] init_test_probes+0x4e/0x489
[ 0.515561] [<ffffffff85b7017c>] init_kprobes+0x17b/0x189
[ 0.515561] [<ffffffff850020fb>] do_one_initcall+0x9f/0x135
[ 0.515561] [<ffffffff85b54f65>] kernel_init_freeable+0x104/0x196
[ 0.515561] [<ffffffff855adbe9>] kernel_init+0x9/0xd5
[ 0.515561] [<ffffffff855c3c8c>] ret_from_fork+0x7c/0xb0
[ 0.515561]
-> #0 (text_mutex){+.+.+.}:
[ 0.515561] [<ffffffff850b0e0f>] validate_chain.isra.20+0x8cf/0xf2e
[ 0.515561] [<ffffffff850b3a65>] __lock_acquire+0x910/0xa03
[ 0.515561] [<ffffffff850b4043>] lock_acquire+0xa4/0xc4
[ 0.515561] [<ffffffff855ba2fe>] mutex_lock_nested+0x65/0x34a
[ 0.515561] [<ffffffff855c2531>] kprobe_optimizer+0x121/0x23c
[ 0.515561] [<ffffffff8508dfc4>] process_one_work+0x237/0x3db
[ 0.515561] [<ffffffff8508edc2>] worker_thread+0x1cb/0x2c4
[ 0.515561] [<ffffffff8509498b>] kthread+0xf1/0xf9
[ 0.515561] [<ffffffff855c3c8c>] ret_from_fork+0x7c/0xb0
[ 0.515561]
[ 0.515561] other info that might help us debug this:
[ 0.515561]
[ 0.515561] Chain exists of:
text_mutex --> kprobe_insn_slots.mutex --> module_mutex
[ 0.515561] Possible unsafe locking scenario:
[ 0.515561]
[ 0.515561] CPU0 CPU1
[ 0.515561] ---- ----
[ 0.515561] lock(module_mutex);
[ 0.515561] lock(kprobe_insn_slots.mutex);
[ 0.515561] lock(module_mutex);
[ 0.515561] lock(text_mutex);
[ 0.515561]
[ 0.515561] *** DEADLOCK ***
[ 0.515561]
[ 0.515561] 4 locks held by kworker/0:1/25:
[ 0.515561] #0: ("events"){.+.+..}, at: [<ffffffff8508df5e>] process_one_work+0x1d1/0x3db
[ 0.515561] #1: ((optimizing_work).work){+.+...}, at: [<ffffffff8508df5e>] process_one_work+0x1d1/0x3db
[ 0.515561] #2: (kprobe_mutex){+.+.+.}, at: [<ffffffff855c2427>] kprobe_optimizer+0x17/0x23c
[ 0.515561] #3: (module_mutex){+.+...}, at: [<ffffffff855c2435>] kprobe_optimizer+0x25/0x23c
[ 0.515561]
[ 0.515561] stack backtrace:
[ 0.515561] CPU: 0 PID: 25 Comm: kworker/0:1 Not tainted 3.14.0-rc5-next-20140307-07129-g1b0a7e3 #1
[ 0.515561] Hardware name: Bochs Bochs, BIOS Bochs 01/01/2011
[ 0.515561] Workqueue: events kprobe_optimizer
[ 0.515561] 0000000000000000 ffff8800137e3b60 ffffffff855b5b1d ffffffff86069110
[ 0.515561] ffff8800137e3ba0 ffffffff855b2850 ffff8800137e4650 ffff8800137e5318
[ 0.515561] ffff8800137e4650 ffff8800137e5318 0000000000000004 ffff8800137e52f0
[ 0.515561] Call Trace:
[ 0.515561] [<ffffffff855b5b1d>] dump_stack+0x4d/0x66
[ 0.515561] [<ffffffff855b2850>] print_circular_bug+0x2b4/0x2c2
[ 0.515561] [<ffffffff850b0e0f>] validate_chain.isra.20+0x8cf/0xf2e
[ 0.515561] [<ffffffff850b3a65>] __lock_acquire+0x910/0xa03
[ 0.515561] [<ffffffff850b4043>] lock_acquire+0xa4/0xc4
[ 0.515561] [<ffffffff855c2531>] ? kprobe_optimizer+0x121/0x23c
[ 0.515561] [<ffffffff855ba2fe>] mutex_lock_nested+0x65/0x34a
[ 0.515561] [<ffffffff855c2531>] ? kprobe_optimizer+0x121/0x23c
[ 0.515561] [<ffffffff850b1d8d>] ? trace_hardirqs_on+0xd/0xf
[ 0.515561] [<ffffffff855c2531>] kprobe_optimizer+0x121/0x23c
[ 0.515561] [<ffffffff8508dfc4>] process_one_work+0x237/0x3db
[ 0.515561] [<ffffffff8508df5e>] ? process_one_work+0x1d1/0x3db
[ 0.515561] [<ffffffff8508edc2>] worker_thread+0x1cb/0x2c4
[ 0.515561] [<ffffffff8508ebf7>] ? rescuer_thread+0x29b/0x29b
[ 0.515561] [<ffffffff8509498b>] kthread+0xf1/0xf9
[ 0.515561] [<ffffffff8509489a>] ? kthread_stop+0x5a/0x5a
[ 0.515561] [<ffffffff855c3c8c>] ret_from_fork+0x7c/0xb0
[ 0.515561] [<ffffffff8509489a>] ? kthread_stop+0x5a/0x5a
[ 0.679517] Kprobe smoke test passed successfully
[ 0.681393] bounce pool size: 64 pages
[ 0.682499] HugeTLB registered 2 MB page size, pre-allocated 0 pages
[ 0.684990] squashfs: version 4.0 (2009/01/31) Phillip Lougher
[ 0.687421] EFS: 1.0a - http://aeschi.ch.eu.org/efs/
[ 0.688594] NILFS version 2 loaded
[ 0.689344] BeFS version: 0.9.3
[ 0.691160] GFS2 installed
[ 0.692017] msgmni has been set to 571
[ 0.697561] Key type asymmetric registered
[ 0.698730] Asymmetric key parser 'x509' registered
[ 0.699914] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 252)
[ 0.701506] io scheduler noop registered (default)
[ 0.702366] list_sort_test: start testing list_sort()
[ 0.703791] test_string_helpers: Running tests...
[ 0.705189] xz_dec_test: module loaded
[ 0.706098] xz_dec_test: Create a device node with 'mknod xz_dec_test c 251 0' and write .xz files to it.
[ 0.708539] pci_hotplug: PCI Hot Plug PCI Core version: 0.5
[ 0.709870] pciehp: PCI Express Hot Plug Controller Driver version: 0.4
[ 0.711398] cpcihp_zt5550: ZT5550 CompactPCI Hot Plug Driver version: 0.2
[ 0.713111] input: Power Button as /devices/LNXSYSTM:00/LNXPWRBN:00/input/input0
[ 0.714930] ACPI: Power Button [PWRF]
[ 0.749820] Serial: 8250/16550 driver, 4 ports, IRQ sharing disabled
[ 0.773535] 00:05: ttyS0 at I/O 0x3f8 (irq = 4, base_baud = 115200) is a 16550A
[ 0.776727] Applicom driver: $Id: ac.c,v 1.30 2000/03/22 16:03:57 dwmw2 Exp $
[ 0.778323] ac.o: No PCI boards found.
[ 0.779326] ac.o: For an ISA board you must supply memory and irq parameters.
[ 0.780936] smapi::smapi_init, ERROR invalid usSmapiID
[ 0.782122] mwave: tp3780i::tp3780I_InitializeBoardData: Error: SMAPI is not available on this machine
[ 0.784072] mwave: mwavedd::mwave_init: Error: Failed to initialize board data
[ 0.785708] mwave: mwavedd::mwave_init: Error: Failed to initialize
[ 0.786991] Hangcheck: starting hangcheck timer 0.9.1 (tick is 180 seconds, margin is 60 seconds).
[ 0.788899] Hangcheck: Using getrawmonotonic().
[ 0.790084] lkdtm: No crash points registered, enable through debugfs
[ 0.791419] Guest personality initialized and is inactive
[ 0.792957] VMCI host device registered (name=vmci, major=10, minor=61)
[ 0.794531] Initialized host personality
[ 0.797149] Uniform Multi-Platform E-IDE driver
[ 0.798654] piix 0000:00:01.1: IDE controller (0x8086:0x7010 rev 0x00)
[ 0.800440] piix 0000:00:01.1: not 100% native mode: will probe irqs later
[ 0.802889] ide0: BM-DMA at 0xc040-0xc047
[ 0.804904] ide1: BM-DMA at 0xc048-0xc04f
[ 0.806406] Probing IDE interface ide0...
[ 1.337183] Probing IDE interface ide1...
[ 1.614891] tsc: Refined TSC clocksource calibration: 2492.686 MHz
[ 2.009671] hdc: QEMU DVD-ROM, ATAPI CD/DVD-ROM drive
[ 2.622360] hdc: host max PIO4 wanted PIO255(auto-tune) selected PIO0
[ 2.623533] hdc: MWDMA2 mode selected
[ 2.624474] ide0 at 0x1f0-0x1f7,0x3f6 on irq 14
[ 2.625399] ide1 at 0x170-0x177,0x376 on irq 15
[ 2.626610] ide_generic: please use "probe_mask=0x3f" module parameter for probing all legacy ISA IDE ports
[ 2.628583] Loading iSCSI transport class v2.0-870.
[ 2.629846] L440GX flash mapping: failed to find PIIX4 ISA bridge, cannot continue
[ 2.631172] slram: not enough parameters.
[ 2.632036] HSI/SSI char device loaded
[ 2.632943] CAN device driver interface
[ 2.633760] pcnet32: pcnet32.c:v1.35 21.Apr.2008 tsbogend@alpha.franken.de
[ 2.634882] cnic: Broadcom NetXtreme II CNIC Driver cnic v2.5.19 (December 19, 2013)
[ 2.636332] enic: Cisco VIC Ethernet NIC Driver, ver 2.1.1.50
[ 2.637286] jme: JMicron JMC2XX ethernet driver version 1.0.8
[ 2.638297] ns83820.c: National Semiconductor DP83820 10/100/1000 driver.
[ 2.639666] irda_register_dongle : registering dongle "JetEye PC ESI-9680 PC" (1).
[ 2.640940] irda_register_dongle : registering dongle "Parallax LiteLink" (5).
[ 2.642188] irda_register_dongle : registering dongle "Microchip MCP2120" (9).
[ 2.643756] ieee802154hardmac ieee802154hardmac: Added ieee802154 HardMAC hardware
[ 2.645393] i8042: PNP: PS/2 Controller [PNP0303:KBD,PNP0f13:MOU] at 0x60,0x64 irq 1,12
[ 2.647575] serio: i8042 KBD port at 0x60,0x64 irq 1
[ 2.648406] serio: i8042 AUX port at 0x60,0x64 irq 12
[ 2.649459] mousedev: PS/2 mouse device common for all mice
[ 2.650840] input: AT Translated Set 2 keyboard as /devices/platform/i8042/serio0/input/input1
[ 2.652811] apanel: Fujitsu BIOS signature 'FJKEYINF' not found...
[ 2.654322] input: PC Speaker as /devices/platform/pcspkr/input/input4
[ 2.655612] I2O subsystem v1.325
[ 2.656247] i2o: max drivers = 8
[ 2.657429] piix4_smbus 0000:00:01.3: SMBus Host Controller at 0xb100, revision 0
[ 2.658972] Driver for 1-wire Dallas network protocol.
[ 2.724203] applesmc: supported laptop not found!
[ 2.724998] applesmc: driver init failed (ret=-19)!
[ 3.455114] input: ImExPS/2 Generic Explorer Mouse as /devices/platform/i8042/serio1/input/input3
[ 4.462215] ib700wdt: WDT driver for IB700 single board computer initialising
[ 4.463728] i6300esb: Intel 6300ESB WatchDog Timer Driver v0.05
[ 4.465290] i6300esb: cannot register miscdev on minor=130 (err=-16)
[ 4.466689] i6300ESB timer: probe of 0000:00:04.0 failed with error -16
[ 4.468292] smsc37b787_wdt: SMsC 37B787 watchdog component driver 1.1 initialising...
[ 4.471195] smsc37b787_wdt: Unable to register miscdev on minor 130
[ 4.472579] w83877f_wdt: I/O address 0x0443 already in use
[ 4.473789] sbc_epx_c3: cannot register miscdev on minor=130 (err=-16)
[ 4.475260] Bluetooth: HCI UART driver ver 2.2
[ 4.476329] Bluetooth: HCI H4 protocol initialized
[ 4.477455] Bluetooth: HCILL protocol initialized
[ 4.478535] Bluetooth: HCIATH3K protocol initialized
[ 4.479662] Bluetooth: HCI Three-wire UART (H5) protocol initialized
[ 4.485454] ISDN subsystem Rev: 1.1.2.3/1.1.2.2/none/none/1.1.2.2
[ 4.487443] t1pci: revision 1.1.2.2
[ 4.488340] b1: revision 1.1.2.2
[ 4.489181] b1dma: revision 1.1.2.3
[ 7.175475] (null): enodev DEV ADDR = 0xFF
[ 7.176612] dcdbas dcdbas: Dell Systems Management Base Driver (version 5.6.0-3.2)
[ 7.178571] hdaps: supported laptop not found!
[ 7.179400] hdaps: driver init failed (ret=-19)!
[ 7.180547] NET: Registered protocol family 17
[ 7.181596] can: controller area network core (rev 20120528 abi 9)
[ 7.182631] NET: Registered protocol family 29
[ 7.183436] can: raw protocol (rev 20120528)
[ 7.184394] can: netlink gateway (rev 20130117) max_hops=1
[ 7.185542] NET: Registered protocol family 36
[ 7.186491] batman_adv: B.A.T.M.A.N. advanced 2014.1.0 (compatibility version 15) loaded
[ 7.188387]
[ 7.188387] printing PIC contents
[ 7.189475] ... PIC IMR: ffff
[ 7.190233] ... PIC IRR: 1013
[ 7.190929] ... PIC ISR: 0000
[ 7.191750] ... PIC ELCR: 0c00
[ 7.192488] printing local APIC contents on CPU#0/0:
[ 7.193274] ... APIC ID: 00000000 (0)
[ 7.193274] ... APIC VERSION: 00050014
[ 7.193274] ... APIC TASKPRI: 00000000 (00)
[ 7.193274] ... APIC PROCPRI: 00000000
[ 7.193274] ... APIC LDR: 01000000
[ 7.193274] ... APIC DFR: ffffffff
[ 7.193274] ... APIC SPIV: 000001ff
[ 7.193274] ... APIC ISR field:
[ 7.193274] 0000000000000000000000000000000000000000000000000000000000000000
[ 7.193274] ... APIC TMR field:
[ 7.193274] 0000000002000000000000000000000000000000000000000000000000000000
[ 7.193274] ... APIC IRR field:
[ 7.193274] 0000000000000000000000000000000000000000000000000000000000008000
[ 7.193274] ... APIC ESR: 00000000
[ 7.193274] ... APIC ICR: 000008fd
[ 7.193274] ... APIC ICR2: 02000000
[ 7.193274] ... APIC LVTT: 000200ef
[ 7.193274] ... APIC LVTPC: 00010000
[ 7.193274] ... APIC LVT0: 00010700
[ 7.193274] ... APIC LVT1: 00000400
[ 7.193274] ... APIC LVTERR: 000000fe
[ 7.193274] ... APIC TMICT: 0000f421
[ 7.193274] ... APIC TMCCT: 000079e0
[ 7.193274] ... APIC TDCR: 00000003
[ 7.193274]
[ 7.230484] number of MP IRQ sources: 15.
[ 7.231310] number of IO-APIC #0 registers: 24.
[ 7.232188] testing the IO APIC.......................
[ 7.233194] IO APIC #0......
[ 7.233937] .... register #00: 00000000
[ 7.234796] ....... : physical APIC id: 00
[ 7.235638] ....... : Delivery Type: 0
[ 7.236493] ....... : LTS : 0
[ 7.237394] .... register #01: 00170011
[ 7.238260] ....... : max redirection entries: 17
[ 7.239290] ....... : PRQ implemented: 0
[ 7.240157] ....... : IO APIC version: 11
[ 7.241181] .... register #02: 00000000
[ 7.241983] ....... : arbitration: 00
[ 7.242886] .... IRQ redirection table:
[ 7.243685] 1 0 0 0 0 0 0 00
[ 7.244543] 0 0 0 0 0 1 1 31
[ 7.245499] 0 0 0 0 0 1 1 30
[ 7.246430] 0 0 0 0 0 1 1 33
[ 7.247387] 1 0 0 0 0 1 1 34
[ 7.256029] 1 1 0 0 0 1 1 35
[ 7.256877] 0 0 0 0 0 1 1 36
[ 7.257880] 0 0 0 0 0 1 1 37
[ 7.258725] 0 0 0 0 0 1 1 38
[ 7.259588] 0 1 0 0 0 1 1 39
[ 7.260486] 1 1 0 0 0 1 1 3A
[ 7.261401] 1 1 0 0 0 1 1 3B
[ 7.262394] 0 0 0 0 0 1 1 3C
[ 7.263334] 0 0 0 0 0 1 1 3D
[ 7.264481] 0 0 0 0 0 1 1 3E
[ 7.265426] 0 0 0 0 0 1 1 3F
[ 7.266343] 1 0 0 0 0 0 0 00
[ 7.267253] 1 0 0 0 0 0 0 00
[ 7.268135] 1 0 0 0 0 0 0 00
[ 7.269090] 1 0 0 0 0