Hello, FYI this soft lockup happens in mainline kernel 4.17.0-rc1. It at least dates back to v4.1 . It occurs in 8 out of 9 boots. [ 59.276648] osst :I: Tape driver with OnStream support version 0.99.4 [ 59.276648] osst :I: $Id: osst.c,v 1.73 2005/01/01 21:13:34 wriede Exp $ [ 59.493429] Rounding down aligned max_sectors from 4294967295 to 4294967288 [ 59.538489] e1000: Intel(R) PRO/1000 Network Driver - version 7.3.21-k8-NAPI [ 59.551970] e1000: Copyright (c) 1999-2006 Intel Corporation. [ 84.192080] watchdog: BUG: soft lockup - CPU#0 stuck for 22s! [swapper:1] [ 84.192080] Modules linked in: [ 84.192080] irq event stamp: 3978566 [ 84.192080] hardirqs last enabled at (3978565): [] __slab_alloc+0x48/0x80 [ 84.192080] hardirqs last disabled at (3978566): [] interrupt_entry+0xac/0xc0: interrupt_entry at arch/x86/entry/entry_64.S:627 [ 84.192080] softirqs last enabled at (3978494): [] __do_softirq+0x45b/0x5e5 [ 84.192080] softirqs last disabled at (3978487): [] irq_exit+0x12e/0x160: invoke_softirq at kernel/softirq.c:365 (inlined by) irq_exit at kernel/softirq.c:405 [ 84.192080] CPU: 0 PID: 1 Comm: swapper Not tainted 4.17.0-rc1 #259 [ 84.192080] Hardware name: QEMU Standard PC (i440FX + PIIX, 1996), BIOS 1.10.2-1 04/01/2014 [ 84.192080] RIP: 0010:__slab_alloc+0x4d/0x80 [ 84.192080] RSP: 0000:ffff88001709f088 EFLAGS: 00000246 ORIG_RAX: ffffffffffffff13 [ 84.192080] RAX: 0000000000000007 RBX: 0000000000000246 RCX: 0000000000000018 [ 84.192080] RDX: 0000000000000000 RSI: ffff880017092f48 RDI: 0000000000000246 [ 84.192080] RBP: ffff88000abc5008 R08: 0000000000000001 R09: 0000000000000000 [ 84.192080] R10: 0000000000000000 R11: 0000000000000000 R12: 00000000014080c0 [ 84.192080] R13: ffffffff8898e7d1 R14: ffff88001c48ab00 R15: ffff8800168fe034 [ 84.192080] FS: 0000000000000000(0000) GS:ffffffff8a457000(0000) knlGS:0000000000000000 [ 84.192080] CS: 0010 DS: 0000 ES: 0000 CR0: 0000000080050033 [ 84.192080] CR2: 0000000000000000 CR3: 0000000012a25001 CR4: 00000000000206f0 [ 84.192080] Call Trace: [ 84.192080] ? acpi_ut_create_generic_state+0x54/0x8c: acpi_ut_create_generic_state at drivers/acpi/acpica/utstate.c:91 [ 84.192080] kmem_cache_alloc+0xeb/0x120: slab_alloc_node at mm/slub.c:2707 (inlined by) slab_alloc at mm/slub.c:2749 (inlined by) kmem_cache_alloc at mm/slub.c:2754 [ 84.192080] acpi_ut_create_generic_state+0x54/0x8c: acpi_ut_create_generic_state at drivers/acpi/acpica/utstate.c:91 [ 84.192080] acpi_ut_create_update_state+0xe/0x9c: acpi_ut_create_update_state at drivers/acpi/acpica/utstate.c:166 [ 84.192080] acpi_ut_create_update_state_and_push+0x13/0x31: acpi_ut_create_update_state_and_push at drivers/acpi/acpica/utmisc.c:172 [ 84.192080] acpi_ut_update_object_reference+0x253/0x433: acpi_ut_update_object_reference at drivers/acpi/acpica/utdelete.c:549 [ 84.192080] ? acpi_ut_update_ref_count+0x8b3/0x8b3: acpi_ut_update_object_reference at drivers/acpi/acpica/utdelete.c:467 [ 84.192080] ? sched_clock_cpu+0x71/0x80: __preempt_count_sub at arch/x86/include/asm/preempt.h:81 (inlined by) sched_clock_cpu at kernel/sched/clock.c:363 [ 84.192080] acpi_ds_do_implicit_return+0xbd/0xca: acpi_ds_do_implicit_return at drivers/acpi/acpica/dsutils.c:117 [ 84.192080] acpi_ds_is_result_used+0x63/0x2be: acpi_ds_is_result_used at drivers/acpi/acpica/dsutils.c:168 [ 84.192080] acpi_ds_delete_result_if_not_used+0x8c/0xde: acpi_ds_delete_result_if_not_used at drivers/acpi/acpica/dsutils.c:321 [ 84.192080] ? acpi_ds_is_result_used+0x2be/0x2be: acpi_ds_delete_result_if_not_used at drivers/acpi/acpica/dsutils.c:306 [ 84.192080] ? acpi_ds_result_push+0x108/0x277: acpi_ds_result_stack_push at drivers/acpi/acpica/dswstate.c:208 (inlined by) acpi_ds_result_push at drivers/acpi/acpica/dswstate.c:128 [ 84.192080] acpi_ds_exec_end_op+0xb9d/0xbef: acpi_ds_exec_end_op at drivers/acpi/acpica/dswexec.c:719 [ 84.192080] ? acpi_ds_exec_begin_op+0x3f8/0x3f8: acpi_ds_exec_end_op at drivers/acpi/acpica/dswexec.c:325 [ 84.192080] acpi_ps_parse_loop+0x1095/0x112d: acpi_ps_parse_loop at drivers/acpi/acpica/psloop.c:644 [ 84.192080] ? acpi_ps_get_next_arg+0x9f6/0x9f6: acpi_ps_parse_loop at drivers/acpi/acpica/psloop.c:414 [ 84.192080] ? trace_hardirqs_on_caller+0x3e4/0x550: __trace_hardirqs_on_caller at kernel/locking/lockdep.c:2836 (inlined by) trace_hardirqs_on_caller at kernel/locking/lockdep.c:2883 [ 84.192080] ? kmem_cache_alloc+0xb1/0x120: slab_post_alloc_hook at mm/slab.h:444 (inlined by) slab_alloc_node at mm/slub.c:2741 (inlined by) slab_alloc at mm/slub.c:2749 (inlined by) kmem_cache_alloc at mm/slub.c:2754 [ 84.192080] acpi_ps_parse_aml+0x1e0/0x6a6: acpi_ps_parse_aml at drivers/acpi/acpica/psparse.c:475 [ 84.192080] acpi_ps_execute_method+0x48d/0x4ea: acpi_ps_execute_method at drivers/acpi/acpica/psxface.c:187 [ 84.192080] ? acpi_ut_acquire_mutex+0x6c/0x10a: acpi_ut_acquire_mutex at drivers/acpi/acpica/utmutex.c:243 [ 84.192080] acpi_ns_evaluate+0x663/0x8a9: acpi_ns_evaluate at drivers/acpi/acpica/nseval.c:204 [ 84.192080] ? acpi_ut_evaluate_object+0x74/0x337: kmem_cache_alloc_trace at include/linux/slab.h:415 (inlined by) kmalloc at include/linux/slab.h:512 (inlined by) kzalloc at include/linux/slab.h:701 (inlined by) acpi_os_allocate_zeroed at include/acpi/platform/aclinuxex.h:57 (inlined by) acpi_ut_evaluate_object at drivers/acpi/acpica/uteval.c:50 [ 84.192080] acpi_ut_evaluate_object+0xe9/0x337: acpi_ut_evaluate_object at drivers/acpi/acpica/uteval.c:61 [ 84.192080] acpi_rs_get_prt_method_data+0x74/0xca: acpi_rs_get_prt_method_data at drivers/acpi/acpica/rsutils.c:448 [ 84.192080] ? acpi_rs_set_resource_source+0x154/0x154: acpi_rs_get_prt_method_data at drivers/acpi/acpica/rsutils.c:435 [ 84.192080] ? acpi_rs_validate_parameters+0x63/0x96: acpi_rs_validate_parameters at drivers/acpi/acpica/rsxface.c:90 [ 84.192080] acpi_get_irq_routing_table+0x76/0xad: acpi_get_irq_routing_table at drivers/acpi/acpica/rsxface.c:124 [ 84.192080] ? acpi_rs_match_vendor_resource+0x2ea/0x2ea: acpi_get_irq_routing_table at drivers/acpi/acpica/rsxface.c:124 [ 84.192080] ? deref_stack_reg+0x31/0x100: deref_stack_reg at arch/x86/kernel/unwind_orc.c:316 [ 84.192080] ? deref_stack_reg+0xc7/0x100: deref_stack_reg at arch/x86/kernel/unwind_orc.c:320 (discriminator 2) [ 84.192080] acpi_pci_irq_find_prt_entry+0x166/0xbf0: acpi_pci_irq_find_prt_entry at drivers/acpi/pci_irq.c:235 [ 84.192080] ? sched_clock_local+0x88/0xb0 [ 84.192080] ? acpi_penalize_sci_irq+0x30/0x30: acpi_pci_irq_find_prt_entry at drivers/acpi/pci_irq.c:221 [ 84.192080] acpi_pci_irq_lookup+0x7e/0x640: acpi_pci_irq_lookup at drivers/acpi/pci_irq.c:319 [ 84.192080] ? _raw_spin_unlock_irqrestore+0x2d/0x60: arch_local_irq_restore at arch/x86/include/asm/paravirt.h:783 (inlined by) __raw_spin_unlock_irqrestore at include/linux/spinlock_api_smp.h:160 (inlined by) _raw_spin_unlock_irqrestore at kernel/locking/spinlock.c:184 [ 84.192080] ? acpi_pci_irq_find_prt_entry+0xbf0/0xbf0: acpi_pci_irq_lookup at drivers/acpi/pci_irq.c:312 [ 84.192080] ? pci_conf1_read+0xa3/0x1f0: pci_conf1_read at arch/x86/pci/direct.c:50 [ 84.192080] acpi_pci_irq_enable+0x1a1/0x520: acpi_pci_irq_enable at drivers/acpi/pci_irq.c:439 [ 84.192080] ? acpi_pci_irq_lookup+0x640/0x640: acpi_pci_irq_enable at drivers/acpi/pci_irq.c:409 [ 84.192080] ? pci_enable_resources+0x7f/0x240: pci_enable_resources at drivers/pci/setup-res.c:461 [ 84.192080] ? pci_resize_resource+0x350/0x350: pci_enable_resources at drivers/pci/setup-res.c:456 [ 84.192080] do_pci_enable_device+0xda/0x180: do_pci_enable_device at drivers/pci/pci.c:1316 [ 84.192080] ? pci_load_and_free_saved_state+0xa0/0xa0: do_pci_enable_device at drivers/pci/pci.c:1301 [ 84.192080] ? find_held_lock+0x3e/0x1c0: find_held_lock at kernel/locking/lockdep.c:3536 [ 84.192080] ? __lock_is_held+0xb5/0x140: __lock_is_held at kernel/locking/lockdep.c:3740 [ 84.192080] pci_enable_device_flags+0x248/0x360: pci_enable_device_flags at drivers/pci/pci.c:1405 [ 84.192080] ? pci_enable_bridge+0x1e0/0x1e0: pci_enable_device_flags at drivers/pci/pci.c:1372 [ 84.192080] e1000_probe+0x172/0x3a60: e1000_probe at drivers/net/ethernet/intel/e1000/e1000_main.c:970 [ 84.192080] ? sched_clock_local+0x88/0xb0 [ 84.192080] ? e1000_io_slot_reset+0x120/0x120: e1000_probe at drivers/net/ethernet/intel/e1000/e1000_main.c:947 [ 84.192080] ? lock_downgrade+0x5b0/0x5b0: lock_release at kernel/locking/lockdep.c:3929 [ 84.192080] ? _raw_spin_unlock_irqrestore+0x2d/0x60: arch_local_irq_restore at arch/x86/include/asm/paravirt.h:783 (inlined by) __raw_spin_unlock_irqrestore at include/linux/spinlock_api_smp.h:160 (inlined by) _raw_spin_unlock_irqrestore at kernel/locking/spinlock.c:184 [ 84.192080] ? trace_hardirqs_on_caller+0x3e4/0x550: __trace_hardirqs_on_caller at kernel/locking/lockdep.c:2836 (inlined by) trace_hardirqs_on_caller at kernel/locking/lockdep.c:2883 [ 84.192080] pci_device_probe+0x268/0x460: local_pci_probe at drivers/pci/pci-driver.c:305 (inlined by) pci_call_probe at drivers/pci/pci-driver.c:358 (inlined by) __pci_device_probe at drivers/pci/pci-driver.c:383 (inlined by) pci_device_probe at drivers/pci/pci-driver.c:423 [ 84.192080] driver_probe_device+0x545/0x800: really_probe at drivers/base/dd.c:449 (inlined by) driver_probe_device at drivers/base/dd.c:590 [ 84.192080] __driver_attach+0x136/0x170: __driver_attach at drivers/base/dd.c:824 [ 84.192080] ? driver_probe_device+0x800/0x800: __driver_attach at drivers/base/dd.c:794 [ 84.192080] bus_for_each_dev+0x122/0x1d0: bus_for_each_dev at drivers/base/bus.c:310 [ 84.192080] ? lock_downgrade+0x5b0/0x5b0: lock_release at kernel/locking/lockdep.c:3929 [ 84.192080] ? store_drivers_autoprobe+0x130/0x130: bus_for_each_dev at drivers/base/bus.c:300 [ 84.192080] bus_add_driver+0x42a/0x5c0: bus_add_driver at drivers/base/bus.c:668 [ 84.192080] ? cavium_ptp_driver_init+0x15/0x15: e1000_init_module at drivers/net/ethernet/intel/e1000/e1000_main.c:250 [ 84.192080] driver_register+0x182/0x3a0: driver_register at drivers/base/driver.c:167 [ 84.192080] ? cavium_ptp_driver_init+0x15/0x15: e1000_init_module at drivers/net/ethernet/intel/e1000/e1000_main.c:250 [ 84.192080] e1000_init_module+0x43/0x75: e1000_init_module at drivers/net/ethernet/intel/e1000/e1000_main.c:257 [ 84.192080] do_one_initcall+0x97/0x230: do_trace_initcall_finish at init/main.c:867 (inlined by) do_one_initcall at init/main.c:884 [ 84.192080] ? parameq+0xf0/0xf0: parse_args at kernel/params.c:173 [ 84.192080] ? initcall_blacklisted+0x150/0x150: do_one_initcall at init/main.c:874 [ 84.192080] ? __wake_up_common+0x4e0/0x4e0: __wake_up_common_lock at kernel/sched/wait.c:109 [ 84.192080] ? lock_downgrade+0x5b0/0x5b0: lock_release at kernel/locking/lockdep.c:3929 [ 84.192080] kernel_init_freeable+0x25f/0x2fb: do_initcall_level at init/main.c:951 (inlined by) do_initcalls at init/main.c:959 (inlined by) do_basic_setup at init/main.c:977 (inlined by) kernel_init_freeable at init/main.c:1127 [ 84.192080] ? rest_init+0x150/0x150: kernel_init at init/main.c:1050 [ 84.192080] kernel_init+0xa/0x110: kernel_init at init/main.c:1055 [ 84.192080] ? rest_init+0x150/0x150: kernel_init at init/main.c:1050 [ 84.192080] ret_from_fork+0x24/0x30: ret_from_fork at arch/x86/entry/entry_64.S:418 [ 84.192080] Code: 44 00 00 e8 16 54 e1 ff 48 89 ef 4c 89 f1 4c 89 ea 44 89 e6 e8 d5 fb ff ff f6 c7 02 48 89 c5 74 1b e8 88 51 e1 ff 48 89 df 57 9d <0f> 1f 44 00 00 5b 48 89 e8 5d 41 5c 41 5d 41 5e c3 48 89 df 57 [ 84.192080] Kernel panic - not syncing: softlockup: hung tasks [ 84.192080] CPU: 0 PID: 1 Comm: swapper Tainted: G L 4.17.0-rc1 #259 [ 84.192080] Hardware name: QEMU Standard PC (i440FX + PIIX, 1996), BIOS 1.10.2-1 04/01/2014 [ 84.192080] Call Trace: [ 84.192080] [ 84.192080] panic+0x1a8/0x2e3: panic at kernel/panic.c:195 [ 84.192080] ? refcount_error_report+0x28d/0x28d: panic at kernel/panic.c:136 [ 84.192080] watchdog_timer_fn+0x248/0x250: watchdog_timer_fn at kernel/watchdog.c:428 [ 84.192080] ? softlockup_update_smpboot_threads+0x80/0x80: watchdog_timer_fn at kernel/watchdog.c:340 [ 84.192080] __hrtimer_run_queues+0x1b5/0x480 [ 84.192080] hrtimer_run_queues+0x85/0xa0: hrtimer_run_queues at kernel/time/hrtimer.c:1621 [ 84.192080] run_local_timers+0x5/0x50: run_local_timers at kernel/time/timer.c:1706 [ 84.192080] update_process_times+0x1b/0x50: update_process_times at kernel/time/timer.c:1636 [ 84.192080] tick_periodic+0x46/0x140 [ 84.192080] tick_handle_periodic+0x29/0x90: clockevent_state_oneshot at include/linux/clockchips.h:152 (inlined by) tick_handle_periodic at kernel/time/tick-common.c:116 [ 84.192080] smp_apic_timer_interrupt+0x77/0xc0: exiting_irq at arch/x86/include/asm/apic.h:525 (inlined by) smp_apic_timer_interrupt at arch/x86/kernel/apic/apic.c:1052 [ 84.192080] apic_timer_interrupt+0xf/0x20: apic_timer_interrupt at arch/x86/entry/entry_64.S:863 [ 84.192080] [ 84.192080] RIP: 0010:__slab_alloc+0x4d/0x80 [ 84.192080] RSP: 0000:ffff88001709f088 EFLAGS: 00000246 ORIG_RAX: ffffffffffffff13 [ 84.192080] RAX: 0000000000000007 RBX: 0000000000000246 RCX: 0000000000000018 [ 84.192080] RDX: 0000000000000000 RSI: ffff880017092f48 RDI: 0000000000000246 [ 84.192080] RBP: ffff88000abc5008 R08: 0000000000000001 R09: 0000000000000000 [ 84.192080] R10: 0000000000000000 R11: 0000000000000000 R12: 00000000014080c0 [ 84.192080] R13: ffffffff8898e7d1 R14: ffff88001c48ab00 R15: ffff8800168fe034 [ 84.192080] ? acpi_ut_create_generic_state+0x54/0x8c: acpi_ut_create_generic_state at drivers/acpi/acpica/utstate.c:91 [ 84.192080] kmem_cache_alloc+0xeb/0x120: slab_alloc_node at mm/slub.c:2707 (inlined by) slab_alloc at mm/slub.c:2749 (inlined by) kmem_cache_alloc at mm/slub.c:2754 [ 84.192080] acpi_ut_create_generic_state+0x54/0x8c: acpi_ut_create_generic_state at drivers/acpi/acpica/utstate.c:91 [ 84.192080] acpi_ut_create_update_state+0xe/0x9c: acpi_ut_create_update_state at drivers/acpi/acpica/utstate.c:166 [ 84.192080] acpi_ut_create_update_state_and_push+0x13/0x31: acpi_ut_create_update_state_and_push at drivers/acpi/acpica/utmisc.c:172 [ 84.192080] acpi_ut_update_object_reference+0x253/0x433: acpi_ut_update_object_reference at drivers/acpi/acpica/utdelete.c:549 [ 84.192080] ? acpi_ut_update_ref_count+0x8b3/0x8b3: acpi_ut_update_object_reference at drivers/acpi/acpica/utdelete.c:467 [ 84.192080] ? sched_clock_cpu+0x71/0x80: __preempt_count_sub at arch/x86/include/asm/preempt.h:81 (inlined by) sched_clock_cpu at kernel/sched/clock.c:363 [ 84.192080] acpi_ds_do_implicit_return+0xbd/0xca: acpi_ds_do_implicit_return at drivers/acpi/acpica/dsutils.c:117 [ 84.192080] acpi_ds_is_result_used+0x63/0x2be: acpi_ds_is_result_used at drivers/acpi/acpica/dsutils.c:168 [ 84.192080] acpi_ds_delete_result_if_not_used+0x8c/0xde: acpi_ds_delete_result_if_not_used at drivers/acpi/acpica/dsutils.c:321 [ 84.192080] ? acpi_ds_is_result_used+0x2be/0x2be: acpi_ds_delete_result_if_not_used at drivers/acpi/acpica/dsutils.c:306 [ 84.192080] ? acpi_ds_result_push+0x108/0x277: acpi_ds_result_stack_push at drivers/acpi/acpica/dswstate.c:208 (inlined by) acpi_ds_result_push at drivers/acpi/acpica/dswstate.c:128 [ 84.192080] acpi_ds_exec_end_op+0xb9d/0xbef: acpi_ds_exec_end_op at drivers/acpi/acpica/dswexec.c:719 [ 84.192080] ? acpi_ds_exec_begin_op+0x3f8/0x3f8: acpi_ds_exec_end_op at drivers/acpi/acpica/dswexec.c:325 [ 84.192080] acpi_ps_parse_loop+0x1095/0x112d: acpi_ps_parse_loop at drivers/acpi/acpica/psloop.c:644 [ 84.192080] ? acpi_ps_get_next_arg+0x9f6/0x9f6: acpi_ps_parse_loop at drivers/acpi/acpica/psloop.c:414 [ 84.192080] ? trace_hardirqs_on_caller+0x3e4/0x550: __trace_hardirqs_on_caller at kernel/locking/lockdep.c:2836 (inlined by) trace_hardirqs_on_caller at kernel/locking/lockdep.c:2883 [ 84.192080] ? kmem_cache_alloc+0xb1/0x120: slab_post_alloc_hook at mm/slab.h:444 (inlined by) slab_alloc_node at mm/slub.c:2741 (inlined by) slab_alloc at mm/slub.c:2749 (inlined by) kmem_cache_alloc at mm/slub.c:2754 [ 84.192080] acpi_ps_parse_aml+0x1e0/0x6a6: acpi_ps_parse_aml at drivers/acpi/acpica/psparse.c:475 [ 84.192080] acpi_ps_execute_method+0x48d/0x4ea: acpi_ps_execute_method at drivers/acpi/acpica/psxface.c:187 [ 84.192080] ? acpi_ut_acquire_mutex+0x6c/0x10a: acpi_ut_acquire_mutex at drivers/acpi/acpica/utmutex.c:243 [ 84.192080] acpi_ns_evaluate+0x663/0x8a9: acpi_ns_evaluate at drivers/acpi/acpica/nseval.c:204 [ 84.192080] ? acpi_ut_evaluate_object+0x74/0x337: kmem_cache_alloc_trace at include/linux/slab.h:415 (inlined by) kmalloc at include/linux/slab.h:512 (inlined by) kzalloc at include/linux/slab.h:701 (inlined by) acpi_os_allocate_zeroed at include/acpi/platform/aclinuxex.h:57 (inlined by) acpi_ut_evaluate_object at drivers/acpi/acpica/uteval.c:50 [ 84.192080] acpi_ut_evaluate_object+0xe9/0x337: acpi_ut_evaluate_object at drivers/acpi/acpica/uteval.c:61 [ 84.192080] acpi_rs_get_prt_method_data+0x74/0xca: acpi_rs_get_prt_method_data at drivers/acpi/acpica/rsutils.c:448 [ 84.192080] ? acpi_rs_set_resource_source+0x154/0x154: acpi_rs_get_prt_method_data at drivers/acpi/acpica/rsutils.c:435 [ 84.192080] ? acpi_rs_validate_parameters+0x63/0x96: acpi_rs_validate_parameters at drivers/acpi/acpica/rsxface.c:90 [ 84.192080] acpi_get_irq_routing_table+0x76/0xad: acpi_get_irq_routing_table at drivers/acpi/acpica/rsxface.c:124 [ 84.192080] ? acpi_rs_match_vendor_resource+0x2ea/0x2ea: acpi_get_irq_routing_table at drivers/acpi/acpica/rsxface.c:124 [ 84.192080] ? deref_stack_reg+0x31/0x100: deref_stack_reg at arch/x86/kernel/unwind_orc.c:316 [ 84.192080] ? deref_stack_reg+0xc7/0x100: deref_stack_reg at arch/x86/kernel/unwind_orc.c:320 (discriminator 2) [ 84.192080] acpi_pci_irq_find_prt_entry+0x166/0xbf0: acpi_pci_irq_find_prt_entry at drivers/acpi/pci_irq.c:235 [ 84.192080] ? sched_clock_local+0x88/0xb0 [ 84.192080] ? acpi_penalize_sci_irq+0x30/0x30: acpi_pci_irq_find_prt_entry at drivers/acpi/pci_irq.c:221 [ 84.192080] acpi_pci_irq_lookup+0x7e/0x640: acpi_pci_irq_lookup at drivers/acpi/pci_irq.c:319 [ 84.192080] ? _raw_spin_unlock_irqrestore+0x2d/0x60: arch_local_irq_restore at arch/x86/include/asm/paravirt.h:783 (inlined by) __raw_spin_unlock_irqrestore at include/linux/spinlock_api_smp.h:160 (inlined by) _raw_spin_unlock_irqrestore at kernel/locking/spinlock.c:184 [ 84.192080] ? acpi_pci_irq_find_prt_entry+0xbf0/0xbf0: acpi_pci_irq_lookup at drivers/acpi/pci_irq.c:312 [ 84.192080] ? pci_conf1_read+0xa3/0x1f0: pci_conf1_read at arch/x86/pci/direct.c:50 [ 84.192080] acpi_pci_irq_enable+0x1a1/0x520: acpi_pci_irq_enable at drivers/acpi/pci_irq.c:439 [ 84.192080] ? acpi_pci_irq_lookup+0x640/0x640: acpi_pci_irq_enable at drivers/acpi/pci_irq.c:409 [ 84.192080] ? pci_enable_resources+0x7f/0x240: pci_enable_resources at drivers/pci/setup-res.c:461 [ 84.192080] ? pci_resize_resource+0x350/0x350: pci_enable_resources at drivers/pci/setup-res.c:456 [ 84.192080] do_pci_enable_device+0xda/0x180: do_pci_enable_device at drivers/pci/pci.c:1316 [ 84.192080] ? pci_load_and_free_saved_state+0xa0/0xa0: do_pci_enable_device at drivers/pci/pci.c:1301 [ 84.192080] ? find_held_lock+0x3e/0x1c0: find_held_lock at kernel/locking/lockdep.c:3536 [ 84.192080] ? __lock_is_held+0xb5/0x140: __lock_is_held at kernel/locking/lockdep.c:3740 [ 84.192080] pci_enable_device_flags+0x248/0x360: pci_enable_device_flags at drivers/pci/pci.c:1405 [ 84.192080] ? pci_enable_bridge+0x1e0/0x1e0: pci_enable_device_flags at drivers/pci/pci.c:1372 [ 84.192080] e1000_probe+0x172/0x3a60: e1000_probe at drivers/net/ethernet/intel/e1000/e1000_main.c:970 [ 84.192080] ? sched_clock_local+0x88/0xb0 [ 84.192080] ? e1000_io_slot_reset+0x120/0x120: e1000_probe at drivers/net/ethernet/intel/e1000/e1000_main.c:947 [ 84.192080] ? lock_downgrade+0x5b0/0x5b0: lock_release at kernel/locking/lockdep.c:3929 [ 84.192080] ? _raw_spin_unlock_irqrestore+0x2d/0x60: arch_local_irq_restore at arch/x86/include/asm/paravirt.h:783 (inlined by) __raw_spin_unlock_irqrestore at include/linux/spinlock_api_smp.h:160 (inlined by) _raw_spin_unlock_irqrestore at kernel/locking/spinlock.c:184 [ 84.192080] ? trace_hardirqs_on_caller+0x3e4/0x550: __trace_hardirqs_on_caller at kernel/locking/lockdep.c:2836 (inlined by) trace_hardirqs_on_caller at kernel/locking/lockdep.c:2883 [ 84.192080] pci_device_probe+0x268/0x460: local_pci_probe at drivers/pci/pci-driver.c:305 (inlined by) pci_call_probe at drivers/pci/pci-driver.c:358 (inlined by) __pci_device_probe at drivers/pci/pci-driver.c:383 (inlined by) pci_device_probe at drivers/pci/pci-driver.c:423 [ 84.192080] driver_probe_device+0x545/0x800: really_probe at drivers/base/dd.c:449 (inlined by) driver_probe_device at drivers/base/dd.c:590 [ 84.192080] __driver_attach+0x136/0x170: __driver_attach at drivers/base/dd.c:824 [ 84.192080] ? driver_probe_device+0x800/0x800: __driver_attach at drivers/base/dd.c:794 [ 84.192080] bus_for_each_dev+0x122/0x1d0: bus_for_each_dev at drivers/base/bus.c:310 [ 84.192080] ? lock_downgrade+0x5b0/0x5b0: lock_release at kernel/locking/lockdep.c:3929 [ 84.192080] ? store_drivers_autoprobe+0x130/0x130: bus_for_each_dev at drivers/base/bus.c:300 [ 84.192080] bus_add_driver+0x42a/0x5c0: bus_add_driver at drivers/base/bus.c:668 [ 84.192080] ? cavium_ptp_driver_init+0x15/0x15: e1000_init_module at drivers/net/ethernet/intel/e1000/e1000_main.c:250 [ 84.192080] driver_register+0x182/0x3a0: driver_register at drivers/base/driver.c:167 [ 84.192080] ? cavium_ptp_driver_init+0x15/0x15: e1000_init_module at drivers/net/ethernet/intel/e1000/e1000_main.c:250 [ 84.192080] e1000_init_module+0x43/0x75: e1000_init_module at drivers/net/ethernet/intel/e1000/e1000_main.c:257 [ 84.192080] do_one_initcall+0x97/0x230: do_trace_initcall_finish at init/main.c:867 (inlined by) do_one_initcall at init/main.c:884 [ 84.192080] ? parameq+0xf0/0xf0: parse_args at kernel/params.c:173 [ 84.192080] ? initcall_blacklisted+0x150/0x150: do_one_initcall at init/main.c:874 [ 84.192080] ? __wake_up_common+0x4e0/0x4e0: __wake_up_common_lock at kernel/sched/wait.c:109 [ 84.192080] ? lock_downgrade+0x5b0/0x5b0: lock_release at kernel/locking/lockdep.c:3929 [ 84.192080] kernel_init_freeable+0x25f/0x2fb: do_initcall_level at init/main.c:951 (inlined by) do_initcalls at init/main.c:959 (inlined by) do_basic_setup at init/main.c:977 (inlined by) kernel_init_freeable at init/main.c:1127 Attached the full dmesg, kconfig and reproduce scripts. Thanks, Fengguang