[ 82.092784][ T7] cfg80211: failed to load regulatory.db Warning: Permanently added '10.128.0.9' (ED25519) to the list of known hosts. 2024/04/08 02:46:40 parsed 1 programs 2024/04/08 02:46:40 executed programs: 0 [ 85.781288][ T5157] Bluetooth: hci0: unexpected cc 0x0c03 length: 249 > 1 [ 85.789174][ T5157] Bluetooth: hci0: unexpected cc 0x1003 length: 249 > 9 [ 85.797454][ T5157] Bluetooth: hci0: unexpected cc 0x1001 length: 249 > 9 [ 85.805463][ T5157] Bluetooth: hci0: unexpected cc 0x0c23 length: 249 > 4 [ 85.813771][ T5157] Bluetooth: hci0: unexpected cc 0x0c25 length: 249 > 3 [ 85.821708][ T5157] Bluetooth: hci0: unexpected cc 0x0c38 length: 249 > 2 [ 85.926858][ T5155] chnl_net:caif_netlink_parms(): no params data found [ 85.985166][ T5155] bridge0: port 1(bridge_slave_0) entered blocking state [ 85.993584][ T5155] bridge0: port 1(bridge_slave_0) entered disabled state [ 86.001490][ T5155] bridge_slave_0: entered allmulticast mode [ 86.008340][ T5155] bridge_slave_0: entered promiscuous mode [ 86.017324][ T5155] bridge0: port 2(bridge_slave_1) entered blocking state [ 86.024895][ T5155] bridge0: port 2(bridge_slave_1) entered disabled state [ 86.032214][ T5155] bridge_slave_1: entered allmulticast mode [ 86.039108][ T5155] bridge_slave_1: entered promiscuous mode [ 86.064852][ T5155] bond0: (slave bond_slave_0): Enslaving as an active interface with an up link [ 86.077154][ T5155] bond0: (slave bond_slave_1): Enslaving as an active interface with an up link [ 86.105412][ T5155] team0: Port device team_slave_0 added [ 86.113447][ T5155] team0: Port device team_slave_1 added [ 86.135166][ T5155] batman_adv: batadv0: Adding interface: batadv_slave_0 [ 86.142422][ T5155] batman_adv: batadv0: The MTU of interface batadv_slave_0 is too small (1500) to handle the transport of batman-adv packets. Packets going over this interface will be fragmented on layer2 which could impact the performance. Setting the MTU to 1560 would solve the problem. [ 86.168703][ T5155] batman_adv: batadv0: Not using interface batadv_slave_0 (retrying later): interface not active [ 86.182940][ T5155] batman_adv: batadv0: Adding interface: batadv_slave_1 [ 86.190171][ T5155] batman_adv: batadv0: The MTU of interface batadv_slave_1 is too small (1500) to handle the transport of batman-adv packets. Packets going over this interface will be fragmented on layer2 which could impact the performance. Setting the MTU to 1560 would solve the problem. [ 86.216467][ T5155] batman_adv: batadv0: Not using interface batadv_slave_1 (retrying later): interface not active [ 86.248259][ T5155] hsr_slave_0: entered promiscuous mode [ 86.255320][ T5155] hsr_slave_1: entered promiscuous mode [ 86.364929][ T5155] netdevsim netdevsim0 netdevsim0: renamed from eth0 [ 86.375966][ T5155] netdevsim netdevsim0 netdevsim1: renamed from eth1 [ 86.385573][ T5155] netdevsim netdevsim0 netdevsim2: renamed from eth2 [ 86.394914][ T5155] netdevsim netdevsim0 netdevsim3: renamed from eth3 [ 86.422369][ T5155] bridge0: port 2(bridge_slave_1) entered blocking state [ 86.429656][ T5155] bridge0: port 2(bridge_slave_1) entered forwarding state [ 86.438061][ T5155] bridge0: port 1(bridge_slave_0) entered blocking state [ 86.445229][ T5155] bridge0: port 1(bridge_slave_0) entered forwarding state [ 86.504804][ T5155] 8021q: adding VLAN 0 to HW filter on device bond0 [ 86.522653][ T5155] 8021q: adding VLAN 0 to HW filter on device team0 [ 86.532794][ T782] bridge0: port 1(bridge_slave_0) entered disabled state [ 86.541957][ T782] bridge0: port 2(bridge_slave_1) entered disabled state [ 86.564760][ T7] bridge0: port 1(bridge_slave_0) entered blocking state [ 86.572006][ T7] bridge0: port 1(bridge_slave_0) entered forwarding state [ 86.583330][ T7] bridge0: port 2(bridge_slave_1) entered blocking state [ 86.590454][ T7] bridge0: port 2(bridge_slave_1) entered forwarding state [ 86.628376][ T5155] hsr0: Slave A (hsr_slave_0) is not up; please bring it up to get a fully working HSR network [ 86.639389][ T5155] hsr0: Slave B (hsr_slave_1) is not up; please bring it up to get a fully working HSR network [ 86.674635][ T5155] 8021q: adding VLAN 0 to HW filter on device batadv0 [ 86.818012][ T5155] veth0_vlan: entered promiscuous mode [ 86.830761][ T5155] veth1_vlan: entered promiscuous mode [ 86.858461][ T5155] veth0_macvtap: entered promiscuous mode [ 86.867931][ T5155] veth1_macvtap: entered promiscuous mode [ 86.886125][ T5155] batman_adv: batadv0: Interface activated: batadv_slave_0 [ 86.900640][ T5155] batman_adv: batadv0: Interface activated: batadv_slave_1 [ 86.916504][ T5155] netdevsim netdevsim0 netdevsim0: set [1, 0] type 2 family 0 port 6081 - 0 [ 86.926940][ T5155] netdevsim netdevsim0 netdevsim1: set [1, 0] type 2 family 0 port 6081 - 0 [ 86.936579][ T5155] netdevsim netdevsim0 netdevsim2: set [1, 0] type 2 family 0 port 6081 - 0 [ 86.945636][ T5155] netdevsim netdevsim0 netdevsim3: set [1, 0] type 2 family 0 port 6081 - 0 [ 87.151042][ T5174] nbd0: detected capacity change from 0 to 10 [ 87.834868][ T4482] block nbd0: Receive control failed (result -104) [ 87.842536][ T5173] block nbd0: shutting down sockets [ 87.851824][ T4482] Bluetooth: hci0: command tx timeout [ 87.852463][ C0] I/O error, dev nbd0, sector 0 op 0x0:(READ) flags 0x0 phys_seg 1 prio class 0 [ 87.866985][ C0] Buffer I/O error on dev nbd0, logical block 0, async page read [ 87.875408][ T5156] ldm_validate_partition_table(): Disk read failed. [ 87.884509][ T5156] Dev nbd0: unable to read RDB block 0 [ 87.890126][ T5156] nbd0: unable to read partition table [ 87.896323][ T5156] nbd0: partition table beyond EOD, truncated [ 88.052224][ T5178] nbd0: detected capacity change from 0 to 10 [ 88.729763][ T4482] block nbd0: Receive control failed (result -104) [ 88.730200][ T5176] block nbd0: shutting down sockets [ 88.744001][ C1] I/O error, dev nbd0, sector 0 op 0x0:(READ) flags 0x0 phys_seg 1 prio class 0 [ 88.753547][ C1] Buffer I/O error on dev nbd0, logical block 0, async page read [ 88.761600][ T5177] ldm_validate_partition_table(): Disk read failed. [ 88.768252][ T5177] Dev nbd0: unable to read RDB block 0 [ 88.773859][ T5177] nbd0: unable to read partition table [ 88.779709][ T5177] nbd0: partition table beyond EOD, truncated [ 88.971284][ T5180] nbd0: detected capacity change from 0 to 10 [ 89.611449][ T4482] block nbd0: Receive control failed (result -104) [ 89.612649][ T5181] block nbd0: shutting down sockets [ 89.623496][ C0] I/O error, dev nbd0, sector 0 op 0x0:(READ) flags 0x0 phys_seg 1 prio class 0 [ 89.632592][ C0] Buffer I/O error on dev nbd0, logical block 0, async page read [ 89.641071][ T5177] ldm_validate_partition_table(): Disk read failed. [ 89.647793][ T5177] Dev nbd0: unable to read RDB block 0 [ 89.653795][ T5177] nbd0: unable to read partition table [ 89.659478][ T5177] nbd0: partition table beyond EOD, truncated [ 89.881127][ T5184] nbd0: detected capacity change from 0 to 10 [ 89.930850][ T5157] Bluetooth: hci0: command tx timeout [ 90.524293][ T4482] block nbd0: Receive control failed (result -104) [ 90.525060][ T5183] block nbd0: shutting down sockets [ 90.536761][ C0] I/O error, dev nbd0, sector 0 op 0x0:(READ) flags 0x0 phys_seg 1 prio class 0 [ 90.546120][ C0] Buffer I/O error on dev nbd0, logical block 0, async page read [ 90.554094][ T5177] ldm_validate_partition_table(): Disk read failed. [ 90.560933][ T5177] Dev nbd0: unable to read RDB block 0 [ 90.566428][ T5177] nbd0: unable to read partition table 2024/04/08 02:46:46 executed programs: 4 [ 90.573377][ T5177] nbd0: partition table beyond EOD, truncated [ 90.771000][ T5186] nbd0: detected capacity change from 0 to 10 [ 91.401610][ T4482] block nbd0: Receive control failed (result -104) [ 91.402055][ T5187] block nbd0: shutting down sockets [ 91.414291][ C0] I/O error, dev nbd0, sector 0 op 0x0:(READ) flags 0x0 phys_seg 1 prio class 0 [ 91.423530][ C0] Buffer I/O error on dev nbd0, logical block 0, async page read [ 91.431627][ T5177] ldm_validate_partition_table(): Disk read failed. [ 91.438471][ T5177] Dev nbd0: unable to read RDB block 0 [ 91.444482][ T5177] nbd0: unable to read partition table [ 91.450204][ T5177] nbd0: partition table beyond EOD, truncated [ 91.641086][ T5190] nbd0: detected capacity change from 0 to 10 [ 92.011168][ T5157] Bluetooth: hci0: command tx timeout [ 92.280985][ T4482] block nbd0: Receive control failed (result -104) [ 92.283815][ T5189] block nbd0: shutting down sockets [ 92.293564][ C1] I/O error, dev nbd0, sector 0 op 0x0:(READ) flags 0x0 phys_seg 1 prio class 0 [ 92.302754][ C1] Buffer I/O error on dev nbd0, logical block 0, async page read [ 92.310822][ T5177] ldm_validate_partition_table(): Disk read failed. [ 92.317486][ T5177] Dev nbd0: unable to read RDB block 0 [ 92.323565][ T5177] nbd0: unable to read partition table [ 92.329414][ T5177] nbd0: partition table beyond EOD, truncated [ 92.510852][ T5192] nbd0: detected capacity change from 0 to 10 [ 93.158881][ T4482] block nbd0: Receive control failed (result -104) [ 93.165653][ T5193] block nbd0: shutting down sockets [ 93.171211][ C0] I/O error, dev nbd0, sector 0 op 0x0:(READ) flags 0x0 phys_seg 1 prio class 0 [ 93.180288][ C0] Buffer I/O error on dev nbd0, logical block 0, async page read [ 93.189030][ T5177] ldm_validate_partition_table(): Disk read failed. [ 93.196081][ T5177] Dev nbd0: unable to read RDB block 0 [ 93.201998][ T5177] nbd0: unable to read partition table [ 93.207689][ T5177] nbd0: partition table beyond EOD, truncated [ 93.391105][ T5195] nbd0: detected capacity change from 0 to 10 [ 94.041624][ T4482] block nbd0: Receive control failed (result -104) [ 94.090879][ T4482] Bluetooth: hci0: command tx timeout [ 123.692460][ T56] block nbd0: Possible stuck request ffff888021078400: control (read@0,4096B). Runtime 30 seconds [ 153.780618][ T56] block nbd0: Possible stuck request ffff888021078400: control (read@0,4096B). Runtime 60 seconds [ 156.193270][ T4536] udevd[4536]: worker [5177] /devices/virtual/block/nbd0 is taking a long time [ 183.851198][ T56] block nbd0: Possible stuck request ffff888021078400: control (read@0,4096B). Runtime 90 seconds [ 212.170930][ T5157] Bluetooth: hci0: command 0x0406 tx timeout [ 213.932296][ T56] block nbd0: Possible stuck request ffff888021078400: control (read@0,4096B). Runtime 120 seconds [ 244.016527][ T56] block nbd0: Possible stuck request ffff888021078400: control (read@0,4096B). Runtime 150 seconds [ 274.091747][ T56] block nbd0: Possible stuck request ffff888021078400: control (read@0,4096B). Runtime 180 seconds [ 275.292013][ T4536] udevd[4536]: worker [5177] /devices/virtual/block/nbd0 timeout; kill it [ 275.300953][ T5177] ldm_validate_partition_table(): Disk read failed. [ 275.302470][ T4536] udevd[4536]: seq 8068 '/devices/virtual/block/nbd0' killed [ 275.307675][ T5177] Dev nbd0: unable to read RDB block 0 [ 275.320669][ T5177] nbd0: unable to read partition table [ 275.326418][ T5177] nbd0: partition table beyond EOD, truncated 2024/04/08 02:49:51 executed programs: 8 2024/04/08 02:49:51 result: hanged=false err=executor 0: failed to write control pipe: write |1: broken pipe 2024/04/08 02:49:51 result: hanged=false err=executor 0: EOF [ 276.660011][ T5157] Bluetooth: hci0: unexpected cc 0x0c03 length: 249 > 1 [ 276.669345][ T5157] Bluetooth: hci0: unexpected cc 0x1003 length: 249 > 9 [ 276.678124][ T5157] Bluetooth: hci0: unexpected cc 0x1001 length: 249 > 9 [ 276.686887][ T5157] Bluetooth: hci0: unexpected cc 0x0c23 length: 249 > 4 [ 276.694651][ T5157] Bluetooth: hci0: unexpected cc 0x0c25 length: 249 > 3 [ 276.702661][ T5157] Bluetooth: hci0: unexpected cc 0x0c38 length: 249 > 2 [ 276.807395][ T5212] chnl_net:caif_netlink_parms(): no params data found [ 276.858444][ T5212] bridge0: port 1(bridge_slave_0) entered blocking state [ 276.866009][ T5212] bridge0: port 1(bridge_slave_0) entered disabled state [ 276.873341][ T5212] bridge_slave_0: entered allmulticast mode [ 276.880309][ T5212] bridge_slave_0: entered promiscuous mode [ 276.889311][ T5212] bridge0: port 2(bridge_slave_1) entered blocking state [ 276.897432][ T5212] bridge0: port 2(bridge_slave_1) entered disabled state [ 276.905230][ T5212] bridge_slave_1: entered allmulticast mode [ 276.913673][ T5212] bridge_slave_1: entered promiscuous mode [ 276.939420][ T5212] bond0: (slave bond_slave_0): Enslaving as an active interface with an up link [ 276.950646][ T5212] bond0: (slave bond_slave_1): Enslaving as an active interface with an up link [ 276.979672][ T5212] team0: Port device team_slave_0 added [ 276.988599][ T5212] team0: Port device team_slave_1 added [ 277.010319][ T5212] batman_adv: batadv0: Adding interface: batadv_slave_0 [ 277.019450][ T5212] batman_adv: batadv0: The MTU of interface batadv_slave_0 is too small (1500) to handle the transport of batman-adv packets. Packets going over this interface will be fragmented on layer2 which could impact the performance. Setting the MTU to 1560 would solve the problem. [ 277.046566][ T5212] batman_adv: batadv0: Not using interface batadv_slave_0 (retrying later): interface not active [ 277.058729][ T5212] batman_adv: batadv0: Adding interface: batadv_slave_1 [ 277.065887][ T5212] batman_adv: batadv0: The MTU of interface batadv_slave_1 is too small (1500) to handle the transport of batman-adv packets. Packets going over this interface will be fragmented on layer2 which could impact the performance. Setting the MTU to 1560 would solve the problem. [ 277.092326][ T5212] batman_adv: batadv0: Not using interface batadv_slave_1 (retrying later): interface not active [ 277.123505][ T5212] hsr_slave_0: entered promiscuous mode [ 277.130278][ T5212] hsr_slave_1: entered promiscuous mode [ 277.136768][ T5212] debugfs: Directory 'hsr0' with parent 'hsr' already present! [ 277.144770][ T5212] Cannot create hsr debugfs directory [ 277.225435][ T5212] bridge0: port 2(bridge_slave_1) entered blocking state [ 277.232980][ T5212] bridge0: port 2(bridge_slave_1) entered forwarding state [ 277.240337][ T5212] bridge0: port 1(bridge_slave_0) entered blocking state [ 277.247461][ T5212] bridge0: port 1(bridge_slave_0) entered forwarding state [ 277.298113][ T5212] 8021q: adding VLAN 0 to HW filter on device bond0 [ 277.319587][ T8] bridge0: port 1(bridge_slave_0) entered disabled state [ 277.328417][ T8] bridge0: port 2(bridge_slave_1) entered disabled state [ 277.343997][ T5212] 8021q: adding VLAN 0 to HW filter on device team0 [ 277.363622][ T782] bridge0: port 1(bridge_slave_0) entered blocking state [ 277.370823][ T782] bridge0: port 1(bridge_slave_0) entered forwarding state [ 277.378894][ T782] bridge0: port 2(bridge_slave_1) entered blocking state [ 277.386121][ T782] bridge0: port 2(bridge_slave_1) entered forwarding state [ 277.422030][ T5212] hsr0: Slave B (hsr_slave_1) is not up; please bring it up to get a fully working HSR network [ 277.452611][ T5212] 8021q: adding VLAN 0 to HW filter on device batadv0 [ 277.709347][ T5212] veth0_vlan: entered promiscuous mode [ 277.720671][ T5212] veth1_vlan: entered promiscuous mode [ 277.748970][ T5212] veth0_macvtap: entered promiscuous mode [ 277.757681][ T5212] veth1_macvtap: entered promiscuous mode [ 277.774910][ T5212] batman_adv: The newly added mac address (aa:aa:aa:aa:aa:3d) already exists on: batadv_slave_0 [ 277.786047][ T5212] batman_adv: It is strongly recommended to keep mac addresses unique to avoid problems! [ 277.797764][ T5212] batman_adv: batadv0: Interface activated: batadv_slave_0 [ 277.811993][ T5212] batman_adv: The newly added mac address (aa:aa:aa:aa:aa:3e) already exists on: batadv_slave_1 [ 277.823265][ T5212] batman_adv: It is strongly recommended to keep mac addresses unique to avoid problems! [ 277.834908][ T5212] batman_adv: batadv0: Interface activated: batadv_slave_1 [ 278.731036][ T4482] Bluetooth: hci0: command tx timeout [ 280.810911][ T4482] Bluetooth: hci0: command tx timeout [ 282.892118][ T4482] Bluetooth: hci0: command tx timeout [ 284.970990][ T4482] Bluetooth: hci0: command tx timeout [ 304.172168][ T56] block nbd0: Possible stuck request ffff888021078400: control (read@0,4096B). Runtime 210 seconds [ 334.263060][ T56] block nbd0: Possible stuck request ffff888021078400: control (read@0,4096B). Runtime 240 seconds [ 364.341223][ T97] block nbd0: Possible stuck request ffff888021078400: control (read@0,4096B). Runtime 270 seconds [ 394.411864][ T56] block nbd0: Possible stuck request ffff888021078400: control (read@0,4096B). Runtime 300 seconds [ 401.610968][ T5242] Bluetooth: hci0: command 0x0406 tx timeout [ 424.491810][ T56] block nbd0: Possible stuck request ffff888021078400: control (read@0,4096B). Runtime 330 seconds [ 430.251575][ T29] INFO: task udevd:5177 blocked for more than 143 seconds. [ 430.259052][ T29] Not tainted 6.9.0-rc2-next-20240405-syzkaller #0 [ 430.266392][ T29] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message. [ 430.276035][ T29] task:udevd state:D stack:24856 pid:5177 tgid:5177 ppid:4536 flags:0x00004006 [ 430.286409][ T29] Call Trace: [ 430.289711][ T29] [ 430.292781][ T29] __schedule+0x17e8/0x4a50 [ 430.297482][ T29] ? __pfx___schedule+0x10/0x10 [ 430.302430][ T29] ? __pfx_lock_release+0x10/0x10 [ 430.307559][ T29] ? lockdep_hardirqs_on_prepare+0x43d/0x780 [ 430.313643][ T29] ? schedule+0x90/0x320 [ 430.317904][ T29] schedule+0x14b/0x320 [ 430.322119][ T29] io_schedule+0x8d/0x110 [ 430.326565][ T29] folio_wait_bit_common+0x882/0x12b0 [ 430.332210][ T29] ? __pfx_folio_wait_bit_common+0x10/0x10 [ 430.338040][ T29] ? __pfx_wake_page_function+0x10/0x10 [ 430.343643][ T29] ? find_lock_entries+0x1d1/0x1110 [ 430.348971][ T29] __filemap_get_folio+0xa3/0xbb0 [ 430.354110][ T29] truncate_inode_pages_range+0x57e/0xfc0 [ 430.360858][ T29] ? __pfx_truncate_inode_pages_range+0x10/0x10 [ 430.367271][ T29] ? __pfx___mutex_lock+0x10/0x10 [ 430.373063][ T29] ? __pfx_invalidate_bh_lru+0x10/0x10 [ 430.378613][ T29] ? __pfx_has_bh_in_lru+0x10/0x10 [ 430.383943][ T29] ? __pfx_invalidate_bh_lru+0x10/0x10 [ 430.389440][ T29] blkdev_flush_mapping+0x156/0x2b0 [ 430.394816][ T29] bdev_release+0x489/0x720 [ 430.399334][ T29] blkdev_release+0x15/0x20 [ 430.403969][ T29] ? __pfx_blkdev_release+0x10/0x10 [ 430.409272][ T29] __fput+0x406/0x8b0 [ 430.413384][ T29] task_work_run+0x24f/0x310 [ 430.418112][ T29] ? __pfx_task_work_run+0x10/0x10 [ 430.423266][ T29] ? switch_task_namespaces+0xe1/0x110 [ 430.428734][ T29] do_exit+0xa1b/0x27e0 [ 430.432958][ T29] ? __pfx_do_exit+0x10/0x10 [ 430.437703][ T29] ? __pfx_do_raw_spin_lock+0x10/0x10 [ 430.443199][ T29] ? lockdep_hardirqs_on_prepare+0x43d/0x780 [ 430.449312][ T29] ? __pfx_lockdep_hardirqs_on_prepare+0x10/0x10 [ 430.456043][ T29] ? _raw_spin_lock_irq+0xdf/0x120 [ 430.461280][ T29] do_group_exit+0x207/0x2c0 [ 430.465899][ T29] ? _raw_spin_unlock_irq+0x23/0x50 [ 430.471431][ T29] ? lockdep_hardirqs_on+0x99/0x150 [ 430.476993][ T29] get_signal+0x16a1/0x1740 [ 430.481742][ T29] ? kasan_quarantine_put+0xdc/0x230 [ 430.487151][ T29] ? __pfx_get_signal+0x10/0x10 [ 430.492057][ T29] ? do_sys_openat2+0x17a/0x1d0 [ 430.497017][ T29] arch_do_signal_or_restart+0x96/0x860 [ 430.503660][ T29] ? __pfx_arch_do_signal_or_restart+0x10/0x10 [ 430.509884][ T29] ? lockdep_hardirqs_on_prepare+0x43d/0x780 [ 430.516173][ T29] ? syscall_exit_to_user_mode+0xa3/0x360 [ 430.521994][ T29] syscall_exit_to_user_mode+0xc9/0x360 [ 430.527686][ T29] do_syscall_64+0x10a/0x240 [ 430.532486][ T29] entry_SYSCALL_64_after_hwframe+0x72/0x7a [ 430.538493][ T29] RIP: 0033:0x7f0d8d5169a4 [ 430.543006][ T29] RSP: 002b:00007ffd1cee08b0 EFLAGS: 00000246 ORIG_RAX: 0000000000000101 [ 430.552452][ T29] RAX: 0000000000000008 RBX: 000055d61910e1f0 RCX: 00007f0d8d5169a4 [ 430.560431][ T29] RDX: 00000000000a0800 RSI: 000055d6190ec7c0 RDI: 00000000ffffff9c [ 430.568503][ T29] RBP: 000055d6190ec7c0 R08: 0000000000000001 R09: 00007f0d8da9d0b0 [ 430.576701][ T29] R10: 0000000000000000 R11: 0000000000000246 R12: 00000000000a0800 [ 430.584948][ T29] R13: 000055d6191005b0 R14: 0000000000000001 R15: 000055d6190eb910 [ 430.593261][ T29] [ 430.596304][ T29] INFO: task syz-executor.0:5233 blocked for more than 143 seconds. [ 430.604335][ T29] Not tainted 6.9.0-rc2-next-20240405-syzkaller #0 [ 430.611739][ T29] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message. [ 430.620503][ T29] task:syz-executor.0 state:D stack:27024 pid:5233 tgid:5232 ppid:5212 flags:0x00000006 [ 430.630838][ T29] Call Trace: [ 430.634207][ T29] [ 430.637168][ T29] __schedule+0x17e8/0x4a50 [ 430.641860][ T29] ? __pfx___schedule+0x10/0x10 [ 430.646752][ T29] ? __pfx_lock_release+0x10/0x10 [ 430.651857][ T29] ? __mutex_trylock_common+0x92/0x2e0 [ 430.657530][ T29] ? schedule+0x90/0x320 [ 430.661877][ T29] schedule+0x14b/0x320 [ 430.666419][ T29] schedule_preempt_disabled+0x13/0x30 [ 430.672040][ T29] __mutex_lock+0x6a4/0xd70 [ 430.676588][ T29] ? __mutex_lock+0x527/0xd70 [ 430.681360][ T29] ? bdev_open+0xdd/0xcb0 [ 430.685738][ T29] ? __pfx___mutex_lock+0x10/0x10 [ 430.690845][ T29] ? __pfx___might_resched+0x10/0x10 [ 430.696180][ T29] ? disk_block_events+0xa9/0x120 [ 430.701431][ T29] ? bdev_open+0xa9/0xcb0 [ 430.705795][ T29] bdev_open+0xdd/0xcb0 [ 430.710210][ T29] blkdev_open+0x20d/0x2e0 [ 430.714664][ T29] ? __pfx_blkdev_open+0x10/0x10 [ 430.719622][ T29] do_dentry_open+0x907/0x15f0 [ 430.724545][ T29] path_openat+0x289f/0x3280 [ 430.729164][ T29] ? mark_lock+0x9a/0x350 [ 430.733659][ T29] ? mark_lock+0x9a/0x350 [ 430.738012][ T29] ? __pfx_path_openat+0x10/0x10 [ 430.743039][ T29] do_filp_open+0x235/0x490 [ 430.747564][ T29] ? __pfx_do_filp_open+0x10/0x10 [ 430.752770][ T29] ? _raw_spin_unlock+0x28/0x50 [ 430.757677][ T29] ? alloc_fd+0x59d/0x640 [ 430.762090][ T29] do_sys_openat2+0x13e/0x1d0 [ 430.766868][ T29] ? __pfx_do_sys_openat2+0x10/0x10 [ 430.772312][ T29] __x64_sys_openat+0x247/0x2a0 [ 430.777203][ T29] ? __pfx___x64_sys_openat+0x10/0x10 [ 430.782631][ T29] ? exc_page_fault+0x59e/0x900 [ 430.787497][ T29] ? do_syscall_64+0xb6/0x240 [ 430.792282][ T29] do_syscall_64+0xfb/0x240 [ 430.796807][ T29] entry_SYSCALL_64_after_hwframe+0x72/0x7a [ 430.802752][ T29] RIP: 0033:0x454000 [ 430.806653][ T29] RSP: 002b:00007f290f730c10 EFLAGS: 00000293 ORIG_RAX: 0000000000000101 [ 430.815120][ T29] RAX: ffffffffffffffda RBX: 0000000000000000 RCX: 0000000000454000 [ 430.823128][ T29] RDX: 0000000000000000 RSI: 00007f290f730cb0 RDI: 00000000ffffff9c [ 430.831127][ T29] RBP: 00007f290f730cb0 R08: 0000000000000000 R09: 002364626e2f7665 [ 430.839111][ T29] R10: 0000000000000000 R11: 0000000000000293 R12: 000000000049f8fd [ 430.847137][ T29] R13: 000000000000000b R14: 000000000054cf00 R15: 00007fff26c9cfa8 [ 430.855166][ T29] [ 430.858240][ T29] [ 430.858240][ T29] Showing all locks held in the system: [ 430.866166][ T29] 1 lock held by khungtaskd/29: [ 430.871261][ T29] #0: ffffffff8e334ea0 (rcu_read_lock){....}-{1:2}, at: debug_show_all_locks+0x55/0x2a0 [ 430.881768][ T29] 2 locks held by kworker/u8:2/34: [ 430.887007][ T29] 7 locks held by kworker/u8:3/50: [ 430.892224][ T29] 2 locks held by getty/4834: [ 430.897202][ T29] #0: ffff88802ab8d0a0 (&tty->ldisc_sem){++++}-{0:0}, at: tty_ldisc_ref_wait+0x25/0x70 [ 430.907544][ T29] #1: ffffc900031332f0 (&ldata->atomic_read_lock){+.+.}-{3:3}, at: n_tty_read+0x6b5/0x1e10 [ 430.918885][ T29] 1 lock held by udevd/5177: [ 430.923551][ T29] #0: ffff8880207af4c8 (&disk->open_mutex){+.+.}-{3:3}, at: bdev_release+0x1c8/0x720 [ 430.933210][ T29] 1 lock held by syz-executor.0/5233: [ 430.938576][ T29] #0: ffff8880207af4c8 (&disk->open_mutex){+.+.}-{3:3}, at: bdev_open+0xdd/0xcb0 [ 430.947965][ T29] [ 430.950310][ T29] ============================================= [ 430.950310][ T29] [ 430.959019][ T29] NMI backtrace for cpu 0 [ 430.963464][ T29] CPU: 0 PID: 29 Comm: khungtaskd Not tainted 6.9.0-rc2-next-20240405-syzkaller #0 [ 430.972758][ T29] Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 03/27/2024 [ 430.982827][ T29] Call Trace: [ 430.986128][ T29] [ 430.989137][ T29] dump_stack_lvl+0x241/0x360 [ 430.993967][ T29] ? __pfx_dump_stack_lvl+0x10/0x10 [ 430.999264][ T29] ? __pfx__printk+0x10/0x10 [ 431.004031][ T29] ? vprintk_emit+0x631/0x770 [ 431.008805][ T29] ? __pfx_vprintk_emit+0x10/0x10 [ 431.013837][ T29] nmi_cpu_backtrace+0x49c/0x4d0 [ 431.018875][ T29] ? __pfx_nmi_cpu_backtrace+0x10/0x10 [ 431.024361][ T29] ? _printk+0xd5/0x120 [ 431.028663][ T29] ? __pfx__printk+0x10/0x10 [ 431.033461][ T29] ? __wake_up_klogd+0xcc/0x110 [ 431.038356][ T29] ? __pfx__printk+0x10/0x10 [ 431.042984][ T29] ? wq_watchdog_touch+0x72/0x110 [ 431.048120][ T29] ? __pfx_nmi_raise_cpu_backtrace+0x10/0x10 [ 431.054586][ T29] nmi_trigger_cpumask_backtrace+0x198/0x320 [ 431.060662][ T29] watchdog+0xfde/0x1020 [ 431.064929][ T29] ? watchdog+0x1ea/0x1020 [ 431.069352][ T29] ? __pfx_watchdog+0x10/0x10 [ 431.074229][ T29] kthread+0x2f0/0x390 [ 431.078315][ T29] ? __pfx_watchdog+0x10/0x10 [ 431.083021][ T29] ? __pfx_kthread+0x10/0x10 [ 431.087628][ T29] ret_from_fork+0x4b/0x80 [ 431.092049][ T29] ? __pfx_kthread+0x10/0x10 [ 431.096646][ T29] ret_from_fork_asm+0x1a/0x30 [ 431.101455][ T29] [ 431.104619][ T29] Sending NMI from CPU 0 to CPUs 1: [ 431.110022][ C1] NMI backtrace for cpu 1 [ 431.110034][ C1] CPU: 1 PID: 4518 Comm: syslogd Not tainted 6.9.0-rc2-next-20240405-syzkaller #0 [ 431.110052][ C1] Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 03/27/2024 [ 431.110061][ C1] RIP: 0010:tomoyo_realpath_from_path+0x0/0x5e0 [ 431.110167][ C1] Code: 4c 89 e7 e8 82 e9 94 fd e9 df fc ff ff 66 2e 0f 1f 84 00 00 00 00 00 0f 1f 00 90 90 90 90 90 90 90 90 90 90 90 90 90 90 90 90 <66> 0f 1f 00 55 41 57 41 56 41 55 41 54 53 48 83 ec 58 48 89 fb 48 [ 431.110180][ C1] RSP: 0018:ffffc9000dfef5d8 EFLAGS: 00000202 [ 431.110194][ C1] RAX: 0000000000000000 RBX: 0000000000000001 RCX: ffff888075739e00 [ 431.110205][ C1] RDX: ffff888075739e00 RSI: 0000000000000001 RDI: ffff88802c9d6400 [ 431.110216][ C1] RBP: ffffc9000dfef810 R08: ffffffff8464c549 R09: 0000000000000000 [ 431.110227][ C1] R10: ffffc9000dfef660 R11: fffff52001bfded6 R12: dffffc0000000000 [ 431.110238][ C1] R13: 1ffff92001bfdec4 R14: ffff88802c9d6400 R15: 1ffff92001bfdec8 [ 431.110250][ C1] FS: 00007f508f608380(0000) GS:ffff8880b9500000(0000) knlGS:0000000000000000 [ 431.110263][ C1] CS: 0010 DS: 0000 ES: 0000 CR0: 0000000080050033 [ 431.110274][ C1] CR2: 0000555ffc422f18 CR3: 0000000075020000 CR4: 00000000003506f0 [ 431.110289][ C1] DR0: 0000000000000000 DR1: 0000000000000000 DR2: 0000000000000000 [ 431.110298][ C1] DR3: 0000000000000000 DR6: 00000000fffe0ff0 DR7: 0000000000000400 [ 431.110308][ C1] Call Trace: [ 431.110314][ C1] [ 431.110320][ C1] ? nmi_cpu_backtrace+0x3c2/0x4d0 [ 431.110342][ C1] ? __pfx_lock_acquire+0x10/0x10 [ 431.110361][ C1] ? __pfx_nmi_cpu_backtrace+0x10/0x10 [ 431.110380][ C1] ? nmi_handle+0x2a/0x5a0 [ 431.110404][ C1] ? nmi_cpu_backtrace_handler+0xc/0x20 [ 431.110422][ C1] ? nmi_handle+0x14f/0x5a0 [ 431.110437][ C1] ? nmi_handle+0x2a/0x5a0 [ 431.110452][ C1] ? __pfx_tomoyo_realpath_from_path+0x10/0x10 [ 431.110471][ C1] ? default_do_nmi+0x63/0x160 [ 431.110492][ C1] ? exc_nmi+0x123/0x1f0 [ 431.110511][ C1] ? end_repeat_nmi+0xf/0x53 [ 431.110554][ C1] ? tomoyo_check_open_permission+0x249/0x500 [ 431.110572][ C1] ? __pfx_tomoyo_realpath_from_path+0x10/0x10 [ 431.110591][ C1] ? __pfx_tomoyo_realpath_from_path+0x10/0x10 [ 431.110611][ C1] ? __pfx_tomoyo_realpath_from_path+0x10/0x10 [ 431.110629][ C1] [ 431.110634][ C1] [ 431.110639][ C1] tomoyo_check_open_permission+0x255/0x500 [ 431.110657][ C1] ? tomoyo_check_open_permission+0x204/0x500 [ 431.110673][ C1] ? __pfx_tomoyo_check_open_permission+0x10/0x10 [ 431.110708][ C1] ? step_into+0x4ba/0x1080 [ 431.110723][ C1] ? tomoyo_file_open+0x168/0x220 [ 431.110744][ C1] security_file_open+0x6a/0x730 [ 431.110785][ C1] ? try_module_get+0x31/0x150 [ 431.110812][ C1] do_dentry_open+0x327/0x15f0 [ 431.110835][ C1] ? inode_permission+0xff/0x460 [ 431.110858][ C1] path_openat+0x289f/0x3280 [ 431.110892][ C1] ? __pfx_path_openat+0x10/0x10 [ 431.110920][ C1] do_filp_open+0x235/0x490 [ 431.110939][ C1] ? __pfx_do_filp_open+0x10/0x10 [ 431.110969][ C1] ? _raw_spin_unlock+0x28/0x50 [ 431.110987][ C1] ? alloc_fd+0x59d/0x640 [ 431.111012][ C1] do_sys_openat2+0x13e/0x1d0 [ 431.111030][ C1] ? __pfx_do_sys_openat2+0x10/0x10 [ 431.111046][ C1] ? lockdep_hardirqs_on_prepare+0x43d/0x780 [ 431.111064][ C1] ? __pfx_lockdep_hardirqs_on_prepare+0x10/0x10 [ 431.111082][ C1] __x64_sys_openat+0x247/0x2a0 [ 431.111100][ C1] ? __pfx___x64_sys_openat+0x10/0x10 [ 431.111119][ C1] ? do_syscall_64+0x10a/0x240 [ 431.111138][ C1] ? do_syscall_64+0xb6/0x240 [ 431.111156][ C1] do_syscall_64+0xfb/0x240 [ 431.111175][ C1] entry_SYSCALL_64_after_hwframe+0x72/0x7a [ 431.111191][ C1] RIP: 0033:0x7f508f75c9a4 [ 431.111204][ C1] Code: 24 20 48 8d 44 24 30 48 89 44 24 28 64 8b 04 25 18 00 00 00 85 c0 75 2c 44 89 e2 48 89 ee bf 9c ff ff ff b8 01 01 00 00 0f 05 <48> 3d 00 f0 ff ff 76 60 48 8b 15 55 a4 0d 00 f7 d8 64 89 02 48 83 [ 431.111216][ C1] RSP: 002b:00007ffc29b263a0 EFLAGS: 00000246 ORIG_RAX: 0000000000000101 [ 431.111231][ C1] RAX: ffffffffffffffda RBX: 00005570b58cf910 RCX: 00007f508f75c9a4 [ 431.111243][ C1] RDX: 0000000000000d41 RSI: 00007f508f8fb443 RDI: 00000000ffffff9c [ 431.111253][ C1] RBP: 00007f508f8fb443 R08: 0000000000000001 R09: 0000000000000000 [ 431.111263][ C1] R10: 00000000000001b6 R11: 0000000000000246 R12: 0000000000000d41 [ 431.111272][ C1] R13: 0000000066135beb R14: 0000000000000004 R15: 00005570b58cfa60 [ 431.111290][ C1] [ 431.112026][ T29] Kernel panic - not syncing: hung_task: blocked tasks [ 431.112038][ T29] CPU: 0 PID: 29 Comm: khungtaskd Not tainted 6.9.0-rc2-next-20240405-syzkaller #0 [ 431.112057][ T29] Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 03/27/2024 [ 431.112067][ T29] Call Trace: [ 431.112074][ T29] [ 431.112082][ T29] dump_stack_lvl+0x241/0x360 [ 431.112108][ T29] ? __pfx_dump_stack_lvl+0x10/0x10 [ 431.112130][ T29] ? __pfx__printk+0x10/0x10 [ 431.112148][ T29] ? lockdep_hardirqs_on_prepare+0x43d/0x780 [ 431.112173][ T29] ? vscnprintf+0x5d/0x90 [ 431.112237][ T29] panic+0x349/0x860 [ 431.112259][ T29] ? nmi_trigger_cpumask_backtrace+0x244/0x320 [ 431.112284][ T29] ? __pfx_panic+0x10/0x10 [ 431.112301][ T29] ? tick_nohz_tick_stopped+0x82/0xb0 [ 431.112336][ T29] ? __irq_work_queue_local+0x137/0x410 [ 431.112371][ T29] ? preempt_schedule_thunk+0x1a/0x30 [ 431.112390][ T29] ? nmi_trigger_cpumask_backtrace+0x244/0x320 [ 431.112413][ T29] ? nmi_trigger_cpumask_backtrace+0x2d4/0x320 [ 431.112439][ T29] ? nmi_trigger_cpumask_backtrace+0x2d9/0x320 [ 431.112466][ T29] watchdog+0x101d/0x1020 [ 431.112487][ T29] ? watchdog+0x1ea/0x1020 [ 431.112510][ T29] ? __pfx_watchdog+0x10/0x10 [ 431.112527][ T29] kthread+0x2f0/0x390 [ 431.112548][ T29] ? __pfx_watchdog+0x10/0x10 [ 431.112565][ T29] ? __pfx_kthread+0x10/0x10 [ 431.112586][ T29] ret_from_fork+0x4b/0x80 [ 431.112609][ T29] ? __pfx_kthread+0x10/0x10 [ 431.112630][ T29] ret_from_fork_asm+0x1a/0x30 [ 431.112665][ T29] [ 431.116119][ T29] Kernel Offset: disabled [ 431.704193][ T29] Rebooting in 86400 seconds..