Received: by 2002:a25:e74b:0:0:0:0:0 with SMTP id e72csp281999ybh; Sun, 12 Jul 2020 06:16:43 -0700 (PDT) X-Google-Smtp-Source: ABdhPJzRyIAqiCAZi3AMsfYWdhw3N0fdxIFD/5zCvqRWowQD312Hcch4Ct2Ude3MjDzGpWR3v3V2 X-Received: by 2002:aa7:cfc4:: with SMTP id r4mr52688267edy.22.1594559803218; Sun, 12 Jul 2020 06:16:43 -0700 (PDT) ARC-Seal: i=1; a=rsa-sha256; t=1594559803; cv=none; d=google.com; s=arc-20160816; b=fv/Kwm/cA6WlFlYPAX8CqdD4ll/+IsRAfGvgz00oZk4vpcNlbGn2B+4JJIP/d3AYbx qV2lsXdXqWYILw4i+gzCYnaz4jafhCal7gJckgIqi0isGMxHdZ35ZrUe6i2e6RE3a7ZJ jfO/XPH7Gv24AHY7hIencrR3CxCnyTJFva3IEhxxc1abs80B79yLBoLDgX42OQfrhDeh WOBzQqNfbNNraMAIkMBbjqtD5PnwZy15/VPFW2pMzSatgJiqP3eNmDvsrWiULKotu4KZ GBAr5OPsIrQbwkvN/iZOCoFv4coRLv98tUKvL005vwGjGPhQyBSBkqhqkuSDDVF1Ixfo NNJA== ARC-Message-Signature: i=1; a=rsa-sha256; c=relaxed/relaxed; d=google.com; s=arc-20160816; h=list-id:precedence:sender:content-language :content-transfer-encoding:in-reply-to:mime-version:user-agent:date :message-id:references:to:from:subject; bh=X2VnvMYtZ1Erg00Yw2qL8Vo0aemGvwyYPXTQNLDaKR4=; b=W/kYa4rFqb7jWak41MpZQJFsFfnCQws0lcuUfkpHkyO6L0KrHSbImAq/wYmntxaio8 cW9kOuDa7cQlQH5V2Hsj2XOixJ62OglLz3KTo/umZuWInWUuMNSnKM2vA57lPSx9WN0B NOnTsnkpxUJZJOAlKPxSkxYZKfcxW/lW8kEHqdL2B7SRXmWSacvvqDTkhMaRJkhgm0k/ 225cCJ0hoYXMmVc5SCrv5W2ivujMpagWhBDAY4s/7EV6N+zOXNz80cnzNc/1lWKFH7qq //dsyVhHqpINtjXgIuompoUcrDfzkBR+5bqh7h4L8bToWmu3QspYmZhrz2uoe/WQfv2R Yu1g== ARC-Authentication-Results: i=1; mx.google.com; spf=pass (google.com: domain of linux-kernel-owner@vger.kernel.org designates 23.128.96.18 as permitted sender) smtp.mailfrom=linux-kernel-owner@vger.kernel.org; dmarc=fail (p=NONE sp=NONE dis=NONE) header.from=inet.fi Return-Path: Received: from vger.kernel.org (vger.kernel.org. [23.128.96.18]) by mx.google.com with ESMTP id a3si7770963ejd.449.2020.07.12.06.16.20; Sun, 12 Jul 2020 06:16:43 -0700 (PDT) Received-SPF: pass (google.com: domain of linux-kernel-owner@vger.kernel.org designates 23.128.96.18 as permitted sender) client-ip=23.128.96.18; Authentication-Results: mx.google.com; spf=pass (google.com: domain of linux-kernel-owner@vger.kernel.org designates 23.128.96.18 as permitted sender) smtp.mailfrom=linux-kernel-owner@vger.kernel.org; dmarc=fail (p=NONE sp=NONE dis=NONE) header.from=inet.fi Received: (majordomo@vger.kernel.org) by vger.kernel.org via listexpand id S1728756AbgGLNQR (ORCPT + 99 others); Sun, 12 Jul 2020 09:16:17 -0400 Received: from mta-out1.inet.fi ([62.71.2.202]:55040 "EHLO julia1.inet.fi" rhost-flags-OK-OK-OK-OK) by vger.kernel.org with ESMTP id S1728339AbgGLNQQ (ORCPT ); Sun, 12 Jul 2020 09:16:16 -0400 X-RazorGate-Vade-Verdict: clean 0 X-RazorGate-Vade-Classification: clean X-RazorGate-Vade: gggruggvucftvghtrhhoucdtuddrgeduiedrvdeigdeihecutefuodetggdotefrodftvfcurfhrohhfihhlvgemucfupfevtfenuceurghilhhouhhtmecufedttdenucenucfjughrpefuhffvfhfkffgfgggjtgfgsehtkeertddtfeejnecuhfhrohhmpefklhhkkhgrucfrrhhushhiuceoihhlkhhkrgdrphhruhhsihesphhprdhinhgvthdrfhhiqeenucggtffrrghtthgvrhhnpeeufeduleegkefhgeektdetieegfedvtdehvdevheduffduiedvueevjeegieekkeenucfkphepkeegrddvhedurdduleegrdduieegnecuvehluhhsthgvrhfuihiivgeptdenucfrrghrrghmpehhvghloheplgduledvrdduieekrddurddutdehngdpihhnvghtpeekgedrvdehuddrudelgedrudeigedpmhgrihhlfhhrohhmpeeophhruhhsihhlqddusehmsghogidrihhnvghtrdhfihequceuqfffjgepkeeukffvoffkoffgpdhrtghpthhtohepoehlihhnuhigqdhkvghrnhgvlhesvhhgvghrrdhkvghrnhgvlhdrohhrgheq Received: from [192.168.1.105] (84.251.194.164) by julia1.inet.fi (9.0.019.26-1) (authenticated as prusil-1) id 5EFB425600416465 for linux-kernel@vger.kernel.org; Sun, 12 Jul 2020 16:16:05 +0300 Subject: Re: splat and freeze (2 instances) From: Ilkka Prusi To: linux-kernel@vger.kernel.org References: <40e7f7f4-88f5-da0f-bf7f-067b74ac7714@pp.inet.fi> Message-ID: Date: Sun, 12 Jul 2020 16:16:05 +0300 User-Agent: Mozilla/5.0 (X11; Linux x86_64; rv:68.0) Gecko/20100101 Thunderbird/68.10.0 MIME-Version: 1.0 In-Reply-To: Content-Type: text/plain; charset=utf-8; format=flowed Content-Transfer-Encoding: 8bit Content-Language: en-US Sender: linux-kernel-owner@vger.kernel.org Precedence: bulk List-ID: X-Mailing-List: linux-kernel@vger.kernel.org Hi, Here's a second splat with some additional tracing enabled. Again this is gathered with phonecamera from frozen machine (dmesg -w) and full logs could not be saved. Linux version 5.8.0-rc4+ (gcc (Debian 9.3.0-14) 9.3.0, GNU ld (GNU Binutils for Debian) 2.34.90.20200706) #95 SMP PREEMPT Sun Jul 12 12:29:16 EEST 2020 schedule_timeout+0x162/0x1a0 ? trace_hardirqs_on+0x1c/0xf0 wait_for_completion+0x84/0xe0 virt_efi_query_variable_info+0x163/0x170 efi_query_variable_store+0x53/0x190 ? _raw_spin_unlock_irqrestore+0x41/0x70 efivar_entry_set_safe+0xbf/0x210 efi_pstore_write+0x116/0x160/ [efi_pstore] pstore_dump+0x10c/0x2e0 ? kmsg_dump+0xd5/0x1c0 kmsg_dump+0x7b/0x1c0 oops_end+0x6f/0xc0 do_trap+0x8c/0x100 ? do_futex+0x15e/0x560 do_error_trap+0x86/0x100 ? do_futex+0x15e/0x560 ? do_futex+0x15e/0x560 exc_invalid_op+0x4c/0x60 ? do_futex+0x15e/0x560 asm_exc_invalid_op+0xf/0x20 RIP: 0010:do_futex+0x15e/0x560 Code: 85 c0 75 4b c7 84 24 a8 00 00 00 ff ff ff ff 41 b8 ff ff ff ff 4c 89 e9 44 89 f2 44 89 e6 48 89 ef e8 d6 e0 ff ff 48 98 e9 62 ff ff 83 f8 08 74 61 83 f8 09 75 18 44 8b 84 24 a8 00 00 00 eb RSP: 0018:ffffc9000128fe08 EFLAGS: 00010282 RAX: 00000000ffffff92 RBX: 0000000000000000 RCX: 0000000000ae8b8c RDX: ffff8887fe8dde80 RSI: ffff8887fa562720 RDI: ffffc9000128fd10 RBP: 0000000057b01018 R08: 0000000000000000 R09: 0000000000000000 R10: 0000000000000001 R11: 0000000000000000 R12: 0000000000000000 R13: ffffc9000128fed0 R14: 0000000000000000 R15: 0000000000000000 ? do_futex+0x15e/0x560 ? lockdep_hardirqs_on_prepare+0xcf/0x170 ? _raw_spin_unlock_irq+0x24/0x50 ? trace_hardirqs_on+0x1c/0xf0 ? _raw_spin_unlock_irq+0x35/0x50 ? finish_task_switch+0x9e/0x280 ? finish_task_switch+0x70/0x280 ? __switch_to+0x361/0x480 ? __switch_to_asm+0x36/0x70 __ia32_sys_futex_time32+0x13a/0x168 do_syscall_32_irqs_on+0x45/0x60 do_fast_syscall_32+0x6b/0xf0 entry_SYSCALL_compat_after_hwframe+0x45/0x4d RIP: 0023:0xf7f06579 Code: Bad RIP value. RSP: 002b:00000000be3faec0 EFLAGS: 00200282 ORIG_RAX: 00000000000000f0 RAX: ffffffffffffffda RBX: 0000000057b01018 RCX: 0000000000000089 RDX: 0000000000000000 RSI: 00000000be3faf90 RDI: 0000000000000000 RBP: 00000000ffffffff R08: 0000000000000000 R09: 0000000000000000 R10: 0000000000000000 R11: 0000000000000000 R12: 0000000000000000 R13: 0000000000000000 R14: 0000000000000000 R15: 0000000000000000 irq event stamp: 455331 hardirqs last  enabled at (455331): [] do_error_trap+0xbe/0x100 hardirqs last disabled at (455330): [] idtentry_enter_cond_rcu+0x1d/0x50 softirqs last  enabled at (454086): [] __do_softirq+0x3aa/0x4af softirqs last disabled at (454075): [] asm_call_on_stack+0x12/0x20 ---[ end trace 87cc90f8d863ccc2 ]--- decode stacktrace: $ cat ~/crashdata/580rc4/irq | ./scripts/decode_stacktrace.sh vmlinux . /lib/modules/5.8.0-rc4+/ schedule_timeout (/usr/src/linux/kernel/time/timer.c:1874) ? trace_hardirqs_on (/usr/src/linux/kernel/trace/trace_preemptirq.c:50 (discriminator 42)) wait_for_completion (/usr/src/linux/kernel/sched/completion.c:86 /usr/src/linux/kernel/sched/completion.c:106 /usr/src/linux/kernel/sched/completion.c:117 /usr/src/linux/kernel/sched/completion.c:138) virt_efi_query_variable_info (/usr/src/linux/drivers/firmware/efi/runtime-wrappers.c:374 (discriminator 7)) efi_query_variable_store (/usr/src/linux/arch/x86/platform/efi/quirks.c:165 /usr/src/linux/arch/x86/platform/efi/quirks.c:151) ? _raw_spin_unlock_irqrestore (/usr/src/linux/./arch/x86/include/asm/preempt.h:102 /usr/src/linux/./include/linux/spinlock_api_smp.h:161 /usr/src/linux/kernel/locking/spinlock.c:191) efivar_entry_set_safe (/usr/src/linux/drivers/firmware/efi/vars.c:784) efi_pstore_write (/usr/src/linux/drivers/firmware/efi/efi-pstore.c:243) efi_pstore pstore_dump (/usr/src/linux/fs/pstore/platform.c:456) ? kmsg_dump (/usr/src/linux/kernel/printk/printk.c:3221) kmsg_dump (/usr/src/linux/kernel/printk/printk.c:3231 (discriminator 4)) oops_end (/usr/src/linux/arch/x86/kernel/dumpstack.c:348) do_trap (/usr/src/linux/arch/x86/kernel/traps.c:119 /usr/src/linux/arch/x86/kernel/traps.c:157) ? do_futex (/usr/src/linux/kernel/futex.c:3811) do_error_trap (/usr/src/linux/arch/x86/kernel/traps.c:83 /usr/src/linux/arch/x86/kernel/traps.c:178) ? do_futex (/usr/src/linux/kernel/futex.c:3811) ? do_futex (/usr/src/linux/kernel/futex.c:3811) exc_invalid_op (/usr/src/linux/arch/x86/kernel/traps.c:262) ? do_futex (/usr/src/linux/kernel/futex.c:3811) asm_exc_invalid_op (/usr/src/linux/./arch/x86/include/asm/idtentry.h:542) RIP: 0010:do_futex (/usr/src/linux/kernel/futex.c:3811) Code: 85 c0 75 4b c7 84 24 a8 00 00 00 ff ff ff ff 41 b8 ff ff ff ff 4c 89 e9 44 89 f2 44 89 e6 48 89 ef e8 d6 e0 ff ff 48 98 e9 62 ff ff 83 f8 08 74 61 83 f8 09 75 18 44 8b 84 24 a8 00 00 00 eb All code ========    0:    85 c0                    test   %eax,%eax    2:    75 4b                    jne    0x4f    4:    c7 84 24 a8 00 00 00     movl   $0xffffffff,0xa8(%rsp)    b:    ff ff ff ff    f:    41 b8 ff ff ff ff        mov    $0xffffffff,%r8d   15:    4c 89 e9                 mov    %r13,%rcx   18:    44 89 f2                 mov    %r14d,%edx   1b:    44 89 e6                 mov    %r12d,%esi   1e:    48 89 ef                 mov    %rbp,%rdi   21:    e8 d6 e0 ff ff           callq  0xffffffffffffe0fc   26:    48 98                    cltq   28:*    e9 62 ff ff ff           jmpq   0xffffffffffffff8f     <-- trapping instruction   2d:    83 f8 08                 cmp    $0x8,%eax   30:    74 61                    je     0x93   32:    83 f8 09                 cmp    $0x9,%eax   35:    75 18                    jne    0x4f   37:    44 8b 84 24 a8 00 00     mov    0xa8(%rsp),%r8d   3e:    00   3f:    eb                       .byte 0xeb Code starting with the faulting instruction ===========================================    0:    ff                       (bad)    1:    ff                       (bad)    2:    ff 83 f8 08 74 61        incl   0x617408f8(%rbx)    8:    83 f8 09                 cmp    $0x9,%eax    b:    75 18                    jne    0x25    d:    44 8b 84 24 a8 00 00     mov    0xa8(%rsp),%r8d   14:    00   15:    eb                       .byte 0xeb RSP: 0018:ffffc9000128fe08 EFLAGS: 00010282 RAX: 00000000ffffff92 RBX: 0000000000000000 RCX: 0000000000ae8b8c RDX: ffff8887fe8dde80 RSI: ffff8887fa562720 RDI: ffffc9000128fd10 RBP: 0000000057b01018 R08: 0000000000000000 R09: 0000000000000000 R10: 0000000000000001 R11: 0000000000000000 R12: 0000000000000000 R13: ffffc9000128fed0 R14: 0000000000000000 R15: 0000000000000000 ? do_futex (/usr/src/linux/kernel/futex.c:3811) ? lockdep_hardirqs_on_prepare (/usr/src/linux/kernel/locking/lockdep.c:3635 /usr/src/linux/kernel/locking/lockdep.c:3686) ? _raw_spin_unlock_irq (/usr/src/linux/./arch/x86/include/asm/paravirt.h:775 /usr/src/linux/./include/linux/spinlock_api_smp.h:168 /usr/src/linux/kernel/locking/spinlock.c:199) ? trace_hardirqs_on (/usr/src/linux/kernel/trace/trace_preemptirq.c:50 (discriminator 42)) ? _raw_spin_unlock_irq (/usr/src/linux/./arch/x86/include/asm/preempt.h:102 /usr/src/linux/./include/linux/spinlock_api_smp.h:169 /usr/src/linux/kernel/locking/spinlock.c:199) ? finish_task_switch (/usr/src/linux/./arch/x86/include/asm/jump_label.h:25 /usr/src/linux/kernel/sched/core.c:3103 /usr/src/linux/kernel/sched/core.c:3296) ? finish_task_switch (/usr/src/linux/kernel/sched/core.c:3163 /usr/src/linux/kernel/sched/core.c:3291) ? __switch_to (/usr/src/linux/./arch/x86/include/asm/paravirt.h:283 /usr/src/linux/arch/x86/kernel/process_64.c:225 /usr/src/linux/arch/x86/kernel/process_64.c:274 /usr/src/linux/arch/x86/kernel/process_64.c:283 /usr/src/linux/arch/x86/kernel/process_64.c:482) ? __switch_to_asm (/usr/src/linux/arch/x86/entry/entry_64.S:252) __ia32_sys_futex_time32 (/usr/src/linux/kernel/futex.c:4060 /usr/src/linux/kernel/futex.c:4034 /usr/src/linux/kernel/futex.c:4034) do_syscall_32_irqs_on (/usr/src/linux/arch/x86/entry/common.c:428) do_fast_syscall_32 (/usr/src/linux/arch/x86/entry/common.c:121 /usr/src/linux/arch/x86/entry/common.c:506) entry_SYSCALL_compat_after_hwframe (/usr/src/linux/arch/x86/entry/entry_64_compat.S:256) RIP: 0023:0xf7f06579 Code: Bad RIP value. objdump: '/tmp/tmp.a5phocvdOL.o': No such file Code starting with the faulting instruction =========================================== RSP: 002b:00000000be3faec0 EFLAGS: 00200282 ORIG_RAX: 00000000000000f0 RAX: ffffffffffffffda RBX: 0000000057b01018 RCX: 0000000000000089 RDX: 0000000000000000 RSI: 00000000be3faf90 RDI: 0000000000000000 RBP: 00000000ffffffff R08: 0000000000000000 R09: 0000000000000000 R10: 0000000000000000 R11: 0000000000000000 R12: 0000000000000000 R13: 0000000000000000 R14: 0000000000000000 R15: 0000000000000000 irq event stamp: 455331 hardirqs last enabled at (455331): do_error_trap (/usr/src/linux/./arch/x86/include/asm/paravirt.h:775 /usr/src/linux/arch/x86/kernel/traps.c:78 /usr/src/linux/arch/x86/kernel/traps.c:176) hardirqs last disabled at (455330): idtentry_enter_cond_rcu (/usr/src/linux/arch/x86/entry/common.c:652) softirqs last enabled at (454086): __do_softirq (/usr/src/linux/./arch/x86/include/asm/preempt.h:26 /usr/src/linux/kernel/softirq.c:320) softirqs last disabled at (454075): asm_call_on_stack (/usr/src/linux/arch/x86/entry/entry_64.S:719) ---[ end trace 87cc90f8d863ccc2 ]--- --  - Ilkka