On Thu, Mar 5, 2020 at 11:18 AM Andy Shevchenko <andy.shevchenko@xxxxxxxxx> wrote: > > +Cc: Sakari > > On Thu, Mar 5, 2020 at 6:00 PM Naresh Kamboju <naresh.kamboju@xxxxxxxxxx> wrote: > > > > Regression reported on Linux next 5.6.0-rc4-next-20200305 on x86_64, > > i386, arm and arm64. The steps to reproduce is running kselftests lib > > printf.sh test case. > > Which is doing modprobe operations. > > > > BTW, there are few RCU warnings from the boot log. > > Please refer below link for more details. > > > > Steps reproduce by using kselftests, > > > > - lsmod || true > > - cd /opt/kselftests/default-in-kernel/lib/ > > - export PATH=/opt/kselftests/default-in-kernel/kselftest:$PATH > > - ./printf.sh || true > > - ./bitmap.sh || true > > - ./prime_numbers.sh || true > > - ./strscpy.sh || true > > > > x86_64 kernel BUG dump. > > + ./printf.sh Oops, I am wondering if I broke this with my change "Revert "software node: Simplify software_node_release() function"": https://git.kernel.org/pub/scm/linux/kernel/git/next/linux-next.git/commit/?id=d1c19322388d6935b534b494a2c223dd089e30dd I am still investigating, will update later. > > [ 32.594369] test_printf: loaded. > > [ 32.599859] BUG: kernel NULL pointer dereference, address: 00000000 > > [ 32.606143] #PF: supervisor read access in kernel mode > > [ 32.611280] #PF: error_code(0x0000) - not-present page > > [ 32.616419] *pde = 00000000 > > [ 32.619306] Oops: 0000 [#1] SMP > > [ 32.622452] CPU: 0 PID: 387 Comm: modprobe Not tainted > > 5.6.0-rc4-next-20200305 #1 > > [ 32.629928] Hardware name: Supermicro SYS-5019S-ML/X11SSH-F, BIOS > > 2.2 05/23/2018 > > [ 32.637314] EIP: ida_free+0x61/0x130 > > [ 32.640891] Code: 00 c7 45 e8 00 00 00 00 c7 45 ec 00 00 00 00 0f > > 88 c4 00 00 00 89 d3 e8 9d ee 01 00 89 c7 8d 45 d8 e8 e3 18 01 00 a8 > > 01 75 3f <0f> a3 30 72 72 8b 45 d8 89 fa e8 70 f0 01 00 53 68 d8 61 01 > > d3 e8 > > [ 32.659628] EAX: 00000000 EBX: 00000000 ECX: ffffffff EDX: 00000000 > > [ 32.665887] ESI: 00000000 EDI: 00000246 EBP: f21a7cc8 ESP: f21a7c9c > > [ 32.672153] DS: 007b ES: 007b FS: 00d8 GS: 00e0 SS: 0068 EFLAGS: 00010046 > > [ 32.678928] CR0: 80050033 CR2: 00000000 CR3: 32ff3000 CR4: 003406d0 > > [ 32.685186] DR0: 00000000 DR1: 00000000 DR2: 00000000 DR3: 00000000 > > [ 32.691442] DR6: fffe0ff0 DR7: 00000400 > > [ 32.695273] Call Trace: > > [ 32.697721] software_node_release+0x21/0x80 > > [ 32.701990] kobject_put+0xa8/0x1c0 > > [ 32.705476] kobject_del+0x40/0x60 > > [ 32.708881] kobject_put+0x92/0x1c0 > > [ 32.712380] fwnode_remove_software_node+0x30/0x50 > > [ 32.717201] software_node_unregister_nodes+0x2b/0x50 > > [ 32.722246] test_printf_init+0xe00/0x1d29 [test_printf] > > [ 32.727563] ? find_held_lock+0x27/0xa0 > > [ 32.731423] ? test_hashed+0x54/0x54 [test_printf] > > [ 32.736207] ? test_hashed+0x54/0x54 [test_printf] > > [ 32.741001] do_one_initcall+0x54/0x2e0 > > [ 32.744841] ? rcu_read_lock_sched_held+0x47/0x70 > > [ 32.749547] ? kmem_cache_alloc_trace+0x285/0x2b0 > > [ 32.754249] ? do_init_module+0x21/0x1ef > > [ 32.758166] ? do_init_module+0x21/0x1ef > > [ 32.762087] do_init_module+0x50/0x1ef > > [ 32.765837] load_module+0x1e32/0x2540 > > [ 32.769586] ? kernel_read_file+0x295/0x2d0 > > [ 32.773771] sys_finit_module+0x8a/0xe0 > > [ 32.777611] do_fast_syscall_32+0x8e/0x340 > > [ 32.781709] entry_SYSENTER_32+0xaa/0x102 > > [ 32.785719] EIP: 0xb7f75ce1 > > [ 32.788508] Code: 5e 5d c3 8d b6 00 00 00 00 b8 40 42 0f 00 eb c1 > > 8b 04 24 c3 8b 1c 24 c3 8b 34 24 c3 8b 3c 24 c3 90 51 52 55 89 e5 0f > > 34 cd 80 <5d> 5a 59 c3 90 90 90 90 8d 76 00 58 b8 77 00 00 00 cd 80 90 > > 8d 76 > > [ 32.807246] EAX: ffffffda EBX: 00000003 ECX: 0806233a EDX: 00000000 > > [ 32.813502] ESI: 085fb600 EDI: 085fb550 EBP: 085fb6e0 ESP: bffe839c > > [ 32.819760] DS: 007b ES: 007b FS: 0000 GS: 0033 SS: 007b EFLAGS: 00000292 > > [ 32.826542] Modules linked in: test_printf(+) x86_pkg_temp_thermal fuse > > [ 32.833150] CR2: 0000000000000000 > > [ 32.836461] ---[ end trace 69388c972b4562b8 ]--- > > [ 32.841072] EIP: ida_free+0x61/0x130 > > [ 32.844642] Code: 00 c7 45 e8 00 00 00 00 c7 45 ec 00 00 00 00 0f > > 88 c4 00 00 00 89 d3 e8 9d ee 01 00 89 c7 8d 45 d8 e8 e3 18 01 00 a8 > > 01 75 3f <0f> a3 30 72 72 8b 45 d8 89 fa e8 70 f0 01 00 53 68 d8 61 01 > > d3 e8 > > [ 32.863420] EAX: 00000000 EBX: 00000000 ECX: ffffffff EDX: 00000000 > > [ 32.869679] ESI: 00000000 EDI: 00000246 EBP: f21a7cc8 ESP: f21a7c9c > > [ 32.875936] DS: 007b ES: 007b FS: 00d8 GS: 00e0 SS: 0068 EFLAGS: 00010046 > > [ 32.882713] CR0: 80050033 CR2: 00000000 CR3: 32ff3000 CR4: 003406d0 > > [ 32.888970] DR0: 00000000 DR1: 00000000 DR2: 00000000 DR3: 00000000 > > [ 32.895227] DR6: fffe0ff0 DR7: 00000400 > > [ 32.899060] BUG: sleeping function called from invalid context at > > /usr/src/kernel/include/linux/percpu-rwsem.h:49 > > [ 32.909303] in_atomic(): 1, irqs_disabled(): 1, non_block: 0, pid: > > 387, name: modprobe > > [ 32.917207] INFO: lockdep is turned off. > > [ 32.921124] irq event stamp: 5120 > > [ 32.924434] hardirqs last enabled at (5119): [<d20dea05>] kfree+0x135/0x270 > > [ 32.931472] hardirqs last disabled at (5120): [<d2b9ab04>] > > _raw_spin_lock_irqsave+0x14/0x40 > > [ 32.939809] softirqs last enabled at (4978): [<d2b9f165>] > > __do_softirq+0x2c5/0x3c3 > > [ 32.947454] softirqs last disabled at (4969): [<d1ea67d5>] > > call_on_stack+0x45/0x50 > > [ 32.955009] CPU: 0 PID: 387 Comm: modprobe Tainted: G D > > 5.6.0-rc4-next-20200305 #1 > > [ 32.963867] Hardware name: Supermicro SYS-5019S-ML/X11SSH-F, BIOS > > 2.2 05/23/2018 > > [ 32.971250] Call Trace: > > [ 32.973695] dump_stack+0x6e/0x96 > > [ 32.977009] ___might_sleep+0x14d/0x240 > > [ 32.980846] __might_sleep+0x33/0x80 > > [ 32.984419] exit_signals+0x2a/0x2d0 > > [ 32.987997] do_exit+0x8e/0xb00 > > [ 32.991143] ? do_fast_syscall_32+0x8e/0x340 > > [ 32.995421] rewind_stack_do_exit+0x11/0x13 > > [ 32.999600] EIP: 0xb7f75ce1 > > [ 33.002416] Code: 5e 5d c3 8d b6 00 00 00 00 b8 40 42 0f 00 eb c1 > > 8b 04 24 c3 8b 1c 24 c3 8b 34 24 c3 8b 3c 24 c3 90 51 52 55 89 e5 0f > > 34 cd 80 <5d> 5a 59 c3 90 90 90 90 8d 76 00 58 b8 77 00 00 00 cd 80 90 > > 8d 76 > > [ 33.021153] EAX: ffffffda EBX: 00000003 ECX: 0806233a EDX: 00000000 > > [ 33.027425] ESI: 085fb600 EDI: 085fb550 EBP: 085fb6e0 ESP: bffe839c > > [ 33.033685] DS: 007b ES: 007b FS: 0000 GS: 0033 SS: 007b EFLAGS: 00000292 > > [ 33.040465] note: modprobe[387] exited with preempt_count 1 > > ./../kselftest/module.sh: line 56: 387 Killed > > $modprobe -q $module $args > > printf: [FAIL] > > > > > > metadata: > > git repo: https://git.kernel.org/pub/scm/linux/kernel/git/next/linux-next.git > > git branch: master > > git describe: next-20200305 > > kernel-config: > > http://snapshots.linaro.org/openembedded/lkft/lkft/sumo/intel-core2-32/lkft/linux-next/719/config > > > > ref: > > https://lkft.validation.linaro.org/scheduler/job/1267112#L1254 > > https://lkft.validation.linaro.org/scheduler/job/1267041#L9795 > > > > -- > > Linaro LKFT > > https://lkft.linaro.org > > > > -- > With Best Regards, > Andy Shevchenko
