syzbot


INFO: task hung in tty_mode_ioctl

Status: auto-closed as invalid on 2021/11/25 22:26
Subsystems: serial
[Documentation on labels]
First crash: 1453d, last: 1453d

Sample crash report:
INFO: task systemd:1 blocked for more than 143 seconds.
      Not tainted 5.14.0-rc7-syzkaller #0
"echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message.
task:systemd         state:D stack:16888 pid:    1 ppid:     0 flags:0x00004000
Call Trace:
 context_switch kernel/sched/core.c:4681 [inline]
 __schedule+0xc07/0x11f0 kernel/sched/core.c:5938
 schedule+0x14b/0x210 kernel/sched/core.c:6017
 rwsem_down_read_slowpath+0x521/0x960 kernel/locking/rwsem.c:992
 __down_read_common+0xaa/0x450 kernel/locking/rwsem.c:1213
 copy_termios drivers/tty/tty_ioctl.c:449 [inline]
 tty_mode_ioctl+0x1b2/0xac0 drivers/tty/tty_ioctl.c:737
 tty_ioctl+0xfe5/0x1720 drivers/tty/tty_io.c:2814
 vfs_ioctl fs/ioctl.c:51 [inline]
 __do_sys_ioctl fs/ioctl.c:1069 [inline]
 __se_sys_ioctl+0xfb/0x170 fs/ioctl.c:1055
 do_syscall_x64 arch/x86/entry/common.c:50 [inline]
 do_syscall_64+0x3d/0xb0 arch/x86/entry/common.c:80
 entry_SYSCALL_64_after_hwframe+0x44/0xae
RIP: 0033:0x7f25325d680a
RSP: 002b:00007fffe9e990a0 EFLAGS: 00000206 ORIG_RAX: 0000000000000010
RAX: ffffffffffffffda RBX: 0000000000000013 RCX: 00007f25325d680a
RDX: 00007fffe9e990a0 RSI: 0000000000005401 RDI: 0000000000000013
RBP: 0000000000000015 R08: 00007fffe9e990e0 R09: 0000000000000000
R10: 0000000000000008 R11: 0000000000000206 R12: 0000000000080902
R13: 000055aef1775e50 R14: 0000000000000000 R15: 000055aef1771fa0
INFO: task syz-executor.1:14368 blocked for more than 143 seconds.
      Not tainted 5.14.0-rc7-syzkaller #0
"echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message.
task:syz-executor.1  state:D stack:21688 pid:14368 ppid: 15778 flags:0x00004004
Call Trace:
 context_switch kernel/sched/core.c:4681 [inline]
 __schedule+0xc07/0x11f0 kernel/sched/core.c:5938
 schedule+0x14b/0x210 kernel/sched/core.c:6017
 schedule_preempt_disabled+0xf/0x20 kernel/sched/core.c:6076
 __mutex_lock_common+0x116f/0x3770 kernel/locking/mutex.c:1036
 __mutex_lock kernel/locking/mutex.c:1104 [inline]
 mutex_lock_nested+0x1a/0x20 kernel/locking/mutex.c:1119
 paste_selection+0x155/0x500 drivers/tty/vt/selection.c:390
 vt_ioctl+0x455/0x37b0 drivers/tty/vt/vt_ioctl.c:760
 tty_ioctl+0xf51/0x1720 drivers/tty/tty_io.c:2805
 vfs_ioctl fs/ioctl.c:51 [inline]
 __do_sys_ioctl fs/ioctl.c:1069 [inline]
 __se_sys_ioctl+0xfb/0x170 fs/ioctl.c:1055
 do_syscall_x64 arch/x86/entry/common.c:50 [inline]
 do_syscall_64+0x3d/0xb0 arch/x86/entry/common.c:80
 entry_SYSCALL_64_after_hwframe+0x44/0xae
RIP: 0033:0x4665f9
RSP: 002b:00007fe89aab9188 EFLAGS: 00000246 ORIG_RAX: 0000000000000010
RAX: ffffffffffffffda RBX: 000000000056c0f0 RCX: 00000000004665f9
RDX: 0000000020000040 RSI: 000000000000541c RDI: 0000000000000007
RBP: 00000000004bfcc4 R08: 0000000000000000 R09: 0000000000000000
R10: 0000000000000000 R11: 0000000000000246 R12: 000000000056c0f0
R13: 00007ffe6347027f R14: 00007fe89aab9300 R15: 0000000000022000
INFO: task syz-executor.1:14376 blocked for more than 143 seconds.
      Not tainted 5.14.0-rc7-syzkaller #0
"echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message.
task:syz-executor.1  state:D stack:25840 pid:14376 ppid: 15778 flags:0x00004004
Call Trace:
 context_switch kernel/sched/core.c:4681 [inline]
 __schedule+0xc07/0x11f0 kernel/sched/core.c:5938
 schedule+0x14b/0x210 kernel/sched/core.c:6017
 rwsem_down_write_slowpath+0xec7/0x14c0 kernel/locking/rwsem.c:1106
 __down_write_common kernel/locking/rwsem.c:1261 [inline]
 __down_write kernel/locking/rwsem.c:1270 [inline]
 down_write+0x165/0x170 kernel/locking/rwsem.c:1407
 tty_set_termios+0x11b/0x15e0 drivers/tty/tty_ioctl.c:352
 set_termios+0x5e4/0x6e0 drivers/tty/tty_ioctl.c:438
 tty_mode_ioctl+0x884/0xac0 drivers/tty/tty_ioctl.c:749
 tty_ioctl+0xfe5/0x1720 drivers/tty/tty_io.c:2814
 vfs_ioctl fs/ioctl.c:51 [inline]
 __do_sys_ioctl fs/ioctl.c:1069 [inline]
 __se_sys_ioctl+0xfb/0x170 fs/ioctl.c:1055
 do_syscall_x64 arch/x86/entry/common.c:50 [inline]
 do_syscall_64+0x3d/0xb0 arch/x86/entry/common.c:80
 entry_SYSCALL_64_after_hwframe+0x44/0xae
RIP: 0033:0x4665f9
RSP: 002b:00007fe89aa98188 EFLAGS: 00000246 ORIG_RAX: 0000000000000010
RAX: ffffffffffffffda RBX: 000000000056c1a8 RCX: 00000000004665f9
RDX: 0000000020000100 RSI: 00000000402c542b RDI: 0000000000000005
RBP: 00000000004bfcc4 R08: 0000000000000000 R09: 0000000000000000
R10: 0000000000000000 R11: 0000000000000246 R12: 000000000056c1a8
R13: 00007ffe6347027f R14: 00007fe89aa98300 R15: 0000000000022000

Showing all locks held in the system:
2 locks held by systemd/1:
 #0: ffff8880213dd098 (&tty->ldisc_sem){++++}-{0:0}, at: tty_ldisc_ref_wait+0x21/0x70 drivers/tty/tty_ldisc.c:252
 #1: ffff8880213dd2e8 (&tty->termios_rwsem){++++}-{3:3}, at: copy_termios drivers/tty/tty_ioctl.c:449 [inline]
 #1: ffff8880213dd2e8 (&tty->termios_rwsem){++++}-{3:3}, at: tty_mode_ioctl+0x1b2/0xac0 drivers/tty/tty_ioctl.c:737
1 lock held by khungtaskd/1624:
 #0: ffffffff8c717ec0 (rcu_read_lock){....}-{1:2}, at: rcu_lock_acquire+0x0/0x30 arch/x86/pci/mmconfig_64.c:151
1 lock held by systemd-journal/4851:
1 lock held by in:imklog/8124:
6 locks held by syz-executor.1/14364:
2 locks held by syz-executor.1/14368:
 #0: ffff8880213dd098 (&tty->ldisc_sem){++++}-{0:0}, at: tty_ldisc_ref_wait+0x21/0x70 drivers/tty/tty_ldisc.c:252
 #1: ffff8880110790b8 (&buf->lock){+.+.}-{3:3}, at: paste_selection+0x155/0x500 drivers/tty/vt/selection.c:390
2 locks held by syz-executor.1/14376:
 #0: ffff8880213dd098 (&tty->ldisc_sem){++++}-{0:0}, at: tty_ldisc_ref_wait+0x21/0x70 drivers/tty/tty_ldisc.c:252
 #1: ffff8880213dd2e8 (&tty->termios_rwsem){++++}-{3:3}, at: tty_set_termios+0x11b/0x15e0 drivers/tty/tty_ioctl.c:352

=============================================

NMI backtrace for cpu 0
CPU: 0 PID: 1624 Comm: khungtaskd Not tainted 5.14.0-rc7-syzkaller #0
Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 01/01/2011
Call Trace:
 __dump_stack lib/dump_stack.c:88 [inline]
 dump_stack_lvl+0x1d3/0x29f lib/dump_stack.c:105
 nmi_cpu_backtrace+0x16c/0x190 lib/nmi_backtrace.c:105
 nmi_trigger_cpumask_backtrace+0x191/0x2f0 lib/nmi_backtrace.c:62
 trigger_all_cpu_backtrace include/linux/nmi.h:146 [inline]
 check_hung_uninterruptible_tasks kernel/hung_task.c:210 [inline]
 watchdog+0xd06/0xd50 kernel/hung_task.c:295
 kthread+0x453/0x480 kernel/kthread.c:319
 ret_from_fork+0x1f/0x30 arch/x86/entry/entry_64.S:295
