[Bug 111440] New: [CI][DRMTIP] igt at gem_pwrite@small-cpu-randomigt at gem_pwrite@small-cpu-random - dmesg-warn - INFO: task kworker/u16:4:154 blocked for more than 61 seconds.

bugzilla-daemon at freedesktop.org bugzilla-daemon at freedesktop.org
Tue Aug 20 10:37:42 UTC 2019


https://bugs.freedesktop.org/show_bug.cgi?id=111440

            Bug ID: 111440
           Summary: [CI][DRMTIP]
                    igt at gem_pwrite@small-cpu-randomigt at gem_pwrite@small-cp
                    u-random - dmesg-warn - INFO: task kworker/u16:4:154
                    blocked for more than 61 seconds.
           Product: DRI
           Version: DRI git
          Hardware: Other
                OS: All
            Status: NEW
          Severity: normal
          Priority: medium
         Component: DRM/Intel
          Assignee: intel-gfx-bugs at lists.freedesktop.org
          Reporter: lakshminarayana.vudum at intel.com
        QA Contact: intel-gfx-bugs at lists.freedesktop.org
                CC: intel-gfx-bugs at lists.freedesktop.org

https://intel-gfx-ci.01.org/tree/drm-tip/drmtip_347/fi-blb-e6850/igt@gem_pwrite@small-cpu-random.html

