============================================ WARNING: possible recursive locking detected 4.14.305-syzkaller #0 Not tainted -------------------------------------------- syz-executor.1/12276 is trying to acquire lock: (&HFSPLUS_I(inode)->extents_lock){+.+.}, at: [] hfsplus_get_block+0x1f9/0x820 fs/hfsplus/extents.c:260 but task is already holding lock: (&HFSPLUS_I(inode)->extents_lock){+.+.}, at: [] hfsplus_file_extend+0x188/0xef0 fs/hfsplus/extents.c:452 other info that might help us debug this: Possible unsafe locking scenario: CPU0 ---- lock(&HFSPLUS_I(inode)->extents_lock); lock(&HFSPLUS_I(inode)->extents_lock); *** DEADLOCK *** May be due to missing lock nesting notation 5 locks held by syz-executor.1/12276: #0: (&type->s_umount_key#83/1){+.+.}, at: [] alloc_super fs/super.c:251 [inline] #0: (&type->s_umount_key#83/1){+.+.}, at: [] sget_userns+0x556/0xc10 fs/super.c:516 #1: (&sbi->vh_mutex){+.+.}, at: [] hfsplus_fill_super+0x1314/0x1850 fs/hfsplus/super.c:553 #2: (&tree->tree_lock){+.+.}, at: [] hfsplus_find_init+0x1a8/0x220 fs/hfsplus/bfind.c:30 #3: (&HFSPLUS_I(inode)->extents_lock){+.+.}, at: [] hfsplus_file_extend+0x188/0xef0 fs/hfsplus/extents.c:452 #4: (&sbi->alloc_mutex){+.+.}, at: [] hfsplus_block_allocate+0xd2/0x910 fs/hfsplus/bitmap.c:35 stack backtrace: CPU: 1 PID: 12276 Comm: syz-executor.1 Not tainted 4.14.305-syzkaller #0 Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 01/21/2023 Call Trace: __dump_stack lib/dump_stack.c:17 [inline] dump_stack+0x1b2/0x281 lib/dump_stack.c:58 print_deadlock_bug kernel/locking/lockdep.c:1800 [inline] check_deadlock kernel/locking/lockdep.c:1847 [inline] validate_chain kernel/locking/lockdep.c:2448 [inline] __lock_acquire.cold+0x180/0x97c kernel/locking/lockdep.c:3491 lock_acquire+0x170/0x3f0 kernel/locking/lockdep.c:3998 __mutex_lock_common kernel/locking/mutex.c:756 [inline] __mutex_lock+0xc4/0x1310 kernel/locking/mutex.c:893 hfsplus_get_block+0x1f9/0x820 fs/hfsplus/extents.c:260 block_read_full_page+0x25e/0x8d0 fs/buffer.c:2316 do_read_cache_page+0x38e/0xc10 mm/filemap.c:2713 read_mapping_page include/linux/pagemap.h:398 [inline] hfsplus_block_allocate+0x189/0x910 fs/hfsplus/bitmap.c:37 hfsplus_file_extend+0x421/0xef0 fs/hfsplus/extents.c:463 hfsplus_bmap_reserve+0x26e/0x410 fs/hfsplus/btree.c:357 hfsplus_create_cat+0x1af/0x10d0 fs/hfsplus/catalog.c:272 hfsplus_fill_super+0x1386/0x1850 fs/hfsplus/super.c:560 mount_bdev+0x2b3/0x360 fs/super.c:1134 mount_fs+0x92/0x2a0 fs/super.c:1237 vfs_kern_mount.part.0+0x5b/0x470 fs/namespace.c:1046 vfs_kern_mount fs/namespace.c:1036 [inline] do_new_mount fs/namespace.c:2572 [inline] do_mount+0xe65/0x2a30 fs/namespace.c:2905 SYSC_mount fs/namespace.c:3121 [inline] SyS_mount+0xa8/0x120 fs/namespace.c:3098 do_syscall_64+0x1d5/0x640 arch/x86/entry/common.c:292 entry_SYSCALL_64_after_hwframe+0x5e/0xd3 RIP: 0033:0x7f43afad962a RSP: 002b:00007f43ae049f88 EFLAGS: 00000202 ORIG_RAX: 00000000000000a5 RAX: ffffffffffffffda RBX: 000000000000061b RCX: 00007f43afad962a RDX: 0000000020000600 RSI: 00000000200001c0 RDI: 00007f43ae049fe0 RBP: 00007f43ae04a020 R08: 00007f43ae04a020 R09: 0000000001a00010 R10: 0000000001a00010 R11: 0000000000000202 R12: 0000000020000600 R13: 00000000200001c0 R14: 00007f43ae049fe0 R15: 0000000020000140 print_req_error: I/O error, dev loop1, sector 0 print_req_error: I/O error, dev loop2, sector 0 unregister_netdevice: waiting for ip6gre0 to become free. Usage count = -1 audit: type=1804 audit(1676677557.776:12): pid=12313 uid=0 auid=4294967295 ses=4294967295 op="invalid_pcr" cause="open_writers" comm="syz-executor.1" name="/root/syzkaller-testdir1347947658/syzkaller.Vo5h7k/83/bus" dev="sda1" ino=14193 res=1 audit: type=1800 audit(1676677557.776:13): pid=12313 uid=0 auid=4294967295 ses=4294967295 op="collect_data" cause="failed(directio)" comm="syz-executor.1" name="bus" dev="sda1" ino=14193 res=0 audit: type=1804 audit(1676677558.136:14): pid=12304 uid=0 auid=4294967295 ses=4294967295 op="invalid_pcr" cause="open_writers" comm="syz-executor.2" name="/root/syzkaller-testdir1214026766/syzkaller.vXgDou/75/bus/bus" dev="loop2" ino=8 res=1 audit: type=1804 audit(1676677558.502:15): pid=12352 uid=0 auid=4294967295 ses=4294967295 op="invalid_pcr" cause="open_writers" comm="syz-executor.2" name="/root/syzkaller-testdir1214026766/syzkaller.vXgDou/76/bus/bus" dev="loop2" ino=8 res=1 audit: type=1804 audit(1676677558.702:16): pid=12366 uid=0 auid=4294967295 ses=4294967295 op="invalid_pcr" cause="open_writers" comm="syz-executor.1" name="/root/syzkaller-testdir1347947658/syzkaller.Vo5h7k/84/bus" dev="sda1" ino=14242 res=1 audit: type=1800 audit(1676677558.702:17): pid=12366 uid=0 auid=4294967295 ses=4294967295 op="collect_data" cause="failed(directio)" comm="syz-executor.1" name="bus" dev="sda1" ino=14242 res=0 audit: type=1804 audit(1676677559.152:18): pid=12377 uid=0 auid=4294967295 ses=4294967295 op="invalid_pcr" cause="open_writers" comm="syz-executor.0" name="/root/syzkaller-testdir622312521/syzkaller.PHijlL/73/bus" dev="sda1" ino=14247 res=1 audit: type=1800 audit(1676677559.152:19): pid=12377 uid=0 auid=4294967295 ses=4294967295 op="collect_data" cause="failed(directio)" comm="syz-executor.0" name="bus" dev="sda1" ino=14247 res=0 audit: type=1804 audit(1676677559.442:20): pid=12372 uid=0 auid=4294967295 ses=4294967295 op="invalid_pcr" cause="open_writers" comm="syz-executor.3" name="/root/syzkaller-testdir2756640642/syzkaller.SPwnZy/87/bus/bus" dev="loop3" ino=8 res=1 audit: type=1804 audit(1676677559.972:21): pid=12394 uid=0 auid=4294967295 ses=4294967295 op="invalid_pcr" cause="open_writers" comm="syz-executor.0" name="/root/syzkaller-testdir622312521/syzkaller.PHijlL/74/bus" dev="sda1" ino=13876 res=1 __ntfs_error: 17 callbacks suppressed ntfs: (device loop2): ntfs_read_locked_inode(): Inode is not in use! ntfs: (device loop2): ntfs_read_locked_inode(): Failed with error code -5. Marking corrupt inode 0x1 as bad. Run chkdsk. ntfs: (device loop2): load_system_files(): Failed to load $MFTMirr. Mounting read-only. Run ntfsfix and/or chkdsk. sp0: Synchronizing with TNC ntfs: volume version 3.1. sp0: Synchronizing with TNC sp0: Synchronizing with TNC sp0: Synchronizing with TNC MINIX-fs: mounting unchecked file system, running fsck is recommended attempt to access beyond end of device loop4: rw=0, want=3740, limit=256 Buffer I/O error on dev loop4, logical block 1869, async page read attempt to access beyond end of device loop4: rw=0, want=3740, limit=256 Buffer I/O error on dev loop4, logical block 1869, async page read audit: type=1800 audit(1676677564.952:39): pid=12679 uid=0 auid=4294967295 ses=4294967295 op="collect_data" cause="failed" comm="syz-executor.4" name="file2" dev="loop4" ino=6 res=0 BTRFS info (device loop2): enabling inode map caching MINIX-fs: mounting unchecked file system, running fsck is recommended BTRFS info (device loop2): force clearing of disk cache attempt to access beyond end of device loop4: rw=0, want=3740, limit=256 BTRFS info (device loop2): disabling free space tree Buffer I/O error on dev loop4, logical block 1869, async page read BTRFS info (device loop2): has skinny extents attempt to access beyond end of device loop4: rw=0, want=3740, limit=256 Buffer I/O error on dev loop4, logical block 1869, async page read audit: type=1800 audit(1676677565.282:40): pid=12703 uid=0 auid=4294967295 ses=4294967295 op="collect_data" cause="failed" comm="syz-executor.4" name="file2" dev="loop4" ino=6 res=0 netlink: 24 bytes leftover after parsing attributes in process `syz-executor.0'. MINIX-fs: mounting unchecked file system, running fsck is recommended netlink: 24 bytes leftover after parsing attributes in process `syz-executor.1'. BTRFS info (device loop2): clearing free space tree BTRFS info (device loop2): clearing 1 ro feature flag attempt to access beyond end of device BTRFS info (device loop2): clearing 2 ro feature flag loop4: rw=0, want=3740, limit=256 Buffer I/O error on dev loop4, logical block 1869, async page read BTRFS info (device loop2): checking UUID tree attempt to access beyond end of device loop4: rw=0, want=3740, limit=256 Buffer I/O error on dev loop4, logical block 1869, async page read audit: type=1800 audit(1676677566.112:41): pid=12742 uid=0 auid=4294967295 ses=4294967295 op="collect_data" cause="failed" comm="syz-executor.4" name="file2" dev="loop4" ino=6 res=0 ntfs: volume version 3.1. netlink: 24 bytes leftover after parsing attributes in process `syz-executor.0'. MINIX-fs: mounting unchecked file system, running fsck is recommended attempt to access beyond end of device loop4: rw=0, want=3740, limit=256 Buffer I/O error on dev loop4, logical block 1869, async page read attempt to access beyond end of device loop4: rw=0, want=3740, limit=256 Buffer I/O error on dev loop4, logical block 1869, async page read