syzbot


WARNING: bad unlock balance in ocfs2_inode_cache_io_unlock

Status: upstream: reported C repro on 2024/09/20 17:22
Subsystems: ocfs2
[Documentation on labels]
Reported-by: syzbot+0e4e71041c9609d922a2@syzkaller.appspotmail.com
First crash: 65d, last: 49d
Discussions (1)
Title Replies (including bot) Last reply
[syzbot] [ocfs2?] WARNING: bad unlock balance in ocfs2_inode_cache_io_unlock 1 (3) 2024/09/21 02:28
Similar bugs (2)
Kernel Title Repro Cause bisect Fix bisect Count Last Reported Patched Status
linux-5.15 WARNING: bad unlock balance in ocfs2_inode_cache_io_unlock origin:upstream C error 14 42d 66d 0/3 upstream: reported C repro on 2024/09/15 22:26
linux-6.1 WARNING: bad unlock balance in ocfs2_inode_cache_io_unlock origin:lts-only C inconclusive 7 59d 65d 0/3 upstream: reported C repro on 2024/09/17 02:11
Last patch testing requests (2)
Created Duration User Patch Repo Result
2024/10/16 21:00 2h38m retest repro git://git.kernel.org/pub/scm/linux/kernel/git/arm64/linux.git for-kernelci OK log
2024/09/21 01:54 24m eadavis@qq.com patch git://git.kernel.org/pub/scm/linux/kernel/git/arm64/linux.git for-kernelci OK log

Sample crash report:
(syz-executor,6675,0):ocfs2_read_blocks:240 ERROR: status = -12
=====================================
WARNING: bad unlock balance detected!
6.11.0-rc7-syzkaller-g5f5673607153 #0 Not tainted
-------------------------------------
syz-executor/6675 is trying to release lock (&oi->ip_io_mutex) at:
[<ffff80008201e0dc>] ocfs2_inode_cache_io_unlock+0x20/0x30 fs/ocfs2/inode.c:1650
but there are no more locks to release!

other info that might help us debug this:
2 locks held by syz-executor/6675:
 #0: ffff0000d3faa0e0 (&type->s_umount_key#62){+.+.}-{3:3}, at: __super_lock fs/super.c:56 [inline]
 #0: ffff0000d3faa0e0 (&type->s_umount_key#62){+.+.}-{3:3}, at: __super_lock_excl fs/super.c:71 [inline]
 #0: ffff0000d3faa0e0 (&type->s_umount_key#62){+.+.}-{3:3}, at: deactivate_super+0xd8/0x100 fs/super.c:505
 #1: ffff0000ee71d100 (&ocfs2_sysfile_lock_key[args->fi_sysfile_type]#2){+.+.}-{3:3}, at: inode_lock include/linux/fs.h:800 [inline]
 #1: ffff0000ee71d100 (&ocfs2_sysfile_lock_key[args->fi_sysfile_type]#2){+.+.}-{3:3}, at: ocfs2_shutdown_local_alloc+0x194/0x8d8 fs/ocfs2/localalloc.c:408

stack backtrace:
CPU: 0 UID: 0 PID: 6675 Comm: syz-executor Not tainted 6.11.0-rc7-syzkaller-g5f5673607153 #0
Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 08/06/2024
Call trace:
 dump_backtrace+0x1b8/0x1e4 arch/arm64/kernel/stacktrace.c:319
 show_stack+0x2c/0x3c arch/arm64/kernel/stacktrace.c:326
 __dump_stack lib/dump_stack.c:93 [inline]
 dump_stack_lvl+0xe4/0x150 lib/dump_stack.c:119
 dump_stack+0x1c/0x28 lib/dump_stack.c:128
 print_unlock_imbalance_bug+0x250/0x2a4 kernel/locking/lockdep.c:5199
 __lock_release kernel/locking/lockdep.c:5436 [inline]
 lock_release+0x4ec/0x9e8 kernel/locking/lockdep.c:5780
 __mutex_unlock_slowpath+0xe0/0x6b4 kernel/locking/mutex.c:912
 mutex_unlock+0x18/0x24 kernel/locking/mutex.c:548
 ocfs2_inode_cache_io_unlock+0x20/0x30 fs/ocfs2/inode.c:1650
 ocfs2_metadata_cache_io_unlock+0x6c/0x90 fs/ocfs2/uptodate.c:95
 ocfs2_read_blocks+0x1164/0x1638 fs/ocfs2/buffer_head_io.c:394
 ocfs2_read_inode_block_full fs/ocfs2/inode.c:1593 [inline]
 ocfs2_read_inode_block+0xf0/0x1a8 fs/ocfs2/inode.c:1605
 ocfs2_assign_bh fs/ocfs2/dlmglue.c:2414 [inline]
 ocfs2_inode_lock_full_nested+0x270/0x1768 fs/ocfs2/dlmglue.c:2509
 ocfs2_shutdown_local_alloc+0x1b0/0x8d8 fs/ocfs2/localalloc.c:410
 ocfs2_dismount_volume+0x1ec/0x920 fs/ocfs2/super.c:1879
 ocfs2_put_super+0xec/0x368 fs/ocfs2/super.c:1610
 generic_shutdown_super+0x128/0x2b8 fs/super.c:642
 kill_block_super+0x44/0x90 fs/super.c:1696
 deactivate_locked_super+0xc4/0x12c fs/super.c:473
 deactivate_super+0xe0/0x100 fs/super.c:506
 cleanup_mnt+0x34c/0x3dc fs/namespace.c:1373
 __cleanup_mnt+0x20/0x30 fs/namespace.c:1380
 task_work_run+0x230/0x2e0 kernel/task_work.c:228
 resume_user_mode_work include/linux/resume_user_mode.h:50 [inline]
 do_notify_resume+0x178/0x1f4 arch/arm64/kernel/entry-common.c:151
 exit_to_user_mode_prepare arch/arm64/kernel/entry-common.c:169 [inline]
 exit_to_user_mode arch/arm64/kernel/entry-common.c:178 [inline]
 el0_svc+0xac/0x168 arch/arm64/kernel/entry-common.c:713
 el0t_64_sync_handler+0x84/0xfc arch/arm64/kernel/entry-common.c:730
 el0t_64_sync+0x190/0x194 arch/arm64/kernel/entry.S:598
