BUG: MAX_LOCKDEP_CHAINS too low! turning off the locking correctness validator. CPU: 1 PID: 30127 Comm: syz-executor.1 Not tainted 4.19.211-syzkaller #0 Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 03/02/2023 Call Trace: __dump_stack lib/dump_stack.c:77 [inline] dump_stack+0x1fc/0x2ef lib/dump_stack.c:118 add_chain_cache kernel/locking/lockdep.c:2259 [inline] lookup_chain_cache_add kernel/locking/lockdep.c:2371 [inline] validate_chain kernel/locking/lockdep.c:2391 [inline] __lock_acquire.cold+0x420/0x57e kernel/locking/lockdep.c:3416 lock_acquire+0x170/0x3c0 kernel/locking/lockdep.c:3908 __raw_spin_lock include/linux/spinlock_api_smp.h:142 [inline] _raw_spin_lock+0x2a/0x40 kernel/locking/spinlock.c:144 lockref_get+0x11/0x50 include/linux/spinlock.h:329 dget include/linux/dcache.h:322 [inline] __rpc_unlink net/sunrpc/rpc_pipe.c:616 [inline] __rpc_depopulate.constprop.0+0x1d6/0x270 net/sunrpc/rpc_pipe.c:672 rpc_depopulate net/sunrpc/rpc_pipe.c:689 [inline] rpc_clntdir_depopulate net/sunrpc/rpc_pipe.c:1035 [inline] rpc_rmdir_depopulate net/sunrpc/rpc_pipe.c:777 [inline] rpc_remove_client_dir+0x179/0x220 net/sunrpc/rpc_pipe.c:1076 __rpc_clnt_remove_pipedir net/sunrpc/clnt.c:105 [inline] rpc_clnt_remove_pipedir net/sunrpc/clnt.c:115 [inline] rpc_free_client+0x6c/0x190 net/sunrpc/clnt.c:880 rpc_free_auth net/sunrpc/clnt.c:910 [inline] rpc_release_client+0x115/0x180 net/sunrpc/clnt.c:927 rpc_shutdown_client+0xef/0x1e0 net/sunrpc/clnt.c:862 rpc_create_xprt+0x336/0x3c0 net/sunrpc/clnt.c:481 rpc_create+0x31e/0x540 net/sunrpc/clnt.c:587 nfs_create_rpc_client+0x36f/0x440 fs/nfs/client.c:529 nfs_init_client fs/nfs/client.c:640 [inline] nfs_init_client+0x6d/0x100 fs/nfs/client.c:627 nfs_get_client+0xedb/0x1310 fs/nfs/client.c:431 nfs_init_server+0x249/0xe10 fs/nfs/client.c:676 nfs_create_server+0x7a/0x4f0 fs/nfs/client.c:960 nfs_try_mount+0x141/0x880 fs/nfs/super.c:1884 nfs_fs_mount+0x171f/0x2e90 fs/nfs/super.c:2701 mount_fs+0xa3/0x310 fs/super.c:1261 vfs_kern_mount.part.0+0x68/0x470 fs/namespace.c:961 vfs_kern_mount fs/namespace.c:951 [inline] do_new_mount fs/namespace.c:2492 [inline] do_mount+0x115c/0x2f50 fs/namespace.c:2822 ksys_mount+0xcf/0x130 fs/namespace.c:3038 __do_sys_mount fs/namespace.c:3052 [inline] __se_sys_mount fs/namespace.c:3049 [inline] __x64_sys_mount+0xba/0x150 fs/namespace.c:3049 do_syscall_64+0xf9/0x620 arch/x86/entry/common.c:293 entry_SYSCALL_64_after_hwframe+0x49/0xbe RIP: 0033:0x7f9aa6a7e0f9 Code: 28 00 00 00 75 05 48 83 c4 28 c3 e8 f1 19 00 00 90 48 89 f8 48 89 f7 48 89 d6 48 89 ca 4d 89 c2 4d 89 c8 4c 8b 4c 24 08 0f 05 <48> 3d 01 f0 ff ff 73 01 c3 48 c7 c1 b8 ff ff ff f7 d8 64 89 01 48 RSP: 002b:00007f9aa4ff0168 EFLAGS: 00000246 ORIG_RAX: 00000000000000a5 RAX: ffffffffffffffda RBX: 00007f9aa6b9df80 RCX: 00007f9aa6a7e0f9 RDX: 0000000020000200 RSI: 0000000020000080 RDI: 0000000000000000 RBP: 00007f9aa6ad9ae9 R08: 0000000020000000 R09: 0000000000000000 R10: 0000000000000000 R11: 0000000000000246 R12: 0000000000000000 R13: 00007ffd2ab42def R14: 00007f9aa4ff0300 R15: 0000000000022000 netlink: 64 bytes leftover after parsing attributes in process `syz-executor.2'. audit: type=1804 audit(1678050464.679:2074): pid=30148 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=invalid_pcr cause=open_writers comm="syz-executor.4" name="/root/syzkaller-testdir3830793523/syzkaller.vpmCtB/1627/bus" dev="sda1" ino=16912 res=1 audit: type=1804 audit(1678050464.709:2075): pid=30151 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=invalid_pcr cause=ToMToU comm="syz-executor.4" name="/root/syzkaller-testdir3830793523/syzkaller.vpmCtB/1627/bus" dev="sda1" ino=16912 res=1 audit: type=1804 audit(1678050465.149:2076): pid=30127 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=invalid_pcr cause=open_writers comm="syz-executor.1" name="/root/syzkaller-testdir1770564298/syzkaller.OOgURA/1941/bus" dev="sda1" ino=14693 res=1 audit: type=1804 audit(1678050465.779:2077): pid=30185 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=invalid_pcr cause=open_writers comm="syz-executor.4" name="/root/syzkaller-testdir3830793523/syzkaller.vpmCtB/1628/bus" dev="sda1" ino=14952 res=1 IPVS: ftp: loaded support on port[0] = 21 netlink: 'syz-executor.3': attribute type 4 has an invalid length. Can't find ip_set type IPVS: ftp: loaded support on port[0] = 21 IPVS: ftp: loaded support on port[0] = 21 IPVS: ftp: loaded support on port[0] = 21 IPVS: ftp: loaded support on port[0] = 21 kauditd_printk_skb: 1 callbacks suppressed audit: type=1804 audit(1678050470.230:2079): pid=30414 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=invalid_pcr cause=open_writers comm="syz-executor.0" name="/root/syzkaller-testdir214402427/syzkaller.Ryc7Qn/1207/bus" dev="sda1" ino=16973 res=1 IPVS: ftp: loaded support on port[0] = 21 netlink: 'syz-executor.4': attribute type 4 has an invalid length. audit: type=1804 audit(1678050470.230:2080): pid=30414 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=invalid_pcr cause=ToMToU comm="syz-executor.0" name="/root/syzkaller-testdir214402427/syzkaller.Ryc7Qn/1207/bus" dev="sda1" ino=16973 res=1 audit: type=1804 audit(1678050470.470:2081): pid=30428 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=invalid_pcr cause=open_writers comm="syz-executor.0" name="/root/syzkaller-testdir214402427/syzkaller.Ryc7Qn/1208/bus" dev="sda1" ino=16938 res=1 ieee80211 ©,í…×: Selected rate control algorithm 'minstrel_ht' ieee80211 phy72: Selected rate control algorithm 'minstrel_ht' audit: type=1804 audit(1678050470.470:2082): pid=30436 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=invalid_pcr cause=ToMToU comm="syz-executor.0" name="/root/syzkaller-testdir214402427/syzkaller.Ryc7Qn/1208/bus" dev="sda1" ino=16938 res=1 audit: type=1804 audit(1678050470.760:2083): pid=30470 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=invalid_pcr cause=open_writers comm="syz-executor.0" name="/root/syzkaller-testdir214402427/syzkaller.Ryc7Qn/1209/bus" dev="sda1" ino=16970 res=1 audit: type=1804 audit(1678050470.790:2084): pid=30470 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=invalid_pcr cause=ToMToU comm="syz-executor.0" name="/root/syzkaller-testdir214402427/syzkaller.Ryc7Qn/1209/bus" dev="sda1" ino=16970 res=1 ieee80211 phy73: Selected rate control algorithm 'minstrel_ht' netlink: 'syz-executor.4': attribute type 4 has an invalid length. IPVS: ftp: loaded support on port[0] = 21 ieee80211 phy74: Selected rate control algorithm 'minstrel_ht' ieee80211 phy75: Selected rate control algorithm 'minstrel_ht' ieee80211 phy76: Selected rate control algorithm 'minstrel_ht' IPVS: ftp: loaded support on port[0] = 21 netlink: 'syz-executor.4': attribute type 4 has an invalid length. 9pnet_virtio: no channels available for device 127.0.0.1 9pnet_virtio: no channels available for device 127.0.0.1 audit: type=1800 audit(1678050474.481:2085): pid=30737 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=collect_data cause=failed(directio) comm="syz-executor.1" name="file0" dev="sda1" ino=16988 res=0 audit: type=1804 audit(1678050474.501:2086): pid=30737 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=invalid_pcr cause=open_writers comm="syz-executor.1" name="/root/syzkaller-testdir1770564298/syzkaller.OOgURA/1954/file0" dev="sda1" ino=16988 res=1 9pnet_virtio: no channels available for device 127.0.0.1 IPVS: ftp: loaded support on port[0] = 21 audit: type=1800 audit(1678050475.241:2087): pid=30759 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=collect_data cause=failed(directio) comm="syz-executor.1" name="file0" dev="sda1" ino=16987 res=0 audit: type=1804 audit(1678050475.261:2088): pid=30759 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=invalid_pcr cause=open_writers comm="syz-executor.1" name="/root/syzkaller-testdir1770564298/syzkaller.OOgURA/1955/file0" dev="sda1" ino=16987 res=1 audit: type=1804 audit(1678050475.261:2089): pid=30759 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=invalid_pcr cause=open_writers comm="syz-executor.1" name="/root/syzkaller-testdir1770564298/syzkaller.OOgURA/1955/file0" dev="sda1" ino=16987 res=1 audit: type=1804 audit(1678050476.001:2090): pid=30840 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=invalid_pcr cause=open_writers comm="syz-executor.3" name="/root/syzkaller-testdir2134411593/syzkaller.9kh5oe/133/bus" dev="sda1" ino=17046 res=1 audit: type=1804 audit(1678050476.031:2091): pid=30836 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=invalid_pcr cause=open_writers comm="syz-executor.3" name="/root/syzkaller-testdir2134411593/syzkaller.9kh5oe/133/bus" dev="sda1" ino=17046 res=1 audit: type=1804 audit(1678050476.081:2092): pid=30836 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=invalid_pcr cause=ToMToU comm="syz-executor.3" name="/root/syzkaller-testdir2134411593/syzkaller.9kh5oe/133/bus" dev="sda1" ino=17046 res=1 audit: type=1804 audit(1678050476.091:2093): pid=30836 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=invalid_pcr cause=ToMToU comm="syz-executor.3" name="/root/syzkaller-testdir2134411593/syzkaller.9kh5oe/133/bus" dev="sda1" ino=17046 res=1 IPVS: ftp: loaded support on port[0] = 21 audit: type=1800 audit(1678050476.991:2094): pid=30881 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=collect_data cause=failed(directio) comm="syz-executor.1" name="file0" dev="sda1" ino=17056 res=0 audit: type=1804 audit(1678050477.031:2095): pid=30910 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=invalid_pcr cause=open_writers comm="syz-executor.3" name="/root/syzkaller-testdir2134411593/syzkaller.9kh5oe/134/bus" dev="sda1" ino=14999 res=1 audit: type=1804 audit(1678050477.031:2096): pid=30909 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=invalid_pcr cause=open_writers comm="syz-executor.3" name="/root/syzkaller-testdir2134411593/syzkaller.9kh5oe/134/bus" dev="sda1" ino=14999 res=1 IPVS: ftp: loaded support on port[0] = 21 IPVS: ftp: loaded support on port[0] = 21 IPVS: ftp: loaded support on port[0] = 21 IPVS: ftp: loaded support on port[0] = 21 IPVS: ftp: loaded support on port[0] = 21 IPVS: ftp: loaded support on port[0] = 21 IPVS: ftp: loaded support on port[0] = 21 relay: one or more items not logged [item size (56) > sub-buffer size (9)] relay: one or more items not logged [item size (56) > sub-buffer size (9)] relay: one or more items not logged [item size (56) > sub-buffer size (9)] blktrace: Concurrent blktraces are not allowed on loop6 relay: one or more items not logged [item size (56) > sub-buffer size (9)] kauditd_printk_skb: 7 callbacks suppressed audit: type=1800 audit(1678050480.272:2104): pid=31280 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=collect_data cause=failed(directio) comm="syz-executor.4" name="file0" dev="sda1" ino=17063 res=0 audit: type=1804 audit(1678050480.312:2105): pid=31280 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=invalid_pcr cause=open_writers comm="syz-executor.4" name="/root/syzkaller-testdir3830793523/syzkaller.vpmCtB/1650/file0" dev="sda1" ino=17063 res=1 blktrace: Concurrent blktraces are not allowed on loop6 relay: one or more items not logged [item size (56) > sub-buffer size (9)] relay: one or more items not logged [item size (56) > sub-buffer size (9)] relay: one or more items not logged [item size (56) > sub-buffer size (9)] relay: one or more items not logged [item size (56) > sub-buffer size (9)] blktrace: Concurrent blktraces are not allowed on loop6 relay: one or more items not logged [item size (56) > sub-buffer size (9)] audit: type=1800 audit(1678050481.382:2106): pid=31327 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=collect_data cause=failed(directio) comm="syz-executor.4" name="file0" dev="sda1" ino=14999 res=0 audit: type=1804 audit(1678050481.382:2107): pid=31327 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=invalid_pcr cause=open_writers comm="syz-executor.4" name="/root/syzkaller-testdir3830793523/syzkaller.vpmCtB/1651/file0" dev="sda1" ino=14999 res=1 blktrace: Concurrent blktraces are not allowed on loop6 blktrace: Concurrent blktraces are not allowed on loop6 relay: one or more items not logged [item size (56) > sub-buffer size (9)] audit: type=1800 audit(1678050481.972:2108): pid=31372 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=collect_data cause=failed(directio) comm="syz-executor.4" name="file0" dev="sda1" ino=17118 res=0 blktrace: Concurrent blktraces are not allowed on loop6 relay: one or more items not logged [item size (56) > sub-buffer size (9)] audit: type=1804 audit(1678050482.182:2109): pid=31372 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=invalid_pcr cause=open_writers comm="syz-executor.4" name="/root/syzkaller-testdir3830793523/syzkaller.vpmCtB/1652/file0" dev="sda1" ino=17118 res=1 blktrace: Concurrent blktraces are not allowed on loop6 audit: type=1800 audit(1678050482.532:2110): pid=31413 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=collect_data cause=failed(directio) comm="syz-executor.4" name="file0" dev="sda1" ino=17124 res=0 blktrace: Concurrent blktraces are not allowed on loop6 audit: type=1804 audit(1678050482.532:2111): pid=31413 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=invalid_pcr cause=open_writers comm="syz-executor.4" name="/root/syzkaller-testdir3830793523/syzkaller.vpmCtB/1653/file0" dev="sda1" ino=17124 res=1 blktrace: Concurrent blktraces are not allowed on loop6 blktrace: Concurrent blktraces are not allowed on loop6 blktrace: Concurrent blktraces are not allowed on loop6 blktrace: Concurrent blktraces are not allowed on loop6 blktrace: Concurrent blktraces are not allowed on loop6 blktrace: Concurrent blktraces are not allowed on loop6 blktrace: Concurrent blktraces are not allowed on loop6 relay: one or more items not logged [item size (56) > sub-buffer size (9)] audit: type=1800 audit(1678050483.563:2112): pid=31449 uid=0 auid=4294967295 ses=4294967295 subj==unconfined op=collect_data cause=failed(directio) comm="syz-executor.4" name="file0" dev="sda1" ino=17108 res=0 blktrace: Concurrent blktraces are not allowed on loop6 blktrace: Concurrent blktraces are not allowed on loop6 relay: one or more items not logged [item size (56) > sub-buffer size (9)]