Sending NMI from CPU 0 to CPUs 1:
NMI backtrace for cpu 1
CPU: 1 PID: 4851 Comm: systemd-journal Not tainted 5.14.0-rc7-syzkaller #0
Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 01/01/2011
RIP: 0010:qlist_free_all mm/kasan/quarantine.c:163 [inline]
RIP: 0010:kasan_quarantine_reduce+0x145/0x1c0 mm/kasan/quarantine.c:272
Code: 61 b3 12 08 48 89 ef e8 f9 e4 6f ff 48 c1 e8 06 48 83 e0 c0 49 8b 4c 07 08 89 ca 83 e2 01 48 85 d2 75 1d 4c 01 f8 48 8b 70 18 <48> 8b 5d 00 48 89 ef e8 ef 03 00 00 48 89 dd 48 85 db 75 c6 eb 31
RSP: 0018:ffffc9000153fa28 EFLAGS: 00000286
RAX: ffffea0001c2ae00 RBX: ffff888070abc000 RCX: ffffea0001c2ae00
RDX: 0000000000000001 RSI: ffff888011042140 RDI: 0000000000000000
RBP: ffff888070abc000 R08: ffffffff81397427 R09: ffffffff81c992c5
R10: fffffbfff18fd93b R11: 0000000000000000 R12: 0000000000000001
R13: ffff888038f69100 R14: 0000000000000001 R15: ffffea0000000000
FS:  00007f3adaea18c0(0000) GS:ffff8880b9d00000(0000) knlGS:0000000000000000
CS:  0010 DS: 0000 ES: 0000 CR0: 0000000080050033
CR2: 000000c028859000 CR3: 000000002d77c000 CR4: 00000000001506e0
DR0: 0000000000000000 DR1: 0000000000000000 DR2: 0000000000000000
DR3: 0000000000000000 DR6: 00000000fffe0ff0 DR7: 0000000000000400
Call Trace:
 __kasan_slab_alloc+0x2f/0xd0 mm/kasan/common.c:444
 kasan_slab_alloc include/linux/kasan.h:254 [inline]
 slab_post_alloc_hook mm/slab.h:519 [inline]
 slab_alloc_node mm/slub.c:2959 [inline]
 slab_alloc mm/slub.c:2967 [inline]
 kmem_cache_alloc+0x1d1/0x340 mm/slub.c:2972
 getname_flags+0xba/0x640 fs/namei.c:138
 do_sys_openat2+0xba/0x460 fs/open.c:1198
 do_sys_open fs/open.c:1220 [inline]
 __do_sys_open fs/open.c:1228 [inline]
 __se_sys_open fs/open.c:1224 [inline]
 __x64_sys_open+0x221/0x270 fs/open.c:1224
 do_syscall_x64 arch/x86/entry/common.c:50 [inline]
 do_syscall_64+0x3d/0xb0 arch/x86/entry/common.c:80
 entry_SYSCALL_64_after_hwframe+0x44/0xae
RIP: 0033:0x7f3ada430840
Code: 73 01 c3 48 8b 0d 68 77 20 00 f7 d8 64 89 01 48 83 c8 ff c3 66 0f 1f 44 00 00 83 3d 89 bb 20 00 00 75 10 b8 02 00 00 00 0f 05 <48> 3d 01 f0 ff ff 73 31 c3 48 83 ec 08 e8 1e f6 ff ff 48 89 04 24
RSP: 002b:00007ffc5ff244b8 EFLAGS: 00000246 ORIG_RAX: 0000000000000002
RAX: ffffffffffffffda RBX: 00007ffc5ff247c0 RCX: 00007f3ada430840
RDX: 00000000000001a0 RSI: 0000000000080042 RDI: 000055a20c3b5e30
RBP: 000000000000000d R08: 000000000000ffc0 R09: 00000000ffffffff
R10: 0000000000000069 R11: 0000000000000246 R12: 00000000ffffffff
R13: 000055a20c3ab040 R14: 00007ffc5ff24780 R15: 000055a20c3b5f30
----------------
Code disassembly (best guess), 1 bytes skipped:
   0:	b3 12                	mov    $0x12,%bl
   2:	08 48 89             	or     %cl,-0x77(%rax)
   5:	ef                   	out    %eax,(%dx)
   6:	e8 f9 e4 6f ff       	callq  0xff6fe504
   b:	48 c1 e8 06          	shr    $0x6,%rax
   f:	48 83 e0 c0          	and    $0xffffffffffffffc0,%rax
  13:	49 8b 4c 07 08       	mov    0x8(%r15,%rax,1),%rcx
  18:	89 ca                	mov    %ecx,%edx
  1a:	83 e2 01             	and    $0x1,%edx
  1d:	48 85 d2             	test   %rdx,%rdx
  20:	75 1d                	jne    0x3f
  22:	4c 01 f8             	add    %r15,%rax
  25:	48 8b 70 18          	mov    0x18(%rax),%rsi
* 29:	48 8b 5d 00          	mov    0x0(%rbp),%rbx <-- trapping instruction
  2d:	48 89 ef             	mov    %rbp,%rdi
  30:	e8 ef 03 00 00       	callq  0x424
  35:	48 89 dd             	mov    %rbx,%rbp
  38:	48 85 db             	test   %rbx,%rbx
  3b:	75 c6                	jne    0x3
  3d:	eb 31                	jmp    0x70

Crashes (1):
Time Kernel Commit Syzkaller Config Log Report Syz repro C repro VM info Assets (help?) Manager Title
2021/08/27 22:17 upstream 77dd11439b86 d5a29e53 .config console log report info ci-upstream-kasan-gce-smack-root INFO: task hung in tty_mode_ioctl
* Struck through repros no longer work on HEAD.