Re: Heisenbug: I/O freeze can be resolved by cat $task/cmdline of unrelated process

[Donald Buczek]

On 11/5/23 13:02, Dr. David Alan Gilbert wrote:
> * Donald Buczek (buczek@xxxxxxxxxxxxx) wrote:
> > Hello, experts,
> >
> > we have a strange new problem on a backup server (high metadata I/O 24/7, xfs -> mdraid). The system worked for years and with v5.15.86 for 8 month. Then we've updated to 6.1.52 and after a few hours it froze: No more I/O activity to one of its filesystems, processes trying to access it blocked until we reboot.
> >
> > Of course, at first we blamed the kernel as this happened after an upgrade. But after several experiments with different kernel versions, we've returned to the v5.15.86 kernel we used before, but still experienced the problem. Then we suspected, that a microcode update (for AMD EPYC 7261), which happened as a side effect of the first reboot, might be the culprit and removed it. That didn't fix it either. For all I can say, all software is back to the state which worked before.
>
> I'm not sure; but did you check /proc/cpuinfo after that revert and
> check the microcode version dropped back (or physically pwoer cycle);
> I'm not sure if a reboot reverts the microcode version.

Yes, when not updated via init.d amd-ucode.img, /proc/cpuinfo and dmesg show the old microcode after reboot (through bios, not just kexec). We've power-cycled nonetheless once

> > Now the strange part: What we usually do, when we have a situation like this, is that we run a script which takes several procfs and sysfs information which happened to be useful in the past. It was soon discovered, that just running this script unblocks the system. I/O continues as if nothing ever happened. Then we singled-stepped the operations of the script to find out, what action exactly gets the system to resume. It is this part:
> >
> >      for task in /proc/*/task/*; do
> >          echo  "# # $task: $(cat $task/comm) : $(cat $task/cmdline | xargs -0 echo)"
> >          cmd cat $task/stack
> >      done
> >
> > which can further be reduced to
> >
> >      for task in /proc/*/task/*; do echo $task $(cat $task/cmdline | xargs -0 echo); done
> >
> > This is absolutely reproducible. Above line unblocks the system reliably.
> >
> > Another remarkable thing: We've modified above code to do the processes slowly one by one and checking after each step if I/O resumed. And each time we've tested that, it was one of the 64 nfsd processes (but not the very first one tried). While the systems exports filesystems, we have absolutely no reason to assume, that any client actually tries to access this nfs server. Additionally, when the full script is run, the stack traces show all nfsd tasks in their normal idle state ( [<0>] svc_recv+0x7bd/0x8d0 [sunrpc] ).
> >
> > Does anybody have an idea, how a `cat /proc/PID/cmdline` on a specific assumed-to-be-idle nfsd thread could have such an "healing" effect?
>
> Not me; but had you tried something simpler like a sysrq-d or sysrq-w
> for locks and blocked tasks.

No, will do.

Thanks!

  Donald

> > I'm well aware, that, for example, a hardware problem might result in just anything and that the question might not be answerable at all. If so: please excuse the noise.
>
> Seems a weird hardware problem to have that specific
> a way to unblock it.
>
> Dave
>
> > Thanks
> > Donald
> > --
> > Donald Buczek
> > buczek@xxxxxxxxxxxxx
> > Tel: +49 30 8413 1433

--
Donald Buczek
buczek@xxxxxxxxxxxxx
Tel: +49 30 8413 1433