You are not logged in.
- Topics: Active | Unanswered
#1 2015-11-18 10:54:23
- veggen
- Member
- Registered: 2013-01-29
- Posts: 12
What logs to check to diagnose a hard system freeze
Every once in a while, my computer hard freezes, to the point where not even REISUB works.
Seems like Chrome is always in focus when this happens, so I tried disabling hardware acceleration as a first step, but I'm using nouveau drivers, so this probably isn't it (still waiting to see if it reoccurs).
I'd like to know what logs to check for this kind of thing. I looked into journalctl, output attached below. Can someone please, please, take a look for anything suspicious? The freeze occurred between 9:32 and 9:36, and then I hard-rebooted. Is there some other place I might be able to look for clues?
I have a nVidia and Intel graphic cards, and my BIOS does not offer an option to disable nVidia, so I'm thinking of going the bbswitch route. But would rather gather some clues/evidence before I just go disabling stuff....
-- Logs begin at Sun 2015-10-25 19:56:37 CET, end at Wed 2015-11-18 11:56:45 CET. --
Nov 18 09:32:27 arch kernel: PM: Syncing filesystems ... done.
Nov 18 09:32:27 arch kernel: PM: Preparing system for sleep (mem)
Nov 18 09:32:27 arch kernel: Freezing user space processes ... (elapsed 0.002 seconds) done.
Nov 18 09:32:27 arch kernel: Freezing remaining freezable tasks ... (elapsed 0.001 seconds) done.
Nov 18 09:32:27 arch kernel: PM: Suspending system (mem)
Nov 18 09:32:27 arch kernel: Suspending console(s) (use no_console_suspend to debug)
Nov 18 09:32:27 arch kernel: sd 1:0:0:0: [sda] Synchronizing SCSI cache
Nov 18 09:32:27 arch kernel: e1000e: EEE TX LPI TIMER: 00000011
Nov 18 09:32:27 arch kernel: sd 1:0:0:0: [sda] Stopping disk
Nov 18 09:32:27 arch kernel: PM: suspend of devices complete after 301.052 msecs
Nov 18 09:32:27 arch kernel: PM: late suspend of devices complete after 19.992 msecs
Nov 18 09:32:27 arch kernel: ehci-pci 0000:00:1d.0: System wakeup enabled by ACPI
Nov 18 09:32:27 arch kernel: e1000e 0000:00:19.0: System wakeup enabled by ACPI
Nov 18 09:32:27 arch kernel: xhci_hcd 0000:00:14.0: System wakeup enabled by ACPI
Nov 18 09:32:27 arch kernel: PM: noirq suspend of devices complete after 38.519 msecs
Nov 18 09:32:27 arch kernel: ACPI: Preparing to enter system sleep state S3
Nov 18 09:32:27 arch kernel: ACPI : EC: EC stopped
Nov 18 09:32:27 arch kernel: PM: Saving platform NVS memory
Nov 18 09:32:27 arch kernel: Disabling non-boot CPUs ...
Nov 18 09:32:27 arch kernel: smpboot: CPU 1 is now offline
Nov 18 09:32:27 arch kernel: smpboot: CPU 2 is now offline
Nov 18 09:32:27 arch kernel: smpboot: CPU 3 is now offline
Nov 18 09:32:27 arch kernel: ACPI: Low-level resume complete
Nov 18 09:32:27 arch kernel: ACPI : EC: EC started
Nov 18 09:32:27 arch kernel: PM: Restoring platform NVS memory
Nov 18 09:32:27 arch kernel: Enabling non-boot CPUs ...
Nov 18 09:32:27 arch kernel: x86: Booting SMP configuration:
Nov 18 09:32:27 arch kernel: smpboot: Booting Node 0 Processor 1 APIC 0x2
Nov 18 09:32:27 arch kernel: cache: parent cpu1 should not be sleeping
Nov 18 09:32:27 arch kernel: CPU1 is up
Nov 18 09:32:27 arch kernel: smpboot: Booting Node 0 Processor 2 APIC 0x1
Nov 18 09:32:27 arch kernel: cache: parent cpu2 should not be sleeping
Nov 18 09:32:27 arch kernel: CPU2 is up
Nov 18 09:32:27 arch kernel: smpboot: Booting Node 0 Processor 3 APIC 0x3
Nov 18 09:32:27 arch kernel: cache: parent cpu3 should not be sleeping
Nov 18 09:32:27 arch kernel: CPU3 is up
Nov 18 09:32:27 arch kernel: ACPI: Waking up from system sleep state S3
Nov 18 09:32:27 arch kernel: ehci-pci 0000:00:1d.0: System wakeup disabled by ACPI
Nov 18 09:32:27 arch kernel: xhci_hcd 0000:00:14.0: System wakeup disabled by ACPI
Nov 18 09:32:27 arch kernel: PM: noirq resume of devices complete after 136.828 msecs
Nov 18 09:32:27 arch kernel: PM: early resume of devices complete after 18.775 msecs
Nov 18 09:32:27 arch kernel: usb usb2: root hub lost power or was reset
Nov 18 09:32:27 arch kernel: usb usb3: root hub lost power or was reset
Nov 18 09:32:27 arch kernel: sd 1:0:0:0: [sda] Starting disk
Nov 18 09:32:27 arch kernel: e1000e 0000:00:19.0: System wakeup disabled by ACPI
Nov 18 09:32:27 arch kernel: rtc_cmos 00:01: System wakeup disabled by ACPI
Nov 18 09:32:27 arch kernel: usb 1-1: reset high-speed USB device number 2 using ehci-pci
Nov 18 09:32:27 arch kernel: ata2: SATA link up 6.0 Gbps (SStatus 133 SControl 300)
Nov 18 09:32:27 arch kernel: ata2.00: configured for UDMA/133
Nov 18 09:32:27 arch kernel: ata1: SATA link down (SStatus 0 SControl 300)
Nov 18 09:32:27 arch kernel: usb 2-8: reset high-speed USB device number 2 using xhci_hcd
Nov 18 09:32:27 arch kernel: usb 2-8: device firmware changed
Nov 18 09:32:27 arch kernel: usb 1-1.6: reset high-speed USB device number 4 using ehci-pci
Nov 18 09:32:27 arch kernel: usb 1-1.7: reset full-speed USB device number 5 using ehci-pci
Nov 18 09:32:27 arch kernel: usb 1-1.3: reset full-speed USB device number 3 using ehci-pci
Nov 18 09:32:27 arch kernel: PM: resume of devices complete after 1016.199 msecs
Nov 18 09:32:27 arch kernel: PM: Finishing wakeup.
Nov 18 09:32:27 arch kernel: Restarting tasks ...
Nov 18 09:32:27 arch kernel: usb 2-8: USB disconnect, device number 2
Nov 18 09:32:27 arch kernel: cdc_mbim 2-8:2.12 wwp0s20u8c2i12: unregister 'cdc_mbim' usb-0000:00:14.0-8, CDC MBIM
Nov 18 09:32:27 arch systemd[1]: Time has been changed
Nov 18 09:32:27 arch kernel: done.
Nov 18 09:32:27 arch kernel: pci_bus 0000:01: Allocating resources
Nov 18 09:32:27 arch kernel: Bluetooth: hci0: read Intel version: 370810011003110e00
Nov 18 09:32:27 arch kernel: Bluetooth: hci0: Intel Bluetooth firmware file: intel/ibt-hw-37.8.10-fw-1.10.3.11.e.bseq
Nov 18 09:32:27 arch ntpd[284]: Deleting interface #9 wlp2s0, 172.20.10.4#123, interface stats: received=70, sent=74, dropped=0, active_time=17079 secs
Nov 18 09:32:27 arch systemd-logind[266]: Lid opened.
Nov 18 09:32:27 arch ntpd[284]: 193.204.114.233 local addr 172.20.10.4 -> <null>
Nov 18 09:32:27 arch systemd[425]: Time has been changed
Nov 18 09:32:27 arch ntpd[284]: 212.45.144.3 local addr 172.20.10.4 -> <null>
Nov 18 09:32:27 arch systemd[1]: Starting Update man-db cache...
Nov 18 09:32:27 arch ntpd[284]: 85.18.189.242 local addr 172.20.10.4 -> <null>
Nov 18 09:32:27 arch systemd[1]: Starting Rotate log files...
Nov 18 09:32:27 arch ntpd[284]: 146.48.81.102 local addr 172.20.10.4 -> <null>
Nov 18 09:32:27 arch systemd[1]: Starting Update locate database...
Nov 18 09:32:27 arch ntpd[284]: Deleting interface #10 wlp2s0, fe80::de53:60ff:fe3a:707d%3#123, interface stats: received=0, sent=0, dropped=0, active_time=17079 secs
Nov 18 09:32:27 arch systemd[1]: Starting Verify integrity of password and group files...
Nov 18 09:32:27 arch ntpd[284]: Deleting interface #11 vpn0, 192.168.50.195#123, interface stats: received=0, sent=0, dropped=0, active_time=14241 secs
Nov 18 09:32:27 arch kernel: pcieport 0000:00:1c.0: bridge window [io 0x1000-0x0fff] to [bus 01] add_size 1000
Nov 18 09:32:27 arch kernel: pcieport 0000:00:1c.0: bridge window [mem 0x00100000-0x000fffff 64bit pref] to [bus 01] add_size 200000 add_align 100000
Nov 18 09:32:27 arch kernel: pci_bus 0000:02: Allocating resources
Nov 18 09:32:27 arch kernel: pcieport 0000:00:1c.3: bridge window [io 0x1000-0x0fff] to [bus 02] add_size 1000
Nov 18 09:32:27 arch kernel: pcieport 0000:00:1c.3: bridge window [mem 0x00100000-0x000fffff 64bit pref] to [bus 02] add_size 200000 add_align 100000
Nov 18 09:32:27 arch kernel: pci_bus 0000:03: Allocating resources
Nov 18 09:32:27 arch kernel: i915 0000:00:02.0: BAR 6: [??? 0x00000000 flags 0x2] has bogus alignment
Nov 18 09:32:27 arch kernel: pcieport 0000:00:1c.0: res[15]=[mem 0x00100000-0x000fffff 64bit pref] res_to_dev_res add_size 200000 min_align 100000
Nov 18 09:32:27 arch kernel: pcieport 0000:00:1c.0: res[15]=[mem 0x00100000-0x002fffff 64bit pref] res_to_dev_res add_size 200000 min_align 100000
Nov 18 09:32:27 arch kernel: pcieport 0000:00:1c.3: res[15]=[mem 0x00100000-0x000fffff 64bit pref] res_to_dev_res add_size 200000 min_align 100000
Nov 18 09:32:27 arch kernel: pcieport 0000:00:1c.3: res[15]=[mem 0x00100000-0x002fffff 64bit pref] res_to_dev_res add_size 200000 min_align 100000
Nov 18 09:32:27 arch kernel: pcieport 0000:00:1c.0: res[13]=[io 0x1000-0x0fff] res_to_dev_res add_size 1000 min_align 1000
Nov 18 09:32:27 arch kernel: pcieport 0000:00:1c.0: res[13]=[io 0x1000-0x1fff] res_to_dev_res add_size 1000 min_align 1000
Nov 18 09:32:27 arch kernel: pcieport 0000:00:1c.3: res[13]=[io 0x1000-0x0fff] res_to_dev_res add_size 1000 min_align 1000
Nov 18 09:32:27 arch kernel: pcieport 0000:00:1c.3: res[13]=[io 0x1000-0x1fff] res_to_dev_res add_size 1000 min_align 1000
Nov 18 09:32:27 arch kernel: pcieport 0000:00:1c.0: BAR 15: assigned [mem 0xcf800000-0xcf9fffff 64bit pref]
Nov 18 09:32:27 arch kernel: pcieport 0000:00:1c.3: BAR 15: assigned [mem 0xcfa00000-0xcfbfffff 64bit pref]
Nov 18 09:32:27 arch kernel: pcieport 0000:00:1c.0: BAR 13: assigned [io 0x2000-0x2fff]
Nov 18 09:32:27 arch kernel: pcieport 0000:00:1c.3: BAR 13: assigned [io 0x3000-0x3fff]
Nov 18 09:32:27 arch kernel: pci_bus 0000:01: Allocating resources
Nov 18 09:32:27 arch systemd[1]: Starting Load/Save RF Kill Switch Status...
Nov 18 09:32:27 arch NetworkManager[261]: <info> WiFi now disabled by radio killswitch
Nov 18 09:32:27 arch systemd-rfkill[18813]: Failed to open device: No such device
Nov 18 09:32:27 arch NetworkManager[261]: <info> WWAN now disabled by radio killswitch
Nov 18 09:32:27 arch kernel: pci_bus 0000:02: Allocating resources
Nov 18 09:32:27 arch kernel: pci_bus 0000:03: Allocating resources
Nov 18 09:32:27 arch kernel: i915 0000:00:02.0: BAR 6: [??? 0x00000000 flags 0x2] has bogus alignment
Nov 18 09:32:27 arch systemd[1]: Started Load/Save RF Kill Switch Status.
Nov 18 09:32:27 arch systemd[1]: Started Rotate log files.
Nov 18 09:32:27 arch kernel: i915 0000:00:02.0: BAR 6: [??? 0x00000000 flags 0x2] has bogus alignment
Nov 18 09:32:27 arch kernel: i915 0000:00:02.0: BAR 6: [??? 0x00000000 flags 0x2] has bogus alignment
Nov 18 09:32:27 arch kernel: i915 0000:00:02.0: BAR 6: [??? 0x00000000 flags 0x2] has bogus alignment
Nov 18 09:32:27 arch systemd[1]: bluetooth.target: Unit not needed anymore. Stopping.
Nov 18 09:32:27 arch systemd[1]: Stopped target Bluetooth.
Nov 18 09:32:27 arch kernel: pci_bus 0000:01: Allocating resources
Nov 18 09:32:27 arch kernel: pci_bus 0000:02: Allocating resources
Nov 18 09:32:27 arch kernel: pci_bus 0000:03: Allocating resources
Nov 18 09:32:27 arch kernel: i915 0000:00:02.0: BAR 6: [??? 0x00000000 flags 0x2] has bogus alignment
Nov 18 09:32:27 arch systemd-sleep[18684]: System resumed.
Nov 18 09:32:27 arch systemd[1]: Started Suspend.
Nov 18 09:32:27 arch systemd[1]: sleep.target: Unit not needed anymore. Stopping.
Nov 18 09:32:27 arch systemd[1]: Stopped target Sleep.
Nov 18 09:32:27 arch systemd[1]: Reached target Suspend.
Nov 18 09:32:27 arch systemd-logind[266]: Operation finished.
Nov 18 09:32:27 arch systemd[1]: suspend.target: Unit is bound to inactive unit systemd-suspend.service. Stopping, too.
Nov 18 09:32:27 arch NetworkManager[261]: <info> wake requested (sleeping: yes enabled: yes)
Nov 18 09:32:27 arch systemd[1]: Stopped target Suspend.
Nov 18 09:32:27 arch NetworkManager[261]: <info> waking up...
Nov 18 09:32:27 arch systemd[1]: Started Local system resume actions.
Nov 18 09:32:27 arch NetworkManager[261]: <info> (eno1): device state change: unavailable -> unmanaged (reason 'sleeping') [20 10 37]
Nov 18 09:32:27 arch kernel: i915 0000:00:02.0: BAR 6: [??? 0x00000000 flags 0x2] has bogus alignment
Nov 18 09:32:27 arch kernel: i915 0000:00:02.0: BAR 6: [??? 0x00000000 flags 0x2] has bogus alignment
Nov 18 09:32:27 arch kernel: i915 0000:00:02.0: BAR 6: [??? 0x00000000 flags 0x2] has bogus alignment
Nov 18 09:32:27 arch kernel: i915 0000:00:02.0: BAR 6: [??? 0x00000000 flags 0x2] has bogus alignment
Nov 18 09:32:27 arch kernel: i915 0000:00:02.0: BAR 6: [??? 0x00000000 flags 0x2] has bogus alignment
Nov 18 09:32:27 arch kernel: i915 0000:00:02.0: BAR 6: [??? 0x00000000 flags 0x2] has bogus alignment
Nov 18 09:32:27 arch kernel: acpi PNP0401:00: Already enumerated
Nov 18 09:32:27 arch kernel: acpi PNP0501:00: Still not present
Nov 18 09:32:27 arch kernel: i915 0000:00:02.0: BAR 6: [??? 0x00000000 flags 0x2] has bogus alignment
Nov 18 09:32:27 arch kernel: iwlwifi 0000:02:00.0: RF_KILL bit toggled to enable radio.
Nov 18 09:32:27 arch kernel: usb 2-8: new high-speed USB device number 3 using xhci_hcd
Nov 18 09:32:27 arch kernel: e1000e: eno1 NIC Link is Down
Nov 18 09:32:27 arch NetworkManager[261]: <info> (wlp2s0): device state change: unmanaged -> unavailable (reason 'managed') [10 20 2]
Nov 18 09:32:27 arch kernel: IPv6: ADDRCONF(NETDEV_UP): wlp2s0: link is not ready
Nov 18 09:32:27 arch kernel: IPv6: ADDRCONF(NETDEV_UP): eno1: link is not ready
Nov 18 09:32:27 arch NetworkManager[261]: <info> (eno1): device state change: unmanaged -> unavailable (reason 'managed') [10 20 2]
Nov 18 09:32:27 arch systemd[1]: Started Verify integrity of password and group files.
Nov 18 09:32:27 arch kernel: Bluetooth: hci0: Intel Bluetooth firmware patch completed and activated
Nov 18 09:32:27 arch kernel: usb 2-8: config 1 interface 0 altsetting 0 bulk endpoint 0x1 has invalid maxpacket 64
Nov 18 09:32:27 arch kernel: usb 2-8: config 1 interface 0 altsetting 0 bulk endpoint 0x81 has invalid maxpacket 64
Nov 18 09:32:27 arch kernel: usb 2-8: USB disconnect, device number 3
Nov 18 09:32:27 arch NetworkManager[261]: <info> NetworkManager state is now DISCONNECTED
Nov 18 09:32:27 arch kernel: IPv6: ADDRCONF(NETDEV_UP): eno1: link is not ready
Nov 18 09:32:27 arch kernel: iwlwifi 0000:02:00.0: L1 Enabled - LTR Enabled
Nov 18 09:32:27 arch NetworkManager[261]: <info> WiFi now enabled by radio killswitch
Nov 18 09:32:27 arch kernel: iwlwifi 0000:02:00.0: L1 Enabled - LTR Enabled
Nov 18 09:32:28 arch kernel: iwlwifi 0000:02:00.0: L1 Enabled - LTR Enabled
Nov 18 09:32:28 arch kernel: iwlwifi 0000:02:00.0: L1 Enabled - LTR Enabled
Nov 18 09:32:28 arch kernel: IPv6: ADDRCONF(NETDEV_UP): wlp2s0: link is not ready
Nov 18 09:32:28 arch NetworkManager[261]: <info> WWAN now enabled by radio killswitch
Nov 18 09:32:28 arch NetworkManager[261]: <info> (wlp2s0) supports 5 scan SSIDs
Nov 18 09:32:28 arch NetworkManager[261]: <info> (wlp2s0): supplicant interface state: starting -> ready
Nov 18 09:32:28 arch NetworkManager[261]: <info> (wlp2s0): device state change: unavailable -> disconnected (reason 'supplicant-available') [20 30 42]
Nov 18 09:32:28 arch kernel: IPv6: ADDRCONF(NETDEV_UP): wlp2s0: link is not ready
Nov 18 09:32:28 arch systemd[1]: Started Update locate database.
Nov 18 09:32:31 arch NetworkManager[261]: <info> (wlp2s0): supplicant interface state: ready -> inactive
Nov 18 09:32:32 arch systemd[1]: Started Update man-db cache.
Nov 18 09:32:38 arch kernel: usb 2-8: new high-speed USB device number 4 using xhci_hcd
Nov 18 09:32:38 arch kernel: usb 2-8: config 1 has an invalid interface number: 8 but max is 3
Nov 18 09:32:38 arch kernel: usb 2-8: config 1 has no interface number 1
Nov 18 09:32:38 arch kernel: usb 2-8: config 2 has an invalid interface number: 12 but max is 1
Nov 18 09:32:38 arch kernel: usb 2-8: config 2 has an invalid interface number: 13 but max is 1
Nov 18 09:32:38 arch kernel: usb 2-8: config 2 has an invalid interface number: 13 but max is 1
Nov 18 09:32:38 arch kernel: usb 2-8: config 2 has no interface number 0
Nov 18 09:32:38 arch kernel: usb 2-8: config 2 has no interface number 1
Nov 18 09:32:38 arch kernel: cdc_mbim 2-8:2.12: cdc-wdm0: USB WDM device
Nov 18 09:32:38 arch kernel: cdc_mbim 2-8:2.12 wwan0: register 'cdc_mbim' at usb-0000:00:14.0-8, CDC MBIM, 5e:d2:b0:f4:06:5b
Nov 18 09:32:38 arch kernel: cdc_mbim 2-8:2.12 wwp0s20u8c2i12: renamed from wwan0
Nov 18 09:33:28 arch NetworkManager[261]: <info> (wlp2s0): supplicant interface state: inactive -> scanning
Nov 18 09:35:25 arch NetworkManager[261]: <info> VPN service 'openconnect' disappeared
Nov 18 09:36:07 arch NetworkManager[261]: <info> Auto-activating connection 'iPhone di Marco Santarelli'.
Nov 18 09:36:07 arch NetworkManager[261]: <info> (wlp2s0): Activation: starting connection 'iPhone di Marco Santarelli' (f391367a-a22f-4f46-b3c4-d5a6c7a3b493)
Nov 18 09:36:07 arch NetworkManager[261]: <info> (wlp2s0): device state change: disconnected -> prepare (reason 'none') [30 40 0]
Nov 18 09:36:07 arch NetworkManager[261]: <info> NetworkManager state is now CONNECTING
Nov 18 09:36:07 arch NetworkManager[261]: <info> (wlp2s0): device state change: prepare -> config (reason 'none') [40 50 0]
Nov 18 09:36:07 arch NetworkManager[261]: <info> (wlp2s0): Activation: (wifi) access point 'iPhone di Marco Santarelli' has security, but secrets are required.
Nov 18 09:36:07 arch NetworkManager[261]: <info> (wlp2s0): device state change: config -> need-auth (reason 'none') [50 60 0]
Nov 18 09:36:07 arch NetworkManager[261]: <warn> Failed to GDBus.Error:fi.w1.wpa_supplicant1.NotConnected: This interface is not connected: disconnect.
Nov 18 09:36:07 arch NetworkManager[261]: <info> (wlp2s0): device state change: need-auth -> prepare (reason 'none') [60 40 0]
Nov 18 09:36:07 arch NetworkManager[261]: <info> (wlp2s0): device state change: prepare -> config (reason 'none') [40 50 0]
Nov 18 09:36:07 arch NetworkManager[261]: <info> (wlp2s0): Activation: (wifi) connection 'iPhone di Marco Santarelli' has security, and secrets exist. No new secrets needed.
Nov 18 09:36:07 arch NetworkManager[261]: <info> Config: added 'ssid' value 'iPhone di Marco Santarelli'
Nov 18 09:36:07 arch NetworkManager[261]: <info> Config: added 'scan_ssid' value '1'
Nov 18 09:36:07 arch NetworkManager[261]: <info> Config: added 'key_mgmt' value 'WPA-PSK'
Nov 18 09:36:07 arch NetworkManager[261]: <info> Config: added 'auth_alg' value 'OPEN'
Nov 18 09:36:07 arch NetworkManager[261]: <info> Config: added 'psk' value '<omitted>'
Nov 18 09:36:07 arch NetworkManager[261]: <warn> Failed to GDBus.Error:fi.w1.wpa_supplicant1.NotConnected: This interface is not connected: disconnect.
Nov 18 09:36:07 arch NetworkManager[261]: <info> Config: set interface ap_scan to 1
Nov 18 09:36:07 arch kernel: wlp2s0: authenticate with 7a:a3:e4:62:dd:d9
Nov 18 09:36:07 arch NetworkManager[261]: <info> (wlp2s0): supplicant interface state: scanning -> authenticating
Nov 18 09:36:07 arch kernel: wlp2s0: send auth to 7a:a3:e4:62:dd:d9 (try 1/3)
Nov 18 09:36:07 arch kernel: wlp2s0: authenticated
Nov 18 09:36:07 arch kernel: wlp2s0: associate with 7a:a3:e4:62:dd:d9 (try 1/3)
Nov 18 09:36:07 arch kernel: wlp2s0: RX AssocResp from 7a:a3:e4:62:dd:d9 (capab=0x411 status=0 aid=3)
Nov 18 09:36:07 arch NetworkManager[261]: <info> (wlp2s0): supplicant interface state: authenticating -> associating
Nov 18 09:36:07 arch kernel: wlp2s0: associated
Nov 18 09:36:07 arch kernel: IPv6: ADDRCONF(NETDEV_CHANGE): wlp2s0: link becomes ready
Nov 18 09:36:07 arch NetworkManager[261]: <info> (wlp2s0): supplicant interface state: associating -> associated
Nov 18 09:36:07 arch NetworkManager[261]: <info> (wlp2s0): supplicant interface state: associated -> 4-way handshake
Nov 18 09:36:07 arch NetworkManager[261]: <info> (wlp2s0): supplicant interface state: 4-way handshake -> completed
Nov 18 09:36:07 arch NetworkManager[261]: <info> (wlp2s0): Activation: (wifi) Stage 2 of 5 (Device Configure) successful. Connected to wireless network 'iPhone di Marco Santarelli'.
Nov 18 09:36:07 arch NetworkManager[261]: <info> (wlp2s0): device state change: config -> ip-config (reason 'none') [50 70 0]
Nov 18 09:36:07 arch NetworkManager[261]: <info> Activation (wlp2s0) Beginning DHCPv4 transaction (timeout in 45 seconds)
Nov 18 09:36:07 arch NetworkManager[261]: <info> dhclient started with pid 18905
Nov 18 09:36:07 arch dhclient[18905]: DHCPREQUEST on wlp2s0 to 255.255.255.255 port 67
Nov 18 09:36:07 arch dhclient[18905]: DHCPACK from 172.20.10.1
Nov 18 09:36:07 arch NetworkManager[261]: <info> address 172.20.10.4
Nov 18 09:36:07 arch NetworkManager[261]: <info> plen 28 (255.255.255.240)
Nov 18 09:36:07 arch NetworkManager[261]: <info> gateway 172.20.10.1
Nov 18 09:36:07 arch NetworkManager[261]: <info> server identifier 172.20.10.1
Nov 18 09:36:07 arch NetworkManager[261]: <info> lease time 85536
Nov 18 09:36:07 arch NetworkManager[261]: <info> nameserver '172.20.10.1'
Nov 18 09:36:07 arch NetworkManager[261]: <info> (wlp2s0): DHCPv4 state changed unknown -> bound
Nov 18 09:36:07 arch avahi-daemon[260]: Joining mDNS multicast group on interface wlp2s0.IPv4 with address 172.20.10.4.
Nov 18 09:36:07 arch avahi-daemon[260]: New relevant interface wlp2s0.IPv4 for mDNS.
Nov 18 09:36:07 arch avahi-daemon[260]: Registering new address record for 172.20.10.4 on wlp2s0.IPv4.
Nov 18 09:36:07 arch NetworkManager[261]: <info> (wlp2s0): device state change: ip-config -> ip-check (reason 'none') [70 80 0]
Nov 18 09:36:07 arch NetworkManager[261]: <info> (wlp2s0): device state change: ip-check -> secondaries (reason 'none') [80 90 0]
Nov 18 09:36:07 arch NetworkManager[261]: <info> (wlp2s0): device state change: secondaries -> activated (reason 'none') [90 100 0]
Nov 18 09:36:07 arch NetworkManager[261]: <info> NetworkManager state is now CONNECTED_LOCAL
Nov 18 09:36:07 arch dhclient[18905]: bound to 172.20.10.4 -- renewal in 39183 seconds.
Nov 18 09:36:08 arch NetworkManager[261]: <info> NetworkManager state is now CONNECTED_GLOBAL
Nov 18 09:36:08 arch NetworkManager[261]: <info> Policy set 'iPhone di Marco Santarelli' (wlp2s0) as default for IPv4 routing and DNS.
Nov 18 09:36:08 arch NetworkManager[261]: <info> Writing DNS information to /usr/bin/resolvconf
Nov 18 09:36:08 arch NetworkManager[261]: <info> (wlp2s0): Activation: successful, device activated.
Nov 18 09:36:08 arch dbus[263]: [system] Activating via systemd: service name='org.freedesktop.nm_dispatcher' unit='dbus-org.freedesktop.nm-dispatcher.service'
Nov 18 09:36:08 arch systemd[1]: Starting Network Manager Script Dispatcher Service...
Nov 18 09:36:08 arch dbus[263]: [system] Successfully activated service 'org.freedesktop.nm_dispatcher'
Nov 18 09:36:08 arch systemd[1]: Started Network Manager Script Dispatcher Service.
Nov 18 09:36:09 arch avahi-daemon[260]: Joining mDNS multicast group on interface wlp2s0.IPv6 with address fe80::de53:60ff:fe3a:707d.
Nov 18 09:36:09 arch avahi-daemon[260]: New relevant interface wlp2s0.IPv6 for mDNS.
Nov 18 09:36:09 arch avahi-daemon[260]: Registering new address record for fe80::de53:60ff:fe3a:707d on wlp2s0.*.
Nov 18 09:36:10 arch ntpd[284]: Listen normally on 12 wlp2s0 172.20.10.4:123
Nov 18 09:36:10 arch ntpd[284]: Listen normally on 13 wlp2s0 [fe80::de53:60ff:fe3a:707d%3]:123
Nov 18 09:36:10 arch ntpd[284]: new interface(s) found: waking up resolver
-- Reboot --
Nov 18 09:57:50 arch systemd-journald[156]: Runtime journal (/run/log/journal/) is currently using 8.0M.
Maximum allowed usage is set to 797.0M.
Leaving at least 1.1G free (of currently available 7.7G of space).
Enforced usage limit is thus 797.0M, of which 789.0M are still available.
Nov 18 09:57:50 arch systemd-journald[156]: System journal (/var/log/journal/) is currently using 48.0M.
Maximum allowed usage is set to 4.0G.
Leaving at least 4.0G free (of currently available 161.7G of space).
Enforced usage limit is thus 4.0G, of which 3.9G are still available.
Nov 18 09:57:50 arch systemd-journald[156]: Time spent on flushing to /var is 40.828ms for 2 entries.
Nov 18 09:57:50 arch kernel: Initializing cgroup subsys cpuset
Nov 18 09:57:50 arch kernel: Initializing cgroup subsys cpu
Nov 18 09:57:50 arch kernel: Initializing cgroup subsys cpuacct
Nov 18 09:57:50 arch kernel: Linux version 4.2.5-1-ARCH (builduser@tobias) (gcc version 5.2.0 (GCC) ) #1 SMP PREEMPT Tue Oct 27 08:13:28 CET 2015
Nov 18 09:57:50 arch kernel: Command line: BOOT_IMAGE=../vmlinuz-linux root=/dev/sda4 rw initrd=../initramfs-linux.img
Nov 18 09:57:50 arch kernel: x86/fpu: xstate_offset[2]: 0240, xstate_sizes[2]: 0100
Nov 18 09:57:50 arch kernel: x86/fpu: Supporting XSAVE feature 0x01: 'x87 floating point registers'
Nov 18 09:57:50 arch kernel: x86/fpu: Supporting XSAVE feature 0x02: 'SSE registers'
Nov 18 09:57:50 arch kernel: x86/fpu: Supporting XSAVE feature 0x04: 'AVX registers'
Nov 18 09:57:50 arch kernel: x86/fpu: Enabled xstate features 0x7, context size is 0x340 bytes, using 'standard' format.
Nov 18 09:57:50 arch kernel: x86/fpu: Using 'eager' FPU context switches.
Nov 18 09:57:50 arch kernel: e820: BIOS-provided physical RAM map:
Nov 18 09:57:50 arch kernel: BIOS-e820: [mem 0x0000000000000000-0x00000000000913ff] usable
Nov 18 09:57:50 arch kernel: BIOS-e820: [mem 0x0000000000091400-0x000000000009ffff] reserved
Nov 18 09:57:50 arch kernel: BIOS-e820: [mem 0x00000000000e0000-0x00000000000fffff] reserved
Nov 18 09:57:50 arch kernel: BIOS-e820: [mem 0x0000000000100000-0x00000000ad201fff] usable
Nov 18 09:57:50 arch kernel: BIOS-e820: [mem 0x00000000ad202000-0x00000000ad688fff] reserved
Nov 18 09:57:50 arch kernel: BIOS-e820: [mem 0x00000000ad689000-0x00000000ca58efff] usable
Nov 18 09:57:50 arch kernel: BIOS-e820: [mem 0x00000000ca58f000-0x00000000ca6c8fff] reserved
Nov 18 09:57:50 arch kernel: BIOS-e820: [mem 0x00000000ca6c9000-0x00000000ca6fbfff] ACPI data
Nov 18 09:57:50 arch kernel: BIOS-e820: [mem 0x00000000ca6fc000-0x00000000caeb4fff] usable
Nov 18 09:57:50 arch kernel: BIOS-e820: [mem 0x00000000caeb5000-0x00000000cb634fff] ACPI NVS
Nov 18 09:57:50 arch kernel: BIOS-e820: [mem 0x00000000cb635000-0x00000000cbafefff] reserved
Nov 18 09:57:50 arch kernel: BIOS-e820: [mem 0x00000000cbaff000-0x00000000cbafffff] usable
Nov 18 09:57:50 arch kernel: BIOS-e820: [mem 0x00000000cd000000-0x00000000cf7fffff] reserved
Nov 18 09:57:50 arch kernel: BIOS-e820: [mem 0x00000000f8000000-0x00000000fbffffff] reserved
Nov 18 09:57:50 arch kernel: BIOS-e820: [mem 0x00000000fec00000-0x00000000fec00fff] reserved
Nov 18 09:57:50 arch kernel: BIOS-e820: [mem 0x00000000fed00000-0x00000000fed03fff] reserved
Nov 18 09:57:50 arch kernel: BIOS-e820: [mem 0x00000000fed1c000-0x00000000fed1ffff] reserved
Nov 18 09:57:50 arch kernel: BIOS-e820: [mem 0x00000000fee00000-0x00000000fee00fff] reserved
Nov 18 09:57:50 arch kernel: BIOS-e820: [mem 0x00000000ff000000-0x00000000ffffffff] reserved
Nov 18 09:57:50 arch kernel: BIOS-e820: [mem 0x0000000100000000-0x000000042e7fffff] usable
Nov 18 09:57:50 arch kernel: NX (Execute Disable) protection: activeLast edited by veggen (2015-11-18 11:10:58)
Offline
#2 2015-11-18 15:34:36
- ewaller
- Administrator
- From: Pasadena, CA
- Registered: 2009-07-13
- Posts: 19,779
Re: What logs to check to diagnose a hard system freeze
Well, this is troubling:
Nov 18 09:32:27 arch systemd-sleep[18684]: System resumed.
Nov 18 09:32:27 arch systemd[1]: Started Suspend.
Nov 18 09:32:27 arch systemd[1]: sleep.target: Unit not needed anymore. Stopping.
Nov 18 09:32:27 arch systemd[1]: Stopped target Sleep.
Nov 18 09:32:27 arch systemd[1]: Reached target Suspend.
Nov 18 09:32:27 arch systemd-logind[266]: Operation finished.
Nov 18 09:32:27 arch systemd[1]: suspend.target: Unit is bound to inactive unit systemd-suspend.service. Stopping, too.
Nov 18 09:32:27 arch NetworkManager[261]: <info> wake requested (sleeping: yes enabled: yes)
Nov 18 09:32:27 arch systemd[1]: Stopped target Suspend.
Nov 18 09:32:27 arch NetworkManager[261]: <info> waking up...
Nov 18 09:32:27 arch systemd[1]: Started Local system resume actions.
Nov 18 09:32:27 arch NetworkManager[261]: <info> (eno1): device state change: unavailable -> unmanaged (reason 'sleeping') [20 10 37]Why did your system go to sleep?
Does sleeping and waking function properly on your machine when you want it to?
What desktop environment are you using? Is a DE doing something silly?
Nothing is too wonderful to be true, if it be consistent with the laws of nature -- Michael Faraday
Sometimes it is the people no one can imagine anything of who do the things no one can imagine. -- Alan Turing
---
How to Ask Questions the Smart Way
Offline
#3 2015-11-19 00:45:08
- veggen
- Member
- Registered: 2013-01-29
- Posts: 12
Re: What logs to check to diagnose a hard system freeze
I was wondering about that section as well... Yeah, sleep and resume work normally when I use them (through systemctl). DE is Openbox. Haven't experienced anything strange apart from these freezes.
Offline