<6> [34.633962] Console: switching to colour dummy device 80x25
<6> [34.634076] [IGT] gem_pwrite: executing
<6> [34.645570] [IGT] gem_pwrite: starting subtest small-cpu-random
<6> [34.660994] gem_pwrite (1005): drop_caches: 4
<6> [38.869235] [IGT] gem_pwrite: exiting, ret=0
<5> [38.871552] Setting dangerous option reset - tainting kernel
<3> [124.235542] INFO: task kworker/u16:4:154 blocked for more than 61 seconds.
<3> [124.235628]       Tainted: G     U  W        
5.3.0-rc4-ge64af2bda23c-drmtip_347+ #1
<3> [124.235681] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables
this message.
<6> [124.235719] kworker/u16:4   D13272   154      2 0x80004000
<6> [124.235734] Workqueue: events_unbound async_run_entry_fn
<4> [124.235738] Call Trace:
<4> [124.235748]  ? __schedule+0x30e/0x860
<4> [124.235756]  ? wait_for_common+0x116/0x1f0
<4> [124.235761]  schedule+0x2e/0xb0
<4> [124.235765]  schedule_timeout+0x21b/0x3d0
<4> [124.235773]  ? wait_for_common+0x116/0x1f0
<4> [124.235777]  ? mark_held_locks+0x49/0x70
<4> [124.235781]  ? _raw_spin_unlock_irq+0x24/0x50
<4> [124.235787]  ? wait_for_common+0x116/0x1f0
<4> [124.235791]  wait_for_common+0x13a/0x1f0
<4> [124.235797]  ? wake_up_q+0x80/0x80
<4> [124.235806]  __flush_work+0x28f/0x4d0
<4> [124.235812]  ? flush_workqueue_prep_pwqs+0x1b0/0x1b0
<4> [124.235825]  ? work_busy+0x150/0x150
<4> [124.235829]  __cancel_work_timer+0x13b/0x1e0
<4> [124.235847]  mei_cancel_work+0x1c/0x30 [mei]
<4> [124.235855]  mei_me_probe+0x316/0x380 [mei_me]
<4> [124.235863]  pci_device_probe+0x9e/0x120
<4> [124.235871]  really_probe+0xea/0x3d0
<4> [124.235877]  driver_probe_device+0x10b/0x120
<4> [124.235882]  __driver_attach_async_helper+0x7f/0x90
<4> [124.235887]  async_run_entry_fn+0x34/0x160
<4> [124.235893]  process_one_work+0x245/0x610
<4> [124.235903]  worker_thread+0x37/0x380
<4> [124.235910]  ? process_one_work+0x610/0x610
<4> [124.235913]  kthread+0x119/0x130
<4> [124.235917]  ? kthread_park+0xa0/0xa0
<4> [124.235924]  ret_from_fork+0x3a/0x50
<3> [124.235941] INFO: task systemd-udevd:264 blocked for more than 61 seconds.
<3> [124.235975]       Tainted: G     U  W        
5.3.0-rc4-ge64af2bda23c-drmtip_347+ #1
<3> [124.236013] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables
this message.
<6> [124.236051] systemd-udevd   D12504   264    214 0x80004100
<4> [124.236058] Call Trace:
<4> [124.236066]  ? __schedule+0x30e/0x860
<4> [124.236075]  schedule+0x2e/0xb0
<4> [124.236080]  async_synchronize_cookie_domain+0x9f/0x150
<4> [124.236084]  ? wait_woken+0xa0/0xa0
<4> [124.236094]  do_init_module+0xb7/0x1f6
<4> [124.236099]  load_module+0x25bd/0x2a40
<4> [124.236123]  ? __se_sys_finit_module+0xd3/0xf0
<4> [124.236127]  __se_sys_finit_module+0xd3/0xf0
<4> [124.236143]  do_syscall_64+0x55/0x1c0
<4> [124.236148]  entry_SYSCALL_64_after_hwframe+0x49/0xbe
<4> [124.236151] RIP: 0033:0x7fe3834c8839
<4> [124.236159] Code: Bad RIP value.
<4> [124.236162] RSP: 002b:00007ffe64261328 EFLAGS: 00000246 ORIG_RAX:
0000000000000139
<4> [124.236166] RAX: ffffffffffffffda RBX: 0000558d1f9eebb0 RCX:
00007fe3834c8839
<4> [124.236169] RDX: 0000000000000000 RSI: 00007fe3831a7145 RDI:
000000000000000f
<4> [124.236172] RBP: 00007fe3831a7145 R08: 0000000000000000 R09:
00007ffe64261440
<4> [124.236175] R10: 000000000000000f R11: 0000000000000246 R12:
0000000000000000
<4> [124.236178] R13: 0000558d1fa10e90 R14: 0000000000020000 R15:
0000558d1f9eebb0
<3> [124.236192] INFO: task systemd-udevd:266 blocked for more than 61 seconds.
<3> [124.236227]       Tainted: G     U  W        
5.3.0-rc4-ge64af2bda23c-drmtip_347+ #1
<3> [124.236264] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables
this message.
<6> [124.236302] systemd-udevd   D13176   266    214 0x80004100
<4> [124.236310] Call Trace:
<4> [124.236317]  ? __schedule+0x30e/0x860
<4> [124.236327]  schedule+0x2e/0xb0
<4> [124.236331]  async_synchronize_cookie_domain+0x9f/0x150
<4> [124.236336]  ? wait_woken+0xa0/0xa0
<4> [124.236343]  do_init_module+0xb7/0x1f6
<4> [124.236348]  load_module+0x25bd/0x2a40
<4> [124.236372]  ? __se_sys_finit_module+0xd3/0xf0
<4> [124.236375]  __se_sys_finit_module+0xd3/0xf0
<4> [124.236391]  do_syscall_64+0x55/0x1c0
<4> [124.236395]  entry_SYSCALL_64_after_hwframe+0x49/0xbe
<4> [124.236398] RIP: 0033:0x7fe3834c8839
<4> [124.236403] Code: Bad RIP value.
<4> [124.236406] RSP: 002b:00007ffe64261328 EFLAGS: 00000246 ORIG_RAX:
0000000000000139
<4> [124.236410] RAX: ffffffffffffffda RBX: 0000558d1f9eebb0 RCX:
00007fe3834c8839
<4> [124.236413] RDX: 0000000000000000 RSI: 00007fe3831a7145 RDI:
000000000000000f
<4> [124.236416] RBP: 00007fe3831a7145 R08: 0000000000000000 R09:
00007ffe64261440
<4> [124.236419] R10: 000000000000000f R11: 0000000000000246 R12:
0000000000000000
<4> [124.236422] R13: 0000558d1fa10e90 R14: 0000000000020000 R15:
0000558d1f9eebb0
<3> [124.236440] INFO: task kworker/1:4:455 blocked for more than 61 seconds.
<3> [124.236473]       Tainted: G     U  W        
5.3.0-rc4-ge64af2bda23c-drmtip_347+ #1
<3> [124.236551] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables
this message.
<6> [124.236590] kworker/1:4     D14480   455      2 0x80004000
<6> [124.236602] Workqueue: events output_poll_execute
<4> [124.236606] Call Trace:
<4> [124.236613]  ? __schedule+0x30e/0x860
<4> [124.236623]  schedule+0x2e/0xb0
<4> [124.236627]  async_synchronize_cookie_domain+0x9f/0x150
<4> [124.236632]  ? wait_woken+0xa0/0xa0
<4> [124.236801]  intel_fbdev_output_poll_changed+0x7e/0x90 [i915]
<4> [124.236809]  drm_kms_helper_hotplug_event+0x21/0x30
<4> [124.236813]  output_poll_execute+0x1a0/0x1b0
<4> [124.236822]  process_one_work+0x245/0x610
<4> [124.236832]  worker_thread+0x37/0x380
<4> [124.236839]  ? process_one_work+0x610/0x610
<4> [124.236842]  kthread+0x119/0x130
<4> [124.236846]  ? kthread_park+0xa0/0xa0
<4> [124.236852]  ret_from_fork+0x3a/0x50
<3> [124.236876] INFO: task gem_pwrite:1005 blocked for more than 61 seconds.
<3> [124.236910]       Tainted: G     U  W        
5.3.0-rc4-ge64af2bda23c-drmtip_347+ #1
<3> [124.236949] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables
this message.
<6> [124.236988] gem_pwrite      D12808  1005   1004 0x00000000
<4> [124.236995] Call Trace:
<4> [124.237002]  ? __schedule+0x30e/0x860
<4> [124.237012]  schedule+0x2e/0xb0
<4> [124.237016]  async_synchronize_cookie_domain+0x9f/0x150
<4> [124.237021]  ? wait_woken+0xa0/0xa0
<4> [124.237105]  intel_fbdev_restore_mode+0x3a/0x60 [i915]
<4> [124.237110]  drm_lastclose+0x2a/0x50
<4> [124.237114]  drm_release+0xb9/0xe0
<4> [124.237120]  __fput+0xc2/0x250
<4> [124.237128]  task_work_run+0x82/0xb0
<4> [124.237135]  exit_to_usermode_loop+0x93/0xa0
<4> [124.237139]  do_syscall_64+0x16d/0x1c0
<4> [124.237143]  entry_SYSCALL_64_after_hwframe+0x49/0xbe
<4> [124.237147] RIP: 0033:0x7f27e2779421
<4> [124.237152] Code: Bad RIP value.
<4> [124.237155] RSP: 002b:00007ffe421b4678 EFLAGS: 00000246 ORIG_RAX:
0000000000000003
<4> [124.237159] RAX: 0000000000000000 RBX: 0000000000000001 RCX:
00007f27e2779421
<4> [124.237162] RDX: 0000000000000000 RSI: 00007ffe421b44b0 RDI:
0000000000000006
<4> [124.237165] RBP: 0000000000000000 R08: 0000000000000000 R09:
0000000000000000
<4> [124.237168] R10: 0000000000000000 R11: 0000000000000246 R12:
00007f27e2c0d860
<4> [124.237171] R13: 0000000000000003 R14: 00007f27e2767628 R15:
00007f27e2763d80
<4> [124.237184] 
Showing all locks held in the system:
<4> [124.237190] 1 lock held by khungtaskd/23:
<4> [124.237192]  #0: 00000000d5e7ba30 (rcu_read_lock){....}, at:
debug_show_all_locks+0xe/0x1a0
<4> [124.237204] 3 locks held by kworker/u16:4/154:
<4> [124.237207]  #0: 00000000d401d32d ((wq_completion)events_unbound){+.+.},
at: process_one_work+0x1bf/0x610
<4> [124.237214]  #1: 000000008c682750 ((work_completion)(&entry->work)){+.+.},
at: process_one_work+0x1bf/0x610
<4> [124.237221]  #2: 00000000439a769d (&dev->mutex){....}, at:
__driver_attach_async_helper+0x13/0x90
<4> [124.237229] 3 locks held by kworker/1:2/159:
<4> [124.237232]  #0: 00000000a264814d ((wq_completion)events){+.+.}, at:
process_one_work+0x1bf/0x610
<4> [124.237238]  #1: 00000000f59b9d9b
((work_completion)(&dev->bus_rescan_work)){+.+.}, at:
process_one_work+0x1bf/0x610
<4> [124.237245]  #2: 0000000062295e78 (&dev->cl_bus_lock){+.+.}, at:
mei_cl_bus_rescan_work+0x2f/0x350 [mei]
<4> [124.237258] 1 lock held by in:imklog/281:
<4> [124.237262] 2 locks held by kworker/1:4/455:
<4> [124.237265]  #0: 00000000a264814d ((wq_completion)events){+.+.}, at:
process_one_work+0x1bf/0x610
<4> [124.237271]  #1: 00000000c7d25de6
((work_completion)(&(&dev->mode_config.output_poll_work)->work)){+.+.}, at:
process_one_work+0x1bf/0x610
<4> [124.237283] 3 locks held by dmesg/987:
<4> [124.237286] 1 lock held by gem_pwrite/1005:
<4> [124.237288]  #0: 00000000b0cf4ab7 (drm_global_mutex){+.+.}, at:
drm_release+0x26/0xe0

-- 
You are receiving this mail because:
You are on the CC list for the bug.
You are the QA Contact for the bug.
You are the assignee for the bug.
-------------- next part --------------
An HTML attachment was scrubbed...
URL: <https://lists.freedesktop.org/archives/intel-gfx-bugs/attachments/20190820/24eda4fb/attachment-0001.html>


More information about the intel-gfx-bugs mailing list