Arch Linux

jdi

Member

Registered: 2014-01-03

Posts: 1

Sony Vaio 13 Pro wakes a few seconds after suspend or poweroff

Hello eveyone,

Like the subject says on my Vaio 13 Pro, after I suspend (button, lid, systemctl suspend, pm-suspend) or power off, after a few seconds (~5) the laptop wakes up again.
I ruled out a HW issue since I power it off by keeping the power button pressed for 5 secs. (and it worked on Win8)
I updated the BIOS to the latest verion as well. (and nothing in the BIOS I can tell wakes it up).

I've tried:

• pm-utils

• s2ram

• adding SUSPEND_MODULES="$SUSPEND_MODULES uhci_hd ehci_hd iwlwifi usbhid hid_multitouch hid nfc mac80211 iwlmvm psmouse sony_laptop ehci_pci echi_hcd xhci_hcd btusb usbhid usbcore usb_common"
  to /etc/pm/config.d/modules (and I didn't forget to make the script executable)

• echoed 'disabled' in every file named 'wakeup' in /sys/devices

I did  my arch install using ArchBang, but I setup myself the bootloader to use gummiboot, since neither grub nor syslinux was working (both from the archbang menu and manual install from the instructions on the arch wiki).

Can anybody help me debug this?

Thank you very much for your time , suspending is a very important feature to my daily workflow

P.S. I'll include dmesg, journalctl and /var/log/pm-suspend.log for a suspend. Let me know if you need anything else more.

dmesg:

[12883.698507] ACPI Error: No installed handler for fixed event - PowerButton (2), disabling (20130725/evevent-286)
[12883.701333] wlp1s0: deauthenticating from 48:f8:b3:06:cc:9b by local choice (reason=3)
[12883.703853] cfg80211: Calling CRDA to update world regulatory domain
[12883.829892] PM: Syncing filesystems ... done.
[12883.866083] PM: Preparing system for mem sleep
[12883.866289] Freezing user space processes ... (elapsed 0.001 seconds) done.
[12883.867560] Freezing remaining freezable tasks ... (elapsed 0.001 seconds) done.
[12883.868680] PM: Entering mem sleep
[12883.868701] Suspending console(s) (use no_console_suspend to debug)
[12883.869063] sd 3:0:0:0: [sda] Synchronizing SCSI cache
[12883.876428] sd 3:0:0:0: [sda] Stopping disk
[12883.904361] mei_me 0000:00:16.0: suspend
[12883.904385] Removing pn544
[12884.997411] PM: suspend of devices complete after 1129.106 msecs
[12884.997572] PM: late suspend of devices complete after 0.159 msecs
[12885.010790] ehci-pci 0000:00:1d.0: System wakeup enabled by ACPI
[12885.037350] xhci_hcd 0000:00:14.0: System wakeup enabled by ACPI
[12885.050904] PM: noirq suspend of devices complete after 53.359 msecs
[12885.051160] ACPI: Preparing to enter system sleep state S3
[12885.051426] PM: Saving platform NVS memory
[12885.051467] Disabling non-boot CPUs ...
[12885.153924] smpboot: CPU 1 is now offline
[12885.257197] smpboot: CPU 2 is now offline
[12885.360479] smpboot: CPU 3 is now offline
[12885.362020] ACPI: Low-level resume complete
[12885.362082] PM: Restoring platform NVS memory
[12885.362488] Enabling non-boot CPUs ...
[12885.362527] smpboot: Booting Node 0 Processor 1 APIC 0x2
[12885.376999] Intel pstate controlling: cpu 1
[12885.377047] CPU1 is up
[12885.377067] smpboot: Booting Node 0 Processor 2 APIC 0x1
[12885.391440] Intel pstate controlling: cpu 2
[12885.391475] CPU2 is up
[12885.391489] smpboot: Booting Node 0 Processor 3 APIC 0x3
[12885.405843] Intel pstate controlling: cpu 3
[12885.405874] CPU3 is up
[12885.412273] ACPI: Waking up from system sleep state S3
[12885.452240] xhci_hcd 0000:00:14.0: System wakeup disabled by ACPI
[12885.492225] ehci-pci 0000:00:1d.0: System wakeup disabled by ACPI
[12885.519017] PM: noirq resume of devices complete after 105.902 msecs
[12885.519143] PM: early resume of devices complete after 0.108 msecs
[12885.519167] i915 0000:00:02.0: setting latency timer to 64
[12885.519233] snd_hda_intel 0000:00:03.0: irq 58 for MSI/MSI-X
[12885.521760] xhci_hcd 0000:00:14.0: setting latency timer to 64
[12885.521851] mei_me 0000:00:16.0: irq 59 for MSI/MSI-X
[12885.522195] ahci 0000:00:1f.2: setting latency timer to 64
[12885.522261] snd_hda_intel 0000:00:1b.0: irq 62 for MSI/MSI-X
[12885.522293] ehci-pci 0000:00:1d.0: setting latency timer to 64
[12885.603758] mei_me 0000:00:16.0: NFC MEI VERSION: IVN 0x1 Vendor ID 0x1 Type 0x1
[12885.603783] Probing NFC pn544
[12885.855336] ata4: SATA link up 6.0 Gbps (SStatus 133 SControl 300)
[12885.857452] ata4.00: ACPI cmd ef/10:06:00:00:00:00 (SET FEATURES) succeeded
[12885.857453] ata4.00: ACPI cmd f5/00:00:00:00:00:00 (SECURITY FREEZE LOCK) filtered out
[12885.857454] ata4.00: ACPI cmd b1/c1:00:00:00:00:00 (DEVICE CONFIGURATION OVERLAY) filtered out
[12885.857508] ata4.00: ACPI cmd ef/10:00:00:00:00:b0 (SET FEATURES) rejected by device (Stat=0x51 Err=0x04)
[12885.863497] ata4.00: ACPI cmd ef/10:06:00:00:00:00 (SET FEATURES) succeeded
[12885.863498] ata4.00: ACPI cmd f5/00:00:00:00:00:00 (SECURITY FREEZE LOCK) filtered out
[12885.863499] ata4.00: ACPI cmd b1/c1:00:00:00:00:00 (DEVICE CONFIGURATION OVERLAY) filtered out
[12885.863562] ata4.00: ACPI cmd ef/10:00:00:00:00:b0 (SET FEATURES) rejected by device (Stat=0x51 Err=0x04)
[12885.863759] ata4.00: configured for UDMA/133
[12885.863811] sd 3:0:0:0: [sda] Starting disk
[12885.935512] usb 1-3: reset full-speed USB device number 2 using xhci_hcd
[12885.949081] xhci_hcd 0000:00:14.0: xHCI xhci_drop_endpoint called with disabled ep ffff88021331c0c0
[12886.479828] PM: resume of devices complete after 961.216 msecs
[12886.480423] PM: Finishing wakeup.
[12886.480447] iwlwifi 0000:01:00.0: no hotplug settings from platform
[12886.480750] Restarting tasks ... done.
[12886.480889] video LNXVIDEO:00: Restoring backlight state
[12886.496526] iwlwifi 0000:01:00.0: L1 Disabled; Enabling L0S
[12886.496673] iwlwifi 0000:01:00.0: L1 Disabled; Enabling L0S
[12886.507378] IPv6: ADDRCONF(NETDEV_UP): wlp1s0: link is not ready
[12887.171279] [drm] Enabling RC6 states: RC6 on, RC6p off, RC6pp off
[12893.903033] wlp1s0: authenticate with 48:f8:b3:06:cc:9b
[12893.903659] wlp1s0: send auth to 48:f8:b3:06:cc:9b (try 1/3)
[12893.905579] wlp1s0: authenticated
[12893.907604] wlp1s0: associate with 48:f8:b3:06:cc:9b (try 1/3)
[12893.910821] wlp1s0: RX AssocResp from 48:f8:b3:06:cc:9b (capab=0x411 status=0 aid=1)
[12893.911671] wlp1s0: associated
[12893.911690] IPv6: ADDRCONF(NETDEV_CHANGE): wlp1s0: link becomes ready

journalctl -b -u systemd-suspend -f
NO OUTPUT
journalctl -f just says the time has changed

/var/log/pm-suspend.log

Initial commandline parameters:
Fri Dec 27 01:40:49 UTC 2013: Running hooks for suspend.
Running hook /usr/lib/pm-utils/sleep.d/00logging suspend suspend:
Linux jdivaio13proarch 3.12.6-1-ARCH #1 SMP PREEMPT Fri Dec 20 19:39:00 CET 2013 x86_64 GNU/Linux
Module                  Size  Used by
xhci_hcd              145185  0
uvcvideo               72900  0
videobuf2_vmalloc       3280  1 uvcvideo
videobuf2_memops        2343  1 videobuf2_vmalloc
videobuf2_core         28027  1 uvcvideo
videodev              111172  2 uvcvideo,videobuf2_core
media                  11751  2 uvcvideo,videodev
usbhid                 40577  0
sony_laptop            39406  0
psmouse                85460  0
iwlmvm                122766  0
iwlwifi               139527  1 iwlmvm
mac80211              468122  1 iwlmvm
cfg80211              412886  3 iwlwifi,mac80211,iwlmvm
hid_multitouch         10369  0
hid                    90806  2 hid_multitouch,usbhid
ehci_pci                4000  0
ehci_hcd               59220  1 ehci_pci
btusb                  18632  0
bluetooth             309116  2 btusb
usbcore               180136  6 btusb,uvcvideo,ehci_hcd,ehci_pci,usbhid,xhci_hcd
usb_common              1656  1 usbcore
pn544_mei               1827  0
mei_phy                 2518  1 pn544_mei
pn544                   6976  1 pn544_mei
hci                    19741  2 pn544,mei_phy
nfc                    75801  2 hci,pn544
rfkill                 15651  5 nfc,cfg80211,sony_laptop,bluetooth
fuse                   74768  5
snd_hda_codec_hdmi     30162  1
snd_hda_codec_realtek    41263  1
nls_cp437               5961  1
vfat                   10063  1
fat                    51827  1 vfat
joydev                  9671  0
arc4                    2008  2
x86_pkg_temp_thermal     6999  0
coretemp                6334  0
kvm_intel             131191  0
kvm                   388773  1 kvm_intel
crct10dif_pclmul        4754  0
crct10dif_common        1380  1 crct10dif_pclmul
crc32_pclmul            3027  0
crc32c_intel           14257  0
ghash_clmulni_intel     4509  0
aesni_intel            46100  2
aes_x86_64              7407  1 aesni_intel
lrw                     3573  1 aesni_intel
gf128mul                5866  1 lrw
glue_helper             4617  1 aesni_intel
ablk_helper             1980  1 aesni_intel
cryptd                  8481  3 ghash_clmulni_intel,aesni_intel,ablk_helper
iTCO_wdt                5407  0
iTCO_vendor_support     1937  1 iTCO_wdt
snd_hda_intel          36904  0
snd_hda_codec         150305  3 snd_hda_codec_realtek,snd_hda_codec_hdmi,snd_hda_intel
snd_hwdep               6340  1 snd_hda_codec
i915                  657793  5
intel_agp              10880  1 i915
snd_pcm                77709  3 snd_hda_codec_hdmi,snd_hda_codec,snd_hda_intel
intel_gtt              12664  2 i915,intel_agp
snd_page_alloc          7242  2 snd_pcm,snd_hda_intel
thermal                 8532  0
battery                 6837  0
snd_timer              18726  1 snd_pcm
drm_kms_helper         36286  1 i915
drm                   238206  4 i915,drm_kms_helper
microcode              15216  0
lib80211                3829  0
evdev                  11085  22
serio_raw               5049  0
snd                    59141  7 snd_hda_codec_realtek,snd_hwdep,snd_timer,snd_hda_codec_hdmi,snd_pcm,snd_hda_codec,snd_hda_intel
i2c_algo_bit            5399  1 i915
i2c_i801               11277  0
mei_me                  9400  0
mei                    62286  3 pn544_mei,mei_phy,mei_me
ac                      3332  0
button                  4677  1 i915
i2c_core               24164  6 drm,i915,i2c_i801,drm_kms_helper,i2c_algo_bit,videodev
soundcore               5450  1 snd
video                  11228  1 i915
shpchp                 25465  0
lpc_ich                13376  0
processor              24935  0
ext4                  474251  2
crc16                   1367  2 ext4,bluetooth
mbcache                 6082  1 ext4
jbd2                   83504  1 ext4
sd_mod                 30821  4
ahci                   23056  3
libahci                21674  1 ahci
libata                170856  2 ahci,libahci
scsi_mod              130701  2 libata,sd_mod
             total       used       free     shared    buffers     cached
Mem:       8086372    1760600    6325772     164340     138528     583736
-/+ buffers/cache:    1038336    7048036
Swap:            0          0          0

/usr/lib/pm-utils/sleep.d/00logging suspend suspend: success.
Running hook /usr/lib/pm-utils/sleep.d/00powersave suspend suspend:

/usr/lib/pm-utils/sleep.d/00powersave suspend suspend: success.
Running hook /usr/lib/pm-utils/sleep.d/01grub suspend suspend:

/usr/lib/pm-utils/sleep.d/01grub suspend suspend: success.
Running hook /usr/lib/pm-utils/sleep.d/01laptop-mode suspend suspend:

/usr/lib/pm-utils/sleep.d/01laptop-mode suspend suspend: success.
Running hook /etc/pm/sleep.d/20_custom_ehci_hcd suspend suspend:

/etc/pm/sleep.d/20_custom_ehci_hcd suspend suspend: success.
Running hook /etc/pm/sleep.d/44toucpad suspend suspend:
Oh, this time we are doing a suspend to RAM. Cool!

/etc/pm/sleep.d/44toucpad suspend suspend: success.
Running hook /usr/lib/pm-utils/sleep.d/49bluetooth suspend suspend:

/usr/lib/pm-utils/sleep.d/49bluetooth suspend suspend: success.
Running hook /usr/lib/pm-utils/sleep.d/75modules suspend suspend:
Unloading kernel module uhci_hd...Done.
Unloading kernel module ehci_hd...Done.
Unloading kernel module iwlwifi...Done.
Unloading kernel module usbhid...Done.
Unloading kernel module hid_multitouch...Done.
Unloading kernel module hid...Done.
Unloading kernel module nfc...Done.
Unloading kernel module mac80211...Done.
Unloading kernel module iwlmvm...Done.
Unloading kernel module psmouse...Done.
Unloading kernel module sony_laptop...Done.
Unloading kernel module ehci_pci...Done.
Unloading kernel module echi_hcd...Done.
Unloading kernel module xhci_hcd...Done.
Unloading kernel module btusb...Done.
Unloading kernel module usbhid...Done.
Unloading kernel module usbcore...Done.
Unloading kernel module usb_common...Done.

/usr/lib/pm-utils/sleep.d/75modules suspend suspend: success.
Running hook /etc/pm/sleep.d/90alsa suspend suspend:

/etc/pm/sleep.d/90alsa suspend suspend: success.
Running hook /usr/lib/pm-utils/sleep.d/90clock suspend suspend:

/usr/lib/pm-utils/sleep.d/90clock suspend suspend: success.
Running hook /usr/lib/pm-utils/sleep.d/94cpufreq suspend suspend:

/usr/lib/pm-utils/sleep.d/94cpufreq suspend suspend: success.
Running hook /usr/lib/pm-utils/sleep.d/95led suspend suspend:

/usr/lib/pm-utils/sleep.d/95led suspend suspend: success.
Running hook /usr/lib/pm-utils/sleep.d/98video-quirk-db-handler suspend suspend:
Kernel modesetting video driver detected, not using quirks.

/usr/lib/pm-utils/sleep.d/98video-quirk-db-handler suspend suspend: success.
Running hook /usr/lib/pm-utils/sleep.d/99video suspend suspend:

/usr/lib/pm-utils/sleep.d/99video suspend suspend: success.
Fri Dec 27 01:40:51 UTC 2013: performing suspend
KMS graphics driver is in use, skipping quirks.
Fri Dec 27 01:40:57 UTC 2013: Awake.
Fri Dec 27 01:40:57 UTC 2013: Running hooks for resume
Running hook /usr/lib/pm-utils/sleep.d/99video resume suspend:

/usr/lib/pm-utils/sleep.d/99video resume suspend: success.
Running hook /usr/lib/pm-utils/sleep.d/98video-quirk-db-handler resume suspend:

/usr/lib/pm-utils/sleep.d/98video-quirk-db-handler resume suspend: success.
Running hook /usr/lib/pm-utils/sleep.d/95led resume suspend:

/usr/lib/pm-utils/sleep.d/95led resume suspend: success.
Running hook /usr/lib/pm-utils/sleep.d/94cpufreq resume suspend:

/usr/lib/pm-utils/sleep.d/94cpufreq resume suspend: success.
Running hook /usr/lib/pm-utils/sleep.d/90clock resume suspend:

/usr/lib/pm-utils/sleep.d/90clock resume suspend: success.
Running hook /etc/pm/sleep.d/90alsa resume suspend:
Playing raw data '/dev/zero' : Unsigned 8 bit, Rate 8000 Hz, Mono

/etc/pm/sleep.d/90alsa resume suspend: success.
Running hook /usr/lib/pm-utils/sleep.d/75modules resume suspend:
Reloaded unloaded modules.

/usr/lib/pm-utils/sleep.d/75modules resume suspend: success.
Running hook /usr/lib/pm-utils/sleep.d/49bluetooth resume suspend:

/usr/lib/pm-utils/sleep.d/49bluetooth resume suspend: success.
Running hook /etc/pm/sleep.d/44toucpad resume suspend:
Hey, the suspend to RAM seems to be over...

/etc/pm/sleep.d/44toucpad resume suspend: success.
Running hook /etc/pm/sleep.d/20_custom_ehci_hcd resume suspend:

/etc/pm/sleep.d/20_custom_ehci_hcd resume suspend: success.
Running hook /usr/lib/pm-utils/sleep.d/01laptop-mode resume suspend:

/usr/lib/pm-utils/sleep.d/01laptop-mode resume suspend: success.
Running hook /usr/lib/pm-utils/sleep.d/01grub resume suspend:

/usr/lib/pm-utils/sleep.d/01grub resume suspend: success.
Running hook /usr/lib/pm-utils/sleep.d/00powersave resume suspend:

/usr/lib/pm-utils/sleep.d/00powersave resume suspend: success.
Running hook /usr/lib/pm-utils/sleep.d/00logging resume suspend:

/usr/lib/pm-utils/sleep.d/00logging resume suspend: success.
Fri Dec 27 01:40:59 UTC 2013: Finished.