(syz-executor,6675,1):ocfs2_assign_bh:2416 ERROR: status = -12
(syz-executor,6675,1):ocfs2_inode_lock_full_nested:2511 ERROR: status = -12
(syz-executor,6675,1):ocfs2_shutdown_local_alloc:412 ERROR: status = -12
syz-executor: attempt to access beyond end of device
loop0: rw=1, sector=17024, nr_sectors = 1 limit=3
Buffer I/O error on dev loop0, logical block 17024, lost sync page write
(syz-executor,6675,1):ocfs2_write_block:78 ERROR: status = -5
(syz-executor,6675,1):ocfs2_update_disk_slot:199 ERROR: status = -5
(syz-executor,6675,1):ocfs2_put_slot:517 ERROR: status = -5
Aborting journal on device loop0-75.
syz-executor: attempt to access beyond end of device
loop0: rw=169985, sector=640, nr_sectors = 1 limit=3
Buffer I/O error on dev loop0, logical block 640, lost sync page write
JBD2: I/O error when updating journal superblock for loop0-75.
ocfs2: Unmounting device (7,0) on (node local)

Crashes (7):
Time Kernel Commit Syzkaller Config Log Report Syz repro C repro VM info Assets (help?) Manager Title
2024/10/02 14:45 git://git.kernel.org/pub/scm/linux/kernel/git/arm64/linux.git for-kernelci 5f5673607153 a4c7fd36 .config console log report info [disk image] [vmlinux] [kernel image] ci-upstream-gce-arm64 WARNING: bad unlock balance in ocfs2_inode_cache_io_unlock
2024/09/20 07:20 git://git.kernel.org/pub/scm/linux/kernel/git/arm64/linux.git for-kernelci 5f5673607153 6f888b75 .config console log report info [disk image] [vmlinux] [kernel image] ci-upstream-gce-arm64 WARNING: bad unlock balance in ocfs2_inode_cache_io_unlock
2024/09/19 12:46 git://git.kernel.org/pub/scm/linux/kernel/git/arm64/linux.git for-kernelci 5f5673607153 c673ca06 .config console log report info [disk image] [vmlinux] [kernel image] ci-upstream-gce-arm64 WARNING: bad unlock balance in ocfs2_inode_cache_io_unlock
2024/09/17 07:09 git://git.kernel.org/pub/scm/linux/kernel/git/arm64/linux.git for-kernelci 5f5673607153 c673ca06 .config console log report syz / log C [disk image] [vmlinux] [kernel image] [mounted in repro] ci-upstream-gce-arm64 WARNING: bad unlock balance in ocfs2_inode_cache_io_unlock
2024/09/17 05:25 git://git.kernel.org/pub/scm/linux/kernel/git/arm64/linux.git for-kernelci 5f5673607153 c673ca06 .config console log report info [disk image] [vmlinux] [kernel image] ci-upstream-gce-arm64 WARNING: bad unlock balance in ocfs2_inode_cache_io_unlock
2024/09/17 05:24 git://git.kernel.org/pub/scm/linux/kernel/git/arm64/linux.git for-kernelci 5f5673607153 c673ca06 .config console log report info [disk image] [vmlinux] [kernel image] ci-upstream-gce-arm64 WARNING: bad unlock balance in ocfs2_inode_cache_io_unlock
2024/09/16 17:20 git://git.kernel.org/pub/scm/linux/kernel/git/arm64/linux.git for-kernelci 5f5673607153 49cf0773 .config console log report info [disk image] [vmlinux] [kernel image] ci-upstream-gce-arm64 WARNING: bad unlock balance in ocfs2_inode_cache_io_unlock
* Struck through repros no longer work on HEAD.