[systemd-devel] systemd-udevd: excessive I/O usage

Alexander E. Patrakov patrakov at gmail.com
Mon Jun 4 20:50:56 PDT 2012


2012/6/5 Kok, Auke-jan H <auke-jan.h.kok at intel.com> wrote on systemd-devel list:
> It seems your system is taking well into 15+ seconds before btrfs is
> actually *ready* on your system, which seems to be the main hiccup
> (note, speculation here). I've personally become a bit displeased with
> btrfs performance recently myself, so, I'm wondering if you should try
> ext4 for now.
>
> Other than that, after btrfs/udev finally pops to life, things seem to
> start relatively quickly.

I think btrfs is to blame here, because I think my system started to
be affected by this problem after ext4 -> btrfs conversion.

I recently changed my ext4-on-lvm gentoo system at home by
defragmenting the LVM (http://bisqwit.iki.fi/source/lvm2defrag.html),
converting the biggest (200 GB, 80% used, mostly video files, git
trees and SVN checkouts of various projects) logical volume to btrfs,
making the backup of metadata, deleting the LVM partition and creating
ordinary partitions in places that were occupied by LVM volumes before
according to the backup. It worked. Then I made a btrfs subvolume and
transferred the contents of the former root partition there using tar.
So now I have two copies of my root filesystem - one on ext4 and one
on btrfs. I recreated an initramfs for each of them using dracut.
Result: boot from ext4 takes less than 15 seconds, while boot from
btrfs takes 9 minutes (or 5 minutes if I disable readahead - the data
file is not valid anyway on btrfs).

One problem is btrfsck in the dracut-created initramfs - it fires
every time (with btrfs mounted read-only?). The other problem is the
btrfs-cache-1 kernel thread - I was told on #btrfs that it is a
one-time thing, but apparently it wants to do its caching every boot
due to some breakage. During the boot, there are also warnings about
hung tasks with some locks held.

I am attaching a dmesg file illustrating all of the problems mentioned above.

-- 
Alexander E. Patrakov
-------------- next part --------------
[    0.000000] Initializing cgroup subsys cpuset
[    0.000000] Initializing cgroup subsys cpu
[    0.000000] Linux version 3.4.0-gentoo (root at home) (gcc version 4.5.3 (Gentoo 4.5.3-r2 p1.1, pie-0.4.7) ) #1 SMP PREEMPT Sun May 27 16:53:25 YEKT 2012
[    0.000000] Command line: initrd=/initramfs.img root=/dev/sda1 rootfstype=btrfs rootflags=subvol=gentoo-gnome-32-a ro debug psmouse.rate=1000 init=/sbin/init32 enable_mtrr_cleanup mtrr_spare_reg_nr=1 mtrr_gran_size=16M mtrr_chunk_size=32M BOOT_IMAGE=/vmlinuz 
[    0.000000] BIOS-provided physical RAM map:
[    0.000000]  BIOS-e820: 0000000000000000 - 000000000009ec00 (usable)
[    0.000000]  BIOS-e820: 000000000009ec00 - 00000000000a0000 (reserved)
[    0.000000]  BIOS-e820: 00000000000e0000 - 0000000000100000 (reserved)
[    0.000000]  BIOS-e820: 0000000000100000 - 00000000cf599000 (usable)
[    0.000000]  BIOS-e820: 00000000cf599000 - 00000000cf5a6000 (reserved)
[    0.000000]  BIOS-e820: 00000000cf5a6000 - 00000000cf665000 (usable)
[    0.000000]  BIOS-e820: 00000000cf665000 - 00000000cf6a9000 (ACPI NVS)
[    0.000000]  BIOS-e820: 00000000cf6a9000 - 00000000cf6ac000 (ACPI data)
[    0.000000]  BIOS-e820: 00000000cf6ac000 - 00000000cf6f2000 (ACPI NVS)
[    0.000000]  BIOS-e820: 00000000cf6f2000 - 00000000cf6ff000 (ACPI data)
[    0.000000]  BIOS-e820: 00000000cf6ff000 - 00000000cf700000 (usable)
[    0.000000]  BIOS-e820: 00000000cf700000 - 00000000d0000000 (reserved)
[    0.000000]  BIOS-e820: 00000000fff00000 - 0000000100000000 (reserved)
[    0.000000]  BIOS-e820: 0000000100000000 - 000000022c000000 (usable)
[    0.000000] NX (Execute Disable) protection: active
[    0.000000] DMI 2.4 present.
[    0.000000] DMI:                  /DG965SS, BIOS MQ96510J.86A.0816.2006.0716.2308 07/16/2006
[    0.000000] e820 update range: 0000000000000000 - 0000000000010000 (usable) ==> (reserved)
[    0.000000] e820 remove range: 00000000000a0000 - 0000000000100000 (usable)
[    0.000000] No AGP bridge found
[    0.000000] last_pfn = 0x22c000 max_arch_pfn = 0x400000000
[    0.000000] MTRR default type: uncachable
[    0.000000] MTRR fixed ranges enabled:
[    0.000000]   00000-9FFFF write-back
[    0.000000]   A0000-FFFFF uncachable
[    0.000000] MTRR variable ranges enabled:
[    0.000000]   0 base 000000000 mask F80000000 write-back
[    0.000000]   1 base 080000000 mask FC0000000 write-back
[    0.000000]   2 base 0C0000000 mask FF0000000 write-back
[    0.000000]   3 base 0CF800000 mask FFF800000 uncachable
[    0.000000]   4 base 0CF700000 mask FFFF00000 uncachable
[    0.000000]   5 base 100000000 mask F00000000 write-back
[    0.000000]   6 base 200000000 mask FE0000000 write-back
[    0.000000]   7 base 220000000 mask FF8000000 write-back
[    0.000000] x86 PAT enabled: cpu 0, old 0x7040600070406, new 0x7010600070106
[    0.000000] original variable MTRRs
[    0.000000] reg 0, base: 0GB, range: 2GB, type WB
[    0.000000] reg 1, base: 2GB, range: 1GB, type WB
[    0.000000] reg 2, base: 3GB, range: 256MB, type WB
[    0.000000] reg 3, base: 3320MB, range: 8MB, type UC
[    0.000000] reg 4, base: 3319MB, range: 1MB, type UC
[    0.000000] reg 5, base: 4GB, range: 4GB, type WB
[    0.000000] reg 6, base: 8GB, range: 512MB, type WB
[    0.000000] reg 7, base: 8704MB, range: 128MB, type WB
[    0.000000] total RAM covered: 8055M
[    0.000000]  gran_size: 16M 	chunk_size: 32M 	num_reg: 7  	lose cover RAM: 7M
[    0.000000] New variable MTRRs
[    0.000000] reg 0, base: 0GB, range: 2GB, type WB
[    0.000000] reg 1, base: 2GB, range: 1GB, type WB
[    0.000000] reg 2, base: 3GB, range: 256MB, type WB
[    0.000000] reg 3, base: 3312MB, range: 16MB, type UC
[    0.000000] reg 4, base: 4GB, range: 4GB, type WB
[    0.000000] reg 5, base: 8GB, range: 512MB, type WB
[    0.000000] reg 6, base: 8704MB, range: 128MB, type WB
[    0.000000] e820 update range: 00000000cf000000 - 0000000100000000 (usable) ==> (reserved)
[    0.000000] e820 update range: 0000000228000000 - 000000022c000000 (usable) ==> (reserved)
[    0.000000] WARNING: BIOS bug: CPU MTRRs don't cover all of memory, losing 70MB of RAM.
[    0.000000] update e820 for mtrr
[    0.000000] modified physical RAM map:
[    0.000000]  modified: 0000000000000000 - 0000000000010000 (reserved)
[    0.000000]  modified: 0000000000010000 - 000000000009ec00 (usable)
[    0.000000]  modified: 000000000009ec00 - 00000000000a0000 (reserved)
[    0.000000]  modified: 00000000000e0000 - 0000000000100000 (reserved)
[    0.000000]  modified: 0000000000100000 - 00000000cf000000 (usable)
[    0.000000]  modified: 00000000cf000000 - 00000000cf665000 (reserved)
[    0.000000]  modified: 00000000cf665000 - 00000000cf6a9000 (ACPI NVS)
[    0.000000]  modified: 00000000cf6a9000 - 00000000cf6ac000 (ACPI data)
[    0.000000]  modified: 00000000cf6ac000 - 00000000cf6f2000 (ACPI NVS)
[    0.000000]  modified: 00000000cf6f2000 - 00000000cf6ff000 (ACPI data)
[    0.000000]  modified: 00000000cf6ff000 - 00000000d0000000 (reserved)
[    0.000000]  modified: 00000000fff00000 - 0000000100000000 (reserved)
[    0.000000]  modified: 0000000100000000 - 0000000228000000 (usable)
[    0.000000]  modified: 0000000228000000 - 000000022c000000 (reserved)
[    0.000000] last_pfn = 0x228000 max_arch_pfn = 0x400000000
[    0.000000] last_pfn = 0xcf000 max_arch_pfn = 0x400000000
[    0.000000] found SMP MP-table at [ffff8800000fe200] fe200
[    0.000000] initial memory mapped : 0 - 20000000
[    0.000000] Base memory trampoline at [ffff880000099000] 99000 size 20480
[    0.000000] init_memory_mapping: 0000000000000000-00000000cf000000
[    0.000000]  0000000000 - 00cf000000 page 2M
[    0.000000] kernel direct mapping tables up to cf000000 @ 1fffb000-20000000
[    0.000000] init_memory_mapping: 0000000100000000-0000000228000000
[    0.000000]  0100000000 - 0228000000 page 2M
[    0.000000] kernel direct mapping tables up to 228000000 @ ceff6000-cf000000
[    0.000000] RAMDISK: 7f67e000 - 7ffff000
[    0.000000] ACPI: RSDP 00000000000fe020 00014 (v00 INTEL )
[    0.000000] ACPI: RSDT 00000000cf6fd038 0004C (v01 INTEL  DG965SS  00000330      01000013)
[    0.000000] ACPI: FACP 00000000cf6fc000 00074 (v01 INTEL  DG965SS  00000330 MSFT 01000013)
[    0.000000] ACPI: DSDT 00000000cf6f8000 03EDA (v01 INTEL  DG965SS  00000330 MSFT 01000013)
[    0.000000] ACPI: FACS 00000000cf6ac000 00040
[    0.000000] ACPI: APIC 00000000cf6f7000 00078 (v01 INTEL  DG965SS  00000330 MSFT 01000013)
[    0.000000] ACPI: WDDT 00000000cf6f6000 00040 (v01 INTEL  DG965SS  00000330 MSFT 01000013)
[    0.000000] ACPI: MCFG 00000000cf6f5000 0003C (v01 INTEL  DG965SS  00000330 MSFT 01000013)
[    0.000000] ACPI: ASF! 00000000cf6f4000 000A6 (v32 INTEL  DG965SS  00000330 MSFT 01000013)
[    0.000000] ACPI: SSDT 00000000cf6f3000 001BC (v01 INTEL     CpuPm 00000330 MSFT 01000013)
[    0.000000] ACPI: SSDT 00000000cf6f2000 00175 (v01 INTEL   Cpu0Ist 00000330 MSFT 01000013)
[    0.000000] ACPI: SSDT 00000000cf6ab000 00175 (v01 INTEL   Cpu1Ist 00000330 MSFT 01000013)
[    0.000000] ACPI: SSDT 00000000cf6aa000 00175 (v01 INTEL   Cpu2Ist 00000330 MSFT 01000013)
[    0.000000] ACPI: SSDT 00000000cf6a9000 00175 (v01 INTEL   Cpu3Ist 00000330 MSFT 01000013)
[    0.000000] ACPI: Local APIC address 0xfee00000
[    0.000000] No NUMA configuration found
[    0.000000] Faking a node at 0000000000000000-0000000228000000
[    0.000000] Initmem setup node 0 0000000000000000-0000000228000000
[    0.000000]   NODE_DATA [0000000227ffb000 - 0000000227ffffff]
[    0.000000]  [ffffea0000000000-ffffea00089fffff] PMD -> [ffff88021f800000-ffff8802275fffff] on node 0
[    0.000000] Zone PFN ranges:
[    0.000000]   DMA      0x00000010 -> 0x00001000
[    0.000000]   DMA32    0x00001000 -> 0x00100000
[    0.000000]   Normal   0x00100000 -> 0x00228000
[    0.000000] Movable zone start PFN for each node
[    0.000000] Early memory PFN ranges
[    0.000000]     0: 0x00000010 -> 0x0000009e
[    0.000000]     0: 0x00000100 -> 0x000cf000
[    0.000000]     0: 0x00100000 -> 0x00228000
[    0.000000] On node 0 totalpages: 2060174
[    0.000000]   DMA zone: 64 pages used for memmap
[    0.000000]   DMA zone: 5 pages reserved
[    0.000000]   DMA zone: 3913 pages, LIFO batch:0
[    0.000000]   DMA32 zone: 16320 pages used for memmap
[    0.000000]   DMA32 zone: 827456 pages, LIFO batch:31
[    0.000000]   Normal zone: 18944 pages used for memmap
[    0.000000]   Normal zone: 1193472 pages, LIFO batch:31
[    0.000000] ACPI: PM-Timer IO Port: 0x408
[    0.000000] ACPI: Local APIC address 0xfee00000
[    0.000000] ACPI: LAPIC (acpi_id[0x01] lapic_id[0x00] enabled)
[    0.000000] ACPI: LAPIC (acpi_id[0x02] lapic_id[0x01] enabled)
[    0.000000] ACPI: LAPIC (acpi_id[0x03] lapic_id[0x82] disabled)
[    0.000000] ACPI: LAPIC (acpi_id[0x04] lapic_id[0x83] disabled)
[    0.000000] ACPI: LAPIC_NMI (acpi_id[0x01] dfl dfl lint[0x1])
[    0.000000] ACPI: LAPIC_NMI (acpi_id[0x02] dfl dfl lint[0x1])
[    0.000000] ACPI: IOAPIC (id[0x02] address[0xfec00000] gsi_base[0])
[    0.000000] IOAPIC[0]: apic_id 2, version 32, address 0xfec00000, GSI 0-23
[    0.000000] ACPI: INT_SRC_OVR (bus 0 bus_irq 0 global_irq 2 dfl dfl)
[    0.000000] ACPI: INT_SRC_OVR (bus 0 bus_irq 9 global_irq 9 high level)
[    0.000000] ACPI: IRQ0 used by override.
[    0.000000] ACPI: IRQ2 used by override.
[    0.000000] ACPI: IRQ9 used by override.
[    0.000000] Using ACPI (MADT) for SMP configuration information
[    0.000000] SMP: Allowing 4 CPUs, 2 hotplug CPUs
[    0.000000] nr_irqs_gsi: 40
[    0.000000] PM: Registered nosave memory: 000000000009e000 - 000000000009f000
[    0.000000] PM: Registered nosave memory: 000000000009f000 - 00000000000a0000
[    0.000000] PM: Registered nosave memory: 00000000000a0000 - 00000000000e0000
[    0.000000] PM: Registered nosave memory: 00000000000e0000 - 0000000000100000
[    0.000000] PM: Registered nosave memory: 00000000cf000000 - 00000000cf665000
[    0.000000] PM: Registered nosave memory: 00000000cf665000 - 00000000cf6a9000
[    0.000000] PM: Registered nosave memory: 00000000cf6a9000 - 00000000cf6ac000
[    0.000000] PM: Registered nosave memory: 00000000cf6ac000 - 00000000cf6f2000
[    0.000000] PM: Registered nosave memory: 00000000cf6f2000 - 00000000cf6ff000
[    0.000000] PM: Registered nosave memory: 00000000cf6ff000 - 00000000d0000000
[    0.000000] PM: Registered nosave memory: 00000000d0000000 - 00000000fff00000
[    0.000000] PM: Registered nosave memory: 00000000fff00000 - 0000000100000000
[    0.000000] Allocating PCI resources starting at d0000000 (gap: d0000000:2ff00000)
[    0.000000] Booting paravirtualized kernel on bare hardware
[    0.000000] setup_percpu: NR_CPUS:8 nr_cpumask_bits:8 nr_cpu_ids:4 nr_node_ids:1
[    0.000000] PERCPU: Embedded 28 pages/cpu @ffff880227c00000 s84160 r8192 d22336 u524288
[    0.000000] pcpu-alloc: s84160 r8192 d22336 u524288 alloc=1*2097152
[    0.000000] pcpu-alloc: [0] 0 1 2 3 
[    0.000000] Built 1 zonelists in Zone order, mobility grouping on.  Total pages: 2024841
[    0.000000] Policy zone: Normal
[    0.000000] Kernel command line: initrd=/initramfs.img root=/dev/sda1 rootfstype=btrfs rootflags=subvol=gentoo-gnome-32-a ro debug psmouse.rate=1000 init=/sbin/init32 enable_mtrr_cleanup mtrr_spare_reg_nr=1 mtrr_gran_size=16M mtrr_chunk_size=32M BOOT_IMAGE=/vmlinuz 
[    0.000000] PID hash table entries: 4096 (order: 3, 32768 bytes)
[    0.000000] Checking aperture...
[    0.000000] No AGP bridge found
[    0.000000] Calgary: detecting Calgary via BIOS EBDA area
[    0.000000] Calgary: Unable to locate Rio Grande table in EBDA - bailing!
[    0.000000] Memory: 8011732k/9043968k available (6715k kernel code, 803272k absent, 228964k reserved, 6295k data, 708k init)
[    0.000000] SLUB: Genslabs=15, HWalign=64, Order=0-3, MinObjects=0, CPUs=4, Nodes=1
[    0.000000] Preemptible hierarchical RCU implementation.
[    0.000000] 	CONFIG_RCU_FANOUT set to non-default value of 32
[    0.000000] 	Additional per-CPU info printed with stalls.
[    0.000000] NR_IRQS:4352 nr_irqs:712 16
[    0.000000] Console: colour VGA+ 80x25
[    0.000000] console [tty0] enabled
[    0.000000] Lock dependency validator: Copyright (c) 2006 Red Hat, Inc., Ingo Molnar
[    0.000000] ... MAX_LOCKDEP_SUBCLASSES:  8
[    0.000000] ... MAX_LOCK_DEPTH:          48
[    0.000000] ... MAX_LOCKDEP_KEYS:        8191
[    0.000000] ... CLASSHASH_SIZE:          4096
[    0.000000] ... MAX_LOCKDEP_ENTRIES:     16384
[    0.000000] ... MAX_LOCKDEP_CHAINS:      32768
[    0.000000] ... CHAINHASH_SIZE:          16384
[    0.000000]  memory used by lock dependency info: 5855 kB
[    0.000000]  per task-struct memory footprint: 1920 bytes
[    0.000000] kmemleak: Kernel memory leak detector disabled
[    0.000000] Fast TSC calibration using PIT
[    0.000000] Detected 2131.070 MHz processor.
[    0.002004] Calibrating delay loop (skipped), value calculated using timer frequency.. 4262.14 BogoMIPS (lpj=2131070)
[    0.003046] pid_max: default: 32768 minimum: 301
[    0.003166] Security Framework initialized
[    0.004248] Dentry cache hash table entries: 1048576 (order: 11, 8388608 bytes)
[    0.009122] Inode-cache hash table entries: 524288 (order: 10, 4194304 bytes)
[    0.011445] Mount-cache hash table entries: 256
[    0.012896] Initializing cgroup subsys cpuacct
[    0.012946] Initializing cgroup subsys devices
[    0.013004] Initializing cgroup subsys freezer
[    0.013129] CPU: Physical Processor ID: 0
[    0.013175] CPU: Processor Core ID: 0
[    0.013221] mce: CPU supports 6 MCE banks
[    0.013272] CPU0: Thermal monitoring enabled (TM2)
[    0.013323] using mwait in idle threads.
[    0.015032] ACPI: Core revision 20120320
[    0.026144] ..TIMER: vector=0x30 apic1=0 pin1=2 apic2=-1 pin2=-1
[    0.036201] CPU0: Intel(R) Core(TM)2 CPU          6420  @ 2.13GHz stepping 06
[    0.036997] Performance Events: PEBS fmt0-, 4-deep LBR, Core2 events, Intel PMU driver.
[    0.036997] PEBS disabled due to CPU errata.
[    0.036997] ... version:                2
[    0.036997] ... bit width:              40
[    0.036997] ... generic registers:      2
[    0.036997] ... value mask:             000000ffffffffff
[    0.036997] ... max period:             000000007fffffff
[    0.036997] ... fixed-purpose events:   3
[    0.036997] ... event mask:             0000000700000003
[    0.044462] NMI watchdog: enabled, takes one hw-pmu counter.
[    0.048048] lockdep: fixing up alternatives.
[    0.050253] Booting Node   0, Processors  #1
[    0.062110] NMI watchdog: enabled, takes one hw-pmu counter.
[    0.062280] Brought up 2 CPUs
[    0.062325] Total of 2 processors activated (8524.28 BogoMIPS).
[    0.064410] devtmpfs: initialized
[    0.069116] PM: Registering ACPI NVS region [mem 0xcf665000-0xcf6a8fff] (278528 bytes)
[    0.070007] PM: Registering ACPI NVS region [mem 0xcf6ac000-0xcf6f1fff] (286720 bytes)
[    0.070463] NET: Registered protocol family 16
[    0.071290] ACPI: bus type pci registered
[    0.071456] dca service started, version 1.12.1
[    0.071558] PCI: MMCONFIG for domain 0000 [bus 00-7f] at [mem 0xf0000000-0xf7ffffff] (base 0xf0000000)
[    0.071634] PCI: not using MMCONFIG
[    0.071679] PCI: Using configuration type 1 for base access
[    0.075323] bio: create slab <bio-0> at 0
[    0.075323] ACPI: Added _OSI(Module Device)
[    0.075323] ACPI: Added _OSI(Processor Device)
[    0.075323] ACPI: Added _OSI(3.0 _SCP Extensions)
[    0.075323] ACPI: Added _OSI(Processor Aggregator Device)
[    0.078683] ACPI: EC: Look up EC in DSDT
[    0.084841] ACPI: Interpreter enabled
[    0.084889] ACPI: (supports S0 S3 S4 S5)
[    0.085060] ACPI: Using IOAPIC for interrupt routing
[    0.085139] PCI: MMCONFIG for domain 0000 [bus 00-7f] at [mem 0xf0000000-0xf7ffffff] (base 0xf0000000)
[    0.085563] PCI: MMCONFIG at [mem 0xf0000000-0xf7ffffff] reserved in ACPI motherboard resources
[    0.142501] ACPI: No dock devices found.
[    0.142550] PCI: Ignoring host bridge windows from ACPI; if necessary, use "pci=use_crs" and report a bug
[    0.144025] ACPI: PCI Root Bridge [PCI0] (domain 0000 [bus 00-ff])
[    0.146706] pci_root PNP0A03:00: host bridge window [io  0x0000-0x0cf7] (ignored)
[    0.146778] pci_root PNP0A03:00: host bridge window [io  0x0d00-0xffff] (ignored)
[    0.146849] pci_root PNP0A03:00: host bridge window [mem 0x000a0000-0x000bffff] (ignored)
[    0.146922] pci_root PNP0A03:00: host bridge window [mem 0x000e0000-0x000effff] (ignored)
[    0.146990] pci_root PNP0A03:00: host bridge window [mem 0xf8000000-0xfeafffff] (ignored)
[    0.147063] pci_root PNP0A03:00: host bridge window [mem 0xd0000000-0xefffffff] (ignored)
[    0.147136] PCI: root bus 00: using default resources
[    0.147382] PCI host bridge to bus 0000:00
[    0.147430] pci_bus 0000:00: root bus resource [io  0x0000-0xffff]
[    0.147483] pci_bus 0000:00: root bus resource [mem 0x00000000-0xfffffffff]
[    0.147603] pci 0000:00:00.0: [8086:29a0] type 00 class 0x060000
[    0.147772] pci 0000:00:02.0: [8086:29a2] type 00 class 0x030000
[    0.147841] pci 0000:00:02.0: reg 10: [mem 0xe0300000-0xe03fffff]
[    0.147911] pci 0000:00:02.0: reg 18: [mem 0xd0000000-0xdfffffff 64bit pref]
[    0.147989] pci 0000:00:02.0: reg 20: [io  0x2110-0x2117]
[    0.148103] pci 0000:00:02.1: [8086:29a3] type 00 class 0x038000
[    0.148168] pci 0000:00:02.1: reg 10: [mem 0xe0200000-0xe02fffff]
[    0.148312] pci 0000:00:03.0: [8086:29a4] type 00 class 0x078000
[    0.148384] pci 0000:00:03.0: reg 10: [mem 0xe0426100-0xe042610f 64bit]
[    0.148511] pci 0000:00:03.0: PME# supported from D0 D3hot D3cold
[    0.148678] pci 0000:00:19.0: [8086:104b] type 00 class 0x020000
[    0.148751] pci 0000:00:19.0: reg 10: [mem 0xe0400000-0xe041ffff]
[    0.148813] pci 0000:00:19.0: reg 14: [mem 0xe0424000-0xe0424fff]
[    0.148875] pci 0000:00:19.0: reg 18: [io  0x20e0-0x20ff]
[    0.149014] pci 0000:00:19.0: PME# supported from D0 D3hot D3cold
[    0.149088] pci 0000:00:1a.0: [8086:2834] type 00 class 0x0c0300
[    0.149194] pci 0000:00:1a.0: reg 20: [io  0x20c0-0x20df]
[    0.149288] pci 0000:00:1a.1: [8086:2835] type 00 class 0x0c0300
[    0.149394] pci 0000:00:1a.1: reg 20: [io  0x20a0-0x20bf]
[    0.149504] pci 0000:00:1a.7: [8086:283a] type 00 class 0x0c0320
[    0.149579] pci 0000:00:1a.7: reg 10: [mem 0xe0425c00-0xe0425fff]
[    0.149745] pci 0000:00:1a.7: PME# supported from D0 D3hot D3cold
[    0.149847] pci 0000:00:1b.0: [8086:284b] type 00 class 0x040300
[    0.149919] pci 0000:00:1b.0: reg 10: [mem 0xe0420000-0xe0423fff 64bit]
[    0.150078] pci 0000:00:1b.0: PME# supported from D0 D3hot D3cold
[    0.150161] pci 0000:00:1c.0: [8086:283f] type 01 class 0x060400
[    0.150317] pci 0000:00:1c.0: PME# supported from D0 D3hot D3cold
[    0.150402] pci 0000:00:1c.1: [8086:2841] type 01 class 0x060400
[    0.150556] pci 0000:00:1c.1: PME# supported from D0 D3hot D3cold
[    0.150640] pci 0000:00:1c.2: [8086:2843] type 01 class 0x060400
[    0.150795] pci 0000:00:1c.2: PME# supported from D0 D3hot D3cold
[    0.150879] pci 0000:00:1c.3: [8086:2845] type 01 class 0x060400
[    0.151039] pci 0000:00:1c.3: PME# supported from D0 D3hot D3cold
[    0.151123] pci 0000:00:1c.4: [8086:2847] type 01 class 0x060400
[    0.151278] pci 0000:00:1c.4: PME# supported from D0 D3hot D3cold
[    0.151362] pci 0000:00:1d.0: [8086:2830] type 00 class 0x0c0300
[    0.151469] pci 0000:00:1d.0: reg 20: [io  0x2080-0x209f]
[    0.151562] pci 0000:00:1d.1: [8086:2831] type 00 class 0x0c0300
[    0.151668] pci 0000:00:1d.1: reg 20: [io  0x2060-0x207f]
[    0.151764] pci 0000:00:1d.2: [8086:2832] type 00 class 0x0c0300
[    0.151871] pci 0000:00:1d.2: reg 20: [io  0x2040-0x205f]
[    0.151980] pci 0000:00:1d.7: [8086:2836] type 00 class 0x0c0320
[    0.152012] pci 0000:00:1d.7: reg 10: [mem 0xe0425800-0xe0425bff]
[    0.152178] pci 0000:00:1d.7: PME# supported from D0 D3hot D3cold
[    0.152257] pci 0000:00:1e.0: [8086:244e] type 01 class 0x060401
[    0.152400] pci 0000:00:1f.0: [8086:2810] type 00 class 0x060100
[    0.152559] pci 0000:00:1f.0: ICH7 LPC Generic IO decode 1 PIO at 0680 (mask 007f)
[    0.152698] pci 0000:00:1f.2: [8086:2824] type 00 class 0x010601
[    0.152772] pci 0000:00:1f.2: reg 10: [io  0x2108-0x210f]
[    0.152831] pci 0000:00:1f.2: reg 14: [io  0x211c-0x211f]
[    0.152890] pci 0000:00:1f.2: reg 18: [io  0x2100-0x2107]
[    0.152997] pci 0000:00:1f.2: reg 1c: [io  0x2118-0x211b]
[    0.153057] pci 0000:00:1f.2: reg 20: [io  0x2020-0x203f]
[    0.153116] pci 0000:00:1f.2: reg 24: [mem 0xe0425000-0xe04257ff]
[    0.153229] pci 0000:00:1f.2: PME# supported from D3hot
[    0.153837] pci 0000:00:1f.3: [8086:283e] type 00 class 0x0c0500
[    0.153902] pci 0000:00:1f.3: reg 10: [mem 0xe0426000-0xe04260ff]
[    0.154003] pci 0000:00:1f.3: reg 20: [io  0x2000-0x201f]
[    0.154150] pci 0000:00:1c.0: PCI bridge to [bus 01-01]
[    0.154205] pci 0000:00:1c.0:   bridge window [mem 0xe0500000-0xe05fffff]
[    0.154347] pci 0000:02:00.0: [11ab:6101] type 00 class 0x01018f
[    0.154417] pci 0000:02:00.0: reg 10: [io  0x1018-0x101f]
[    0.154481] pci 0000:02:00.0: reg 14: [io  0x1024-0x1027]
[    0.154544] pci 0000:02:00.0: reg 18: [io  0x1010-0x1017]
[    0.154607] pci 0000:02:00.0: reg 1c: [io  0x1020-0x1023]
[    0.154670] pci 0000:02:00.0: reg 20: [io  0x1000-0x100f]
[    0.154734] pci 0000:02:00.0: reg 24: [mem 0xe0100000-0xe01001ff]
[    0.154872] pci 0000:02:00.0: supports D1
[    0.154918] pci 0000:02:00.0: PME# supported from D0 D1 D3hot
[    0.154999] pci 0000:02:00.0: disabling ASPM on pre-1.1 PCIe device.  You can enable it with 'pcie_aspm=force'
[    0.155161] pci 0000:00:1c.1: PCI bridge to [bus 02-02]
[    0.155214] pci 0000:00:1c.1:   bridge window [io  0x1000-0x1fff]
[    0.155269] pci 0000:00:1c.1:   bridge window [mem 0xe0100000-0xe01fffff]
[    0.155385] pci 0000:00:1c.2: PCI bridge to [bus 03-03]
[    0.155440] pci 0000:00:1c.2:   bridge window [mem 0xe0600000-0xe06fffff]
[    0.155555] pci 0000:00:1c.3: PCI bridge to [bus 04-04]
[    0.155610] pci 0000:00:1c.3:   bridge window [mem 0xe0700000-0xe07fffff]
[    0.155725] pci 0000:00:1c.4: PCI bridge to [bus 05-05]
[    0.155780] pci 0000:00:1c.4:   bridge window [mem 0xe0800000-0xe08fffff]
[    0.155884] pci 0000:06:01.0: [1131:7133] type 00 class 0x048000
[    0.155957] pci 0000:06:01.0: reg 10: [mem 0xe0004800-0xe0004fff]
[    0.156093] pci 0000:06:01.0: supports D1 D2
[    0.156167] pci 0000:06:03.0: [104c:8023] type 00 class 0x0c0010
[    0.156241] pci 0000:06:03.0: reg 10: [mem 0xe0004000-0xe00047ff]
[    0.156304] pci 0000:06:03.0: reg 14: [mem 0xe0000000-0xe0003fff]
[    0.156453] pci 0000:06:03.0: supports D1 D2
[    0.156499] pci 0000:06:03.0: PME# supported from D0 D1 D2 D3hot
[    0.156615] pci 0000:00:1e.0: PCI bridge to [bus 06-06] (subtractive decode)
[    0.156676] pci 0000:00:1e.0:   bridge window [mem 0xe0000000-0xe00fffff]
[    0.156735] pci 0000:00:1e.0:   bridge window [io  0x0000-0xffff] (subtractive decode)
[    0.156807] pci 0000:00:1e.0:   bridge window [mem 0x00000000-0xfffffffff] (subtractive decode)
[    0.156918] ACPI: PCI Interrupt Routing Table [\_SB_.PCI0._PRT]
[    0.157420] ACPI: PCI Interrupt Routing Table [\_SB_.PCI0.P32_._PRT]
[    0.157743] ACPI: PCI Interrupt Routing Table [\_SB_.PCI0.PEX0._PRT]
[    0.157883] ACPI: PCI Interrupt Routing Table [\_SB_.PCI0.PEX1._PRT]
[    0.158049] ACPI: PCI Interrupt Routing Table [\_SB_.PCI0.PEX2._PRT]
[    0.158188] ACPI: PCI Interrupt Routing Table [\_SB_.PCI0.PEX3._PRT]
[    0.158326] ACPI: PCI Interrupt Routing Table [\_SB_.PCI0.PEX4._PRT]
[    0.158572]  pci0000:00: Requesting ACPI _OSC control (0x1d)
[    0.158625]  pci0000:00: ACPI _OSC request failed (AE_NOT_FOUND), returned control mask: 0x1d
[    0.158698] ACPI _OSC control for PCIe not granted, disabling ASPM
[    0.174399] ACPI: PCI Interrupt Link [LNKA] (IRQs 3 4 5 7 9 10 *11 12)
[    0.174765] ACPI: PCI Interrupt Link [LNKB] (IRQs 3 4 5 7 9 *10 11 12)
[    0.175100] ACPI: PCI Interrupt Link [LNKC] (IRQs 3 4 5 7 9 10 *11 12)
[    0.175461] ACPI: PCI Interrupt Link [LNKD] (IRQs 3 4 5 7 9 10 *11 12)
[    0.175819] ACPI: PCI Interrupt Link [LNKE] (IRQs 3 4 5 7 *9 10 11 12)
[    0.176213] ACPI: PCI Interrupt Link [LNKF] (IRQs 3 4 5 7 9 *10 11 12)
[    0.176572] ACPI: PCI Interrupt Link [LNKG] (IRQs 3 4 5 7 *9 10 11 12)
[    0.176930] ACPI: PCI Interrupt Link [LNKH] (IRQs 3 4 5 7 9 10 *11 12)
[    0.178085] vgaarb: device added: PCI:0000:00:02.0,decodes=io+mem,owns=io+mem,locks=none
[    0.178196] vgaarb: loaded
[    0.178238] vgaarb: bridge control possible 0000:00:02.0
[    0.178238] SCSI subsystem initialized
[    0.178238] libata version 3.00 loaded.
[    0.178238] usbcore: registered new interface driver usbfs
[    0.178238] usbcore: registered new interface driver hub
[    0.178289] usbcore: registered new device driver usb
[    0.178289] PCI: Using ACPI for IRQ routing
[    0.182373] PCI: pci_cache_line_size set to 64 bytes
[    0.182599] reserve RAM buffer: 000000000009ec00 - 000000000009ffff 
[    0.182638] reserve RAM buffer: 00000000cf000000 - 00000000cfffffff 
[    0.200125] pnp: PnP ACPI init
[    0.200250] ACPI: bus type pnp registered
[    0.201611] pnp 00:00: [bus 00-ff]
[    0.201657] pnp 00:00: [io  0x0cf8-0x0cff]
[    0.201704] pnp 00:00: [io  0x0000-0x0cf7 window]
[    0.201752] pnp 00:00: [io  0x0d00-0xffff window]
[    0.201801] pnp 00:00: [mem 0x000a0000-0x000bffff window]
[    0.201851] pnp 00:00: [mem 0x000e0000-0x000effff window]
[    0.201901] pnp 00:00: [mem 0xf8000000-0xfeafffff window]
[    0.201951] pnp 00:00: [mem 0xd0000000-0xefffffff window]
[    0.202133] pnp 00:00: Plug and Play ACPI device, IDs PNP0a03 (active)
[    0.202203] pnp 00:01: [mem 0xf0000000-0xf7ffffff]
[    0.202252] pnp 00:01: [mem 0xfed13000-0xfed13fff]
[    0.202303] pnp 00:01: [mem 0xfed14000-0xfed17fff]
[    0.202352] pnp 00:01: [mem 0xfed18000-0xfed18fff]
[    0.202400] pnp 00:01: [mem 0xfed19000-0xfed19fff]
[    0.202448] pnp 00:01: [mem 0xfed1c000-0xfed1ffff]
[    0.202496] pnp 00:01: [mem 0xfed20000-0xfed3ffff]
[    0.202543] pnp 00:01: [mem 0xfed45000-0xfed99fff]
[    0.202591] pnp 00:01: [mem 0x000c0000-0x000dffff]
[    0.202639] pnp 00:01: [mem 0x000e0000-0x000fffff]
[    0.202834] system 00:01: [mem 0xf0000000-0xf7ffffff] has been reserved
[    0.202889] system 00:01: [mem 0xfed13000-0xfed13fff] has been reserved
[    0.202943] system 00:01: [mem 0xfed14000-0xfed17fff] has been reserved
[    0.202983] system 00:01: [mem 0xfed18000-0xfed18fff] has been reserved
[    0.203037] system 00:01: [mem 0xfed19000-0xfed19fff] has been reserved
[    0.203092] system 00:01: [mem 0xfed1c000-0xfed1ffff] has been reserved
[    0.203146] system 00:01: [mem 0xfed20000-0xfed3ffff] has been reserved
[    0.203200] system 00:01: [mem 0xfed45000-0xfed99fff] has been reserved
[    0.203255] system 00:01: [mem 0x000c0000-0x000dffff] could not be reserved
[    0.203311] system 00:01: [mem 0x000e0000-0x000fffff] could not be reserved
[    0.203371] system 00:01: Plug and Play ACPI device, IDs PNP0c02 (active)
[    0.203666] pnp 00:02: [io  0x0000-0x000f]
[    0.203713] pnp 00:02: [io  0x0081-0x0083]
[    0.203760] pnp 00:02: [io  0x0087]
[    0.203804] pnp 00:02: [io  0x0089-0x008b]
[    0.203850] pnp 00:02: [io  0x008f]
[    0.203894] pnp 00:02: [io  0x00c0-0x00df]
[    0.203982] pnp 00:02: [dma 4]
[    0.204094] pnp 00:02: Plug and Play ACPI device, IDs PNP0200 (active)
[    0.204165] pnp 00:03: [io  0x0070-0x0071]
[    0.204212] pnp 00:03: [io  0x0074-0x0077]
[    0.204271] pnp 00:03: [irq 8]
[    0.204382] pnp 00:03: Plug and Play ACPI device, IDs PNP0b00 (active)
[    0.204455] pnp 00:04: [io  0x00f0]
[    0.204505] pnp 00:04: [irq 13]
[    0.204628] pnp 00:04: Plug and Play ACPI device, IDs PNP0c04 (active)
[    0.204701] pnp 00:05: [io  0x0061]
[    0.204822] pnp 00:05: Plug and Play ACPI device, IDs PNP0800 (active)
[    0.204891] pnp 00:06: [io  0x0500-0x053f]
[    0.204938] pnp 00:06: [io  0x0400-0x047f]
[    0.204981] pnp 00:06: [io  0x0092]
[    0.205026] pnp 00:06: [io  0x0680-0x06ff]
[    0.205072] pnp 00:06: [io  0x0010-0x001f]
[    0.205118] pnp 00:06: [io  0x0072-0x0073]
[    0.205165] pnp 00:06: [io  0x0080]
[    0.205209] pnp 00:06: [io  0x0084-0x0086]
[    0.205255] pnp 00:06: [io  0x0088]
[    0.205299] pnp 00:06: [io  0x008c-0x008e]
[    0.205346] pnp 00:06: [io  0x0090-0x009f]
[    0.205519] system 00:06: [io  0x0500-0x053f] has been reserved
[    0.205571] system 00:06: [io  0x0400-0x047f] has been reserved
[    0.205624] system 00:06: [io  0x0680-0x06ff] has been reserved
[    0.205680] system 00:06: Plug and Play ACPI device, IDs PNP0c02 (active)
[    0.206283] pnp 00:07: [io  0x0378-0x037f]
[    0.206330] pnp 00:07: [io  0x0778-0x077f]
[    0.206383] pnp 00:07: [irq 7]
[    0.206427] pnp 00:07: [dma 0 disabled]
[    0.206602] pnp 00:07: Plug and Play ACPI device, IDs PNP0401 (active)
[    0.206717] pnp 00:08: [irq 12]
[    0.206839] pnp 00:08: Plug and Play ACPI device, IDs PNP0f03 PNP0f13 (active)
[    0.206945] pnp 00:09: [io  0x0060]
[    0.206981] pnp 00:09: [io  0x0064]
[    0.207032] pnp 00:09: [irq 1]
[    0.207153] pnp 00:09: Plug and Play ACPI device, IDs PNP0303 PNP030b (active)
[    0.207430] pnp 00:0a: [io  0x03f8-0x03ff]
[    0.207483] pnp 00:0a: [irq 4]
[    0.207665] pnp 00:0a: Plug and Play ACPI device, IDs PNP0501 (active)
[    0.207866] pnp 00:0b: [mem 0xfec00000-0xfec000ff]
[    0.208021] pnp 00:0b: Plug and Play ACPI device, IDs PNP0003 (active)
[    0.208213] pnp: PnP ACPI: found 12 devices
[    0.208260] ACPI: ACPI bus type pnp unregistered
[    0.212879] Switching to clocksource acpi_pm
[    0.213081] pci 0000:00:1c.0: bridge window [io  0x1000-0x0fff] to [bus 01-01] add_size 1000
[    0.213157] pci 0000:00:1c.0: bridge window [mem 0x00100000-0x000fffff 64bit pref] to [bus 01-01] add_size 200000
[    0.213245] pci 0000:00:1c.1: bridge window [mem 0x00100000-0x000fffff 64bit pref] to [bus 02-02] add_size 200000
[    0.213333] pci 0000:00:1c.2: bridge window [io  0x1000-0x0fff] to [bus 03-03] add_size 1000
[    0.213407] pci 0000:00:1c.2: bridge window [mem 0x00100000-0x000fffff 64bit pref] to [bus 03-03] add_size 200000
[    0.213494] pci 0000:00:1c.3: bridge window [io  0x1000-0x0fff] to [bus 04-04] add_size 1000
[    0.213576] pci 0000:00:1c.3: bridge window [mem 0x00100000-0x000fffff 64bit pref] to [bus 04-04] add_size 200000
[    0.213663] pci 0000:00:1c.4: bridge window [io  0x1000-0x0fff] to [bus 05-05] add_size 1000
[    0.213737] pci 0000:00:1c.4: bridge window [mem 0x00100000-0x000fffff 64bit pref] to [bus 05-05] add_size 200000
[    0.213835] pci 0000:00:1c.0: res[15]=[mem 0x00100000-0x000fffff 64bit pref] get_res_add_size add_size 200000
[    0.213912] pci 0000:00:1c.1: res[15]=[mem 0x00100000-0x000fffff 64bit pref] get_res_add_size add_size 200000
[    0.213990] pci 0000:00:1c.2: res[15]=[mem 0x00100000-0x000fffff 64bit pref] get_res_add_size add_size 200000
[    0.214615] pci 0000:00:1c.3: res[15]=[mem 0x00100000-0x000fffff 64bit pref] get_res_add_size add_size 200000
[    0.214694] pci 0000:00:1c.4: res[15]=[mem 0x00100000-0x000fffff 64bit pref] get_res_add_size add_size 200000
[    0.214771] pci 0000:00:1c.0: res[13]=[io  0x1000-0x0fff] get_res_add_size add_size 1000
[    0.214843] pci 0000:00:1c.2: res[13]=[io  0x1000-0x0fff] get_res_add_size add_size 1000
[    0.214916] pci 0000:00:1c.3: res[13]=[io  0x1000-0x0fff] get_res_add_size add_size 1000
[    0.214988] pci 0000:00:1c.4: res[13]=[io  0x1000-0x0fff] get_res_add_size add_size 1000
[    0.215076] pci 0000:00:1c.0: BAR 15: assigned [mem 0xe0900000-0xe0afffff 64bit pref]
[    0.215149] pci 0000:00:1c.1: BAR 15: assigned [mem 0xe0b00000-0xe0cfffff 64bit pref]
[    0.215222] pci 0000:00:1c.2: BAR 15: assigned [mem 0xe0d00000-0xe0efffff 64bit pref]
[    0.215295] pci 0000:00:1c.3: BAR 15: assigned [mem 0xe0f00000-0xe10fffff 64bit pref]
[    0.215368] pci 0000:00:1c.4: BAR 15: assigned [mem 0xe1100000-0xe12fffff 64bit pref]
[    0.215440] pci 0000:00:1c.0: BAR 13: assigned [io  0x3000-0x3fff]
[    0.215494] pci 0000:00:1c.2: BAR 13: assigned [io  0x4000-0x4fff]
[    0.215547] pci 0000:00:1c.3: BAR 13: assigned [io  0x5000-0x5fff]
[    0.215599] pci 0000:00:1c.4: BAR 13: assigned [io  0x6000-0x6fff]
[    0.215657] pci 0000:00:1c.0: PCI bridge to [bus 01-01]
[    0.215708] pci 0000:00:1c.0:   bridge window [io  0x3000-0x3fff]
[    0.215764] pci 0000:00:1c.0:   bridge window [mem 0xe0500000-0xe05fffff]
[    0.215821] pci 0000:00:1c.0:   bridge window [mem 0xe0900000-0xe0afffff 64bit pref]
[    0.215898] pci 0000:00:1c.1: PCI bridge to [bus 02-02]
[    0.215948] pci 0000:00:1c.1:   bridge window [io  0x1000-0x1fff]
[    0.216017] pci 0000:00:1c.1:   bridge window [mem 0xe0100000-0xe01fffff]
[    0.216074] pci 0000:00:1c.1:   bridge window [mem 0xe0b00000-0xe0cfffff 64bit pref]
[    0.216150] pci 0000:00:1c.2: PCI bridge to [bus 03-03]
[    0.216201] pci 0000:00:1c.2:   bridge window [io  0x4000-0x4fff]
[    0.216257] pci 0000:00:1c.2:   bridge window [mem 0xe0600000-0xe06fffff]
[    0.216313] pci 0000:00:1c.2:   bridge window [mem 0xe0d00000-0xe0efffff 64bit pref]
[    0.216390] pci 0000:00:1c.3: PCI bridge to [bus 04-04]
[    0.216440] pci 0000:00:1c.3:   bridge window [io  0x5000-0x5fff]
[    0.216496] pci 0000:00:1c.3:   bridge window [mem 0xe0700000-0xe07fffff]
[    0.216553] pci 0000:00:1c.3:   bridge window [mem 0xe0f00000-0xe10fffff 64bit pref]
[    0.216629] pci 0000:00:1c.4: PCI bridge to [bus 05-05]
[    0.216680] pci 0000:00:1c.4:   bridge window [io  0x6000-0x6fff]
[    0.216735] pci 0000:00:1c.4:   bridge window [mem 0xe0800000-0xe08fffff]
[    0.216792] pci 0000:00:1c.4:   bridge window [mem 0xe1100000-0xe12fffff 64bit pref]
[    0.216869] pci 0000:00:1e.0: PCI bridge to [bus 06-06]
[    0.216922] pci 0000:00:1e.0:   bridge window [mem 0xe0000000-0xe00fffff]
[    0.217069] pci 0000:00:1e.0: setting latency timer to 64
[    0.217122] pci_bus 0000:00: resource 4 [io  0x0000-0xffff]
[    0.217172] pci_bus 0000:00: resource 5 [mem 0x00000000-0xfffffffff]
[    0.217225] pci_bus 0000:01: resource 0 [io  0x3000-0x3fff]
[    0.217275] pci_bus 0000:01: resource 1 [mem 0xe0500000-0xe05fffff]
[    0.217328] pci_bus 0000:01: resource 2 [mem 0xe0900000-0xe0afffff 64bit pref]
[    0.217397] pci_bus 0000:02: resource 0 [io  0x1000-0x1fff]
[    0.217448] pci_bus 0000:02: resource 1 [mem 0xe0100000-0xe01fffff]
[    0.217500] pci_bus 0000:02: resource 2 [mem 0xe0b00000-0xe0cfffff 64bit pref]
[    0.217570] pci_bus 0000:03: resource 0 [io  0x4000-0x4fff]
[    0.217620] pci_bus 0000:03: resource 1 [mem 0xe0600000-0xe06fffff]
[    0.217672] pci_bus 0000:03: resource 2 [mem 0xe0d00000-0xe0efffff 64bit pref]
[    0.217742] pci_bus 0000:04: resource 0 [io  0x5000-0x5fff]
[    0.217792] pci_bus 0000:04: resource 1 [mem 0xe0700000-0xe07fffff]
[    0.217845] pci_bus 0000:04: resource 2 [mem 0xe0f00000-0xe10fffff 64bit pref]
[    0.217914] pci_bus 0000:05: resource 0 [io  0x6000-0x6fff]
[    0.217964] pci_bus 0000:05: resource 1 [mem 0xe0800000-0xe08fffff]
[    0.218030] pci_bus 0000:05: resource 2 [mem 0xe1100000-0xe12fffff 64bit pref]
[    0.218100] pci_bus 0000:06: resource 1 [mem 0xe0000000-0xe00fffff]
[    0.218153] pci_bus 0000:06: resource 4 [io  0x0000-0xffff]
[    0.218203] pci_bus 0000:06: resource 5 [mem 0x00000000-0xfffffffff]
[    0.218331] NET: Registered protocol family 2
[    0.218782] IP route cache hash table entries: 262144 (order: 9, 2097152 bytes)
[    0.220682] TCP established hash table entries: 524288 (order: 11, 8388608 bytes)
[    0.225320] TCP bind hash table entries: 65536 (order: 10, 4194304 bytes)
[    0.230962] TCP: Hash tables configured (established 524288 bind 65536)
[    0.231095] TCP: reno registered
[    0.231226] UDP hash table entries: 4096 (order: 7, 655360 bytes)
[    0.232073] UDP-Lite hash table entries: 4096 (order: 7, 655360 bytes)
[    0.233028] NET: Registered protocol family 1
[    0.233103] pci 0000:00:02.0: Boot video device
[    0.233703] PCI: CLS 64 bytes, default 64
[    0.233944] Unpacking initramfs...
[    1.586692] Freeing initrd memory: 9732k freed
[    1.590797] PCI-DMA: Using software bounce buffering for IO (SWIOTLB)
[    1.590857] Placing 64MB software IO TLB between ffff8800caff6000 - ffff8800ceff6000
[    1.590929] software IO TLB at phys 0xcaff6000 - 0xceff6000
[    1.592121] audit: initializing netlink socket (disabled)
[    1.592220] type=2000 audit(1338821347.591:1): initialized
[    1.614186] HugeTLB registered 2 MB page size, pre-allocated 0 pages
[    1.619324] VFS: Disk quotas dquot_6.5.2
[    1.619470] Dquot-cache hash table entries: 512 (order 0, 4096 bytes)
[    1.620452] squashfs: version 4.0 (2009/01/31) Phillip Lougher
[    1.620829] msgmni has been set to 15666
[    1.621755] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 253)
[    1.621847] io scheduler noop registered
[    1.621894] io scheduler deadline registered
[    1.622066] io scheduler cfq registered (default)
[    1.622505] pcieport 0000:00:1c.0: irq 40 for MSI/MSI-X
[    1.622765] pcieport 0000:00:1c.1: irq 41 for MSI/MSI-X
[    1.622970] pcieport 0000:00:1c.2: irq 42 for MSI/MSI-X
[    1.623204] pcieport 0000:00:1c.3: irq 43 for MSI/MSI-X
[    1.623415] pcieport 0000:00:1c.4: irq 44 for MSI/MSI-X
[    1.623631] pci_hotplug: PCI Hot Plug PCI Core version: 0.5
[    1.623842] pciehp: PCI Express Hot Plug Controller Driver version: 0.4
[    1.623989] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled
[    1.644666] serial8250: ttyS0 at I/O 0x3f8 (irq = 4) is a 16550A
[    1.667258] 00:0a: ttyS0 at I/O 0x3f8 (irq = 4) is a 16550A
[    1.667970] Linux agpgart interface v0.103
[    1.668343] agpgart-intel 0000:00:00.0: Intel 965G Chipset
[    1.668716] agpgart-intel 0000:00:00.0: detected gtt size: 524288K total, 262144K mappable
[    1.669982] agpgart-intel 0000:00:00.0: detected 8192K stolen memory
[    1.670316] agpgart-intel 0000:00:00.0: AGP aperture is 256M @ 0xd0000000
[    1.670885] intel_idle: does not run on family 6 model 15
[    1.671185] input: Sleep Button as /devices/LNXSYSTM:00/device:00/PNP0C0E:00/input/input0
[    1.671327] ACPI: Sleep Button [SLPB]
[    1.671485] input: Power Button as /devices/LNXSYSTM:00/LNXPWRBN:00/input/input1
[    1.671559] ACPI: Power Button [PWRF]
[    1.671784] ACPI: Requesting acpi_cpufreq
[    1.680896] ioatdma: Intel(R) QuickData Technology Driver 4.00
[    1.681056] XENFS: not registering filesystem on non-xen platform
[    1.681185] [drm] Initialized drm 1.1.0 20060810
[    1.681667] [drm] radeon defaulting to kernel modesetting.
[    1.681717] [drm] radeon kernel modesetting enabled.
[    1.683309] i915 0000:00:02.0: setting latency timer to 64
[    1.826442] i915 0000:00:02.0: irq 45 for MSI/MSI-X
[    1.826510] [drm] Supports vblank timestamp caching Rev 1 (10.10.2010).
[    1.826563] [drm] Driver supports precise vblank timestamp query.
[    1.826870] vgaarb: device changed decodes: PCI:0000:00:02.0,olddecodes=io+mem,decodes=io+mem:owns=io+mem
[    1.934937] [drm] initialized overlay support
[    2.027855] fbcon: inteldrmfb (fb0) is primary device
[    2.154289] Console: switching to colour frame buffer device 240x75
[    2.160359] fb0: inteldrmfb frame buffer device
[    2.160387] drm: registered panic notifier
[    2.160487] [drm] Initialized i915 1.6.0 20080730 for 0000:00:02.0 on minor 0
[    2.160970] usbcore: registered new interface driver udl
[    2.163134] loop: module loaded
[    2.163307] Loading iSCSI transport class v2.0-870.
[    2.163515] iscsi: registered transport (tcp)
[    2.163658] ahci 0000:00:1f.2: version 3.0
[    2.163762] ahci 0000:00:1f.2: irq 46 for MSI/MSI-X
[    2.163897] ahci 0000:00:1f.2: AHCI 0001.0100 32 slots 4 ports 3 Gbps 0x33 impl SATA mode
[    2.163941] ahci 0000:00:1f.2: flags: 64bit ncq sntf led clo pio slum part ccc ems 
[    2.163983] ahci 0000:00:1f.2: setting latency timer to 64
[    2.171845] scsi0 : ahci
[    2.172238] scsi1 : ahci
[    2.172430] scsi2 : ahci
[    2.172604] scsi3 : ahci
[    2.172780] scsi4 : ahci
[    2.172951] scsi5 : ahci
[    2.173405] ata1: SATA max UDMA/133 abar m2048 at 0xe0425000 port 0xe0425100 irq 46
[    2.173445] ata2: SATA max UDMA/133 abar m2048 at 0xe0425000 port 0xe0425180 irq 46
[    2.173483] ata3: DUMMY
[    2.173498] ata4: DUMMY
[    2.173514] ata5: SATA max UDMA/133 abar m2048 at 0xe0425000 port 0xe0425300 irq 46
[    2.173553] ata6: SATA max UDMA/133 abar m2048 at 0xe0425000 port 0xe0425380 irq 46
[    2.174372] scsi6 : pata_legacy
[    2.174487] ata7: PATA max PIO4 cmd 0x1f0 ctl 0x3f6 irq 14
[    2.478061] ata1: SATA link up 3.0 Gbps (SStatus 123 SControl 300)
[    2.478131] ata2: SATA link down (SStatus 0 SControl 300)
[    2.479054] ata6: SATA link down (SStatus 0 SControl 300)
[    2.479128] ata5: SATA link up 1.5 Gbps (SStatus 113 SControl 300)
[    2.481865] ata5.00: ATAPI: Optiarc BD RW BD-5300S, 1.04, max UDMA/100
[    2.483547] ata5.00: configured for UDMA/100
[    2.519074] ata1.00: ATA-7: ST3250820AS, 3.AAE, max UDMA/133
[    2.519116] ata1.00: 488397168 sectors, multi 0: LBA48 NCQ (depth 31/32)
[    2.577378] ata1.00: configured for UDMA/133
[    2.578171] scsi 0:0:0:0: Direct-Access     ATA      ST3250820AS      3.AA PQ: 0 ANSI: 5
[    2.578908] sd 0:0:0:0: [sda] 488397168 512-byte logical blocks: (250 GB/232 GiB)
[    2.579070] sd 0:0:0:0: [sda] Write Protect is off
[    2.579099] sd 0:0:0:0: [sda] Mode Sense: 00 3a 00 00
[    2.579170] sd 0:0:0:0: [sda] Write cache: enabled, read cache: enabled, doesn't support DPO or FUA
[    2.583760] scsi 4:0:0:0: CD-ROM            Optiarc  BD RW BD-5300S   1.04 PQ: 0 ANSI: 5
[    2.588327] sr0: scsi3-mmc drive: 48x/48x writer dvd-ram cd/rw xa/form2 cdda tray
[    2.588380] cdrom: Uniform CD-ROM driver Revision: 3.20
[    2.589068] sr 4:0:0:0: Attached scsi CD-ROM sr0
[    2.592137] Refined TSC clocksource calibration: 2131.204 MHz.
[    2.592209] Switching to clocksource tsc
[    2.617308]  sda: sda1 sda2 sda3
[    2.618193] sd 0:0:0:0: [sda] Attached SCSI disk
[    2.620065] scsi7 : pata_legacy
[    2.620178] ata8: PATA max PIO4 cmd 0x170 ctl 0x376 irq 15
[    2.772931] i8042: PNP: PS/2 Controller [PNP0303:PS2K,PNP0f03:PS2M] at 0x60,0x64 irq 1,12
[    2.777683] serio: i8042 KBD port at 0x60,0x64 irq 1
[    2.779587] serio: i8042 AUX port at 0x60,0x64 irq 12
[    2.781369] mousedev: PS/2 mouse device common for all mice
[    2.783603] rtc_cmos 00:03: RTC can wake from S4
[    2.785519] rtc_cmos 00:03: rtc core: registered rtc_cmos as rtc0
[    2.787135] rtc0: alarms up to one month, 114 bytes nvram
[    2.788758] cpuidle: using governor ladder
[    2.790315] cpuidle: using governor menu
[    2.792115] TCP: cubic registered
[    2.793660] Initializing XFRM netlink socket
[    2.795525] NET: Registered protocol family 10
[    2.797626] NET: Registered protocol family 17
[    2.799137] Registering the dns_resolver key type
[    2.801074] PM: Hibernation image not present or could not be loaded.
[    2.802591] registered taskstats version 1
[    2.805150] input: AT Translated Set 2 keyboard as /devices/platform/i8042/serio0/input/input2
[    2.806824] rtc_cmos 00:03: setting system clock to 2012-06-04 14:49:09 UTC (1338821349)
[    2.811261] Freeing unused kernel memory: 708k freed
[    2.812953] Write protecting the kernel read-only data: 12288k
[    2.819982] Freeing unused kernel memory: 1452k freed
[    2.825389] Freeing unused kernel memory: 936k freed
[    2.888293] device-mapper: uevent: version 1.0.3
[    2.890146] device-mapper: ioctl: 4.22.0-ioctl (2011-10-19) initialised: dm-devel at redhat.com
[    2.897704] udevd[125]: starting version 182
[    3.016109] Btrfs loaded
[    3.018700] device fsid d929bdc7-2817-402a-8582-6681d80d5e85 devid 1 transid 1106 /dev/sda1
[    3.032626] uhci_hcd: USB Universal Host Controller Interface driver
[    3.035105] uhci_hcd 0000:00:1a.0: setting latency timer to 64
[    3.036886] uhci_hcd 0000:00:1a.0: UHCI Host Controller
[    3.039267] uhci_hcd 0000:00:1a.0: new USB bus registered, assigned bus number 1
[    3.041511] uhci_hcd 0000:00:1a.0: irq 16, io base 0x000020c0
[    3.042616] ehci_hcd: USB 2.0 'Enhanced' Host Controller (EHCI) Driver
[    3.042619] Warning! ehci_hcd should always be loaded before uhci_hcd and ohci_hcd, not after
[    3.049692] hub 1-0:1.0: USB hub found
[    3.051351] hub 1-0:1.0: 2 ports detected
[    3.052972] scsi8 : pata_marvell
[    3.055487] scsi9 : pata_marvell
[    3.057727] ata9: PATA max UDMA/100 cmd 0x1018 ctl 0x1024 bmdma 0x1000 irq 17
[    3.059399] ata10: DUMMY
[    3.061194] ehci_hcd 0000:00:1a.7: setting latency timer to 64
[    3.063222] ehci_hcd 0000:00:1a.7: EHCI Host Controller
[    3.065065] ehci_hcd 0000:00:1a.7: new USB bus registered, assigned bus number 2
[    3.067365] ehci_hcd 0000:00:1a.7: debug port 1
[    3.073697] ehci_hcd 0000:00:1a.7: cache line size of 64 is not supported
[    3.075569] ehci_hcd 0000:00:1a.7: irq 18, io mem 0xe0425c00
[    3.083033] ehci_hcd 0000:00:1a.7: USB 2.0 started, EHCI 1.00
[    3.085749] hub 2-0:1.0: USB hub found
[    3.087386] hub 2-0:1.0: 4 ports detected
[    3.094885] uhci_hcd 0000:00:1a.1: setting latency timer to 64
[    3.096501] uhci_hcd 0000:00:1a.1: UHCI Host Controller
[    3.098116] uhci_hcd 0000:00:1a.1: new USB bus registered, assigned bus number 3
[    3.099575] firewire_ohci 0000:06:03.0: added OHCI v1.10 device as card 0, 4 IR + 8 IT contexts, quirks 0x2
[    3.101409] uhci_hcd 0000:00:1a.1: irq 21, io base 0x000020a0
[    3.103668] hub 3-0:1.0: USB hub found
[    3.105287] hub 3-0:1.0: 2 ports detected
[    3.107330] ehci_hcd 0000:00:1d.7: setting latency timer to 64
[    3.108935] ehci_hcd 0000:00:1d.7: EHCI Host Controller
[    3.110587] ehci_hcd 0000:00:1d.7: new USB bus registered, assigned bus number 4
[    3.112222] ehci_hcd 0000:00:1d.7: debug port 1
[    3.118031] ehci_hcd 0000:00:1d.7: cache line size of 64 is not supported
[    3.119957] ehci_hcd 0000:00:1d.7: irq 23, io mem 0xe0425800
[    3.127584] ehci_hcd 0000:00:1d.7: USB 2.0 started, EHCI 1.00
[    3.130938] hub 4-0:1.0: USB hub found
[    3.133497] hub 4-0:1.0: 6 ports detected
[    3.137112] uhci_hcd 0000:00:1d.0: setting latency timer to 64
[    3.138794] uhci_hcd 0000:00:1d.0: UHCI Host Controller
[    3.143026] uhci_hcd 0000:00:1d.0: new USB bus registered, assigned bus number 5
[    3.146059] uhci_hcd 0000:00:1d.0: irq 23, io base 0x00002080
[    3.152315] hub 5-0:1.0: USB hub found
[    3.152325] hub 5-0:1.0: 2 ports detected
[    3.154666] uhci_hcd 0000:00:1d.1: setting latency timer to 64
[    3.154671] uhci_hcd 0000:00:1d.1: UHCI Host Controller
[    3.154726] uhci_hcd 0000:00:1d.1: new USB bus registered, assigned bus number 6
[    3.154759] uhci_hcd 0000:00:1d.1: irq 19, io base 0x00002060
[    3.156486] hub 6-0:1.0: USB hub found
[    3.156495] hub 6-0:1.0: 2 ports detected
[    3.156853] uhci_hcd 0000:00:1d.2: setting latency timer to 64
[    3.156857] uhci_hcd 0000:00:1d.2: UHCI Host Controller
[    3.156878] uhci_hcd 0000:00:1d.2: new USB bus registered, assigned bus number 7
[    3.156912] uhci_hcd 0000:00:1d.2: irq 18, io base 0x00002040
[    3.159905] hub 7-0:1.0: USB hub found
[    3.159915] hub 7-0:1.0: 2 ports detected
[    3.391049] usb 2-3: new high-speed USB device number 2 using ehci_hcd
[    3.423480] device fsid d929bdc7-2817-402a-8582-6681d80d5e85 devid 1 transid 1106 /dev/sda1
[    3.600995] firewire_core 0000:06:03.0: created device fw0: GUID 0090270001b8b988, S400
[    3.611040] usb 2-4: new high-speed USB device number 3 using ehci_hcd
[    3.728019] hub 2-4:1.0: USB hub found
[    3.730342] hub 2-4:1.0: 3 ports detected
[    3.817286] input: ImExPS/2 Logitech Wheel Mouse as /devices/platform/i8042/serio1/input/input3
[    3.937033] usb 4-2: new high-speed USB device number 3 using ehci_hcd
[    4.535031] usb 5-1: new full-speed USB device number 2 using uhci_hcd
[    4.729896] dracut: Checking btrfs: /dev/sda1
[    4.733287] dracut: trying to mount /dev/sda1
[    4.745131] device fsid d929bdc7-2817-402a-8582-6681d80d5e85 
[    4.745202] usb 2-4.1: new high-speed USB device number 4 using ehci_hcd
[    4.745206] devid 1 transid 1106 /dev/sda1
[    4.836771] hub 2-4.1:1.0: USB hub found
[    4.838920] hub 2-4.1:1.0: 3 ports detected
[    5.114176] usb 2-4.1.1: new high-speed USB device number 5 using ehci_hcd
[    5.250418] Initializing USB Mass Storage driver...
[    5.252919] scsi10 : usb-storage 2-4.1.1:1.0
[    5.255216] usbcore: registered new interface driver usb-storage
[    5.257251] USB Mass Storage support registered.
[    5.969743] dracut: btrfs: /dev/sda1 is clean
[    6.267512] scsi 10:0:0:0: Direct-Access     Generic  Ultra HS-SD/MMC  1.82 PQ: 0 ANSI: 0
[    6.289067] sd 10:0:0:0: [sdb] Attached SCSI removable disk
[  161.757851] dracut: Remounting /dev/sda1 with -o subvol=gentoo-gnome-32-a,ro
[  161.768886] device fsid d929bdc7-2817-402a-8582-6681d80d5e85 devid 1 transid 1109 /dev/sda1
[  163.077595] dracut: Mounted root filesystem /dev/sda1
[  163.193212] dracut: Switching root
[  165.539227] udevd[324]: starting version 182
[  167.007442] parport_pc 00:07: reported by Plug and Play ACPI
[  167.009882] parport0: PC-style at 0x378 (0x778), irq 7, using FIFO [PCSPP,TRISTATE,COMPAT,ECP]
[  167.064364] WARNING! power/level is deprecated; use power/control instead
[  167.077568] mei: module is from the staging directory, the quality is unknown, you have been warned.
[  167.080295] mei 0000:00:03.0: setting latency timer to 64
[  167.082011] mei 0000:00:03.0: irq 47 for MSI/MSI-X
[  167.102666] e1000e: Intel(R) PRO/1000 Network Driver - 1.9.5-k
[  167.104643] e1000e: Copyright(c) 1999 - 2012 Intel Corporation.
[  167.106700] e1000e 0000:00:19.0: setting latency timer to 64
[  167.108305] e1000e 0000:00:19.0: (unregistered net_device): Interrupt Throttling Rate (ints/sec) set to dynamic conservative mode
[  167.110298] e1000e 0000:00:19.0: irq 48 for MSI/MSI-X
[  167.225608] iTCO_vendor_support: vendor-support=0
[  167.431485] e1000e 0000:00:19.0: eth0: (PCI Express:2.5GT/s:Width x1) 00:19:d1:04:28:5d
[  167.433373] e1000e 0000:00:19.0: eth0: Intel(R) PRO/1000 Network Connection
[  167.435261] e1000e 0000:00:19.0: eth0: MAC: 6, PHY: 6, PBA No: FFFFFF-0FF
[  167.458257] cfg80211: Calling CRDA to update world regulatory domain
[  167.466963] microcode: CPU0 sig=0x6f6, pf=0x1, revision=0x44
[  167.732053] usb 2-3: reset high-speed USB device number 2 using ehci_hcd
[  167.734496] Linux media interface: v0.10
[  167.911796] Linux video capture interface: v2.00
[  168.066713] iTCO_wdt: Intel TCO WatchDog Timer Driver v1.07
[  168.067761] ppdev: user-space parallel port driver
[  168.070786] iTCO_wdt: Found a ICH8 or ICH8R TCO device (Version=2, TCOBASE=0x0460)
[  168.073209] iTCO_wdt: initialized. heartbeat=30 sec (nowayout=0)
[  168.286629] microcode: CPU0 updated to revision 0xd0, date = 2010-09-30
[  168.288558] microcode: CPU1 sig=0x6f6, pf=0x1, revision=0x44
[  168.292005] microcode: CPU1 updated to revision 0xd0, date = 2010-09-30
[  168.294490] microcode: Microcode Update Driver: v2.00 <tigran at aivazian.fsnet.co.uk>, Peter Oruba
[  168.436949] ieee80211 phy0: Selected rate control algorithm 'minstrel_ht'
[  168.439697] zd1211rw 2-3:1.0: phy0
[  168.441682] usbcore: registered new interface driver zd1211rw
[  168.570847] coretemp coretemp.0: Using relative temperature scale!
[  168.572756] coretemp coretemp.0: Using relative temperature scale!
[  168.638658] input: PC Speaker as /devices/platform/pcspkr/input/input4
[  168.860555] uvcvideo: Found UVC 1.00 device <unnamed> (046d:0821)
[  168.942422] snd_hda_intel 0000:00:1b.0: irq 49 for MSI/MSI-X
[  169.076751] input: UVC Camera (046d:0821) as /devices/pci0000:00/0000:00:1d.7/usb4/4-2/4-2:1.2/input/input5
[  169.079890] usbcore: registered new interface driver uvcvideo
[  169.081922] USB Video Class driver (1.1.1)
[  169.091044] saa7130/34: v4l2 driver version 0, 2, 17 loaded
[  169.093190] saa7133[0]: found at 0000:06:01.0, rev: 209, irq: 22, latency: 32, mmio: 0xe0004800
[  169.095266] saa7133[0]: subsystem: 11bd:002f, board: Pinnacle PCTV 310i [card=101,autodetected]
[  169.097469] saa7133[0]: board init: gpio is 600c000
[  169.135999] usbcore: registered new interface driver snd-usb-audio
[  169.174213] input: HDA Intel Line as /devices/pci0000:00/0000:00:1b.0/sound/card0/input6
[  169.176640] input: HDA Intel Rear Mic as /devices/pci0000:00/0000:00:1b.0/sound/card0/input7
[  169.179071] input: HDA Intel Front Mic as /devices/pci0000:00/0000:00:1b.0/sound/card0/input8
[  169.181433] input: HDA Intel Front Headphone as /devices/pci0000:00/0000:00:1b.0/sound/card0/input9
[  169.183819] input: HDA Intel Line Out Side as /devices/pci0000:00/0000:00:1b.0/sound/card0/input10
[  169.186214] input: HDA Intel Line Out CLFE as /devices/pci0000:00/0000:00:1b.0/sound/card0/input11
[  169.188609] input: HDA Intel Line Out Surround as /devices/pci0000:00/0000:00:1b.0/sound/card0/input12
[  169.191038] input: HDA Intel Line Out Front as /devices/pci0000:00/0000:00:1b.0/sound/card0/input13
[  169.202183] saa7133[0]: i2c eeprom read error (err=-5)
[  170.135426] i2c-core: driver [tuner] using legacy suspend method
[  170.137698] i2c-core: driver [tuner] using legacy resume method
[  170.147019] tuner 10-004b: Tuner -1 found with type(s) Radio TV.
[  170.185029] tda829x 10-004b: setting tuner address to 61
[  170.218023] tda829x 10-004b: type set to tda8290+75a
[  170.271326] device fsid d929bdc7-2817-402a-8582-6681d80d5e85 devid 1 transid 1109 /dev/sda1
[  172.016983] EXT4-fs (sda3): mounted filesystem with ordered data mode. Opts: (null)
[  173.401166] saa7133[0]: registered device video1 [v4l2]
[  173.401323] saa7133[0]: registered device vbi0
[  173.401467] saa7133[0]: registered device radio0
[  174.748569] dvb_init() allocating 1 frontend
[  174.751108] DVB: registering new adapter (saa7133[0])
[  174.751289] DVB: registering adapter 0 frontend 0 (Philips TDA10046H DVB-T)...
[  174.779018] tda1004x: setting up plls for 48MHz sampling clock
[  174.940019] tda1004x: found firmware revision 29 -- ok
[  328.566200] saa7134 ALSA driver for DMA sound loaded
[  328.566340] saa7133[0]/alsa: saa7133[0] at 0xe0004800 irq 22 registered as card 1
[  331.069525] Bridge firewalling registered
[  331.232246] tun: Universal TUN/TAP device driver, 1.6
[  331.232288] tun: (C) 1999-2004 Max Krasnyansky <maxk at qualcomm.com>
[  331.253201] device virbr0-nic entered promiscuous mode
[  331.694464] ip_tables: (C) 2000-2006 Netfilter Core Team
[  332.584528] ADDRCONF(NETDEV_UP): virbr0: link is not ready
[  481.613024] INFO: task systemd:1 blocked for more than 120 seconds.
[  481.613073] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message.
[  481.613125] systemd         D 0000000000000246     0     1      0 0x20020000
[  481.613184]  ffff88021e46dd78 0000000000000046 0000000000000000 0000000000000002
[  481.613252]  ffff88021e46dfd8 ffff88021e470000 ffff88021e46dfd8 ffff88021e46c000
[  481.613320]  0000000000013b40 ffff88021e46c000 ffff88021e46dfd8 0000000000013b40
[  481.613388] Call Trace:
[  481.613415]  [<ffffffff81081991>] ? get_parent_ip+0x11/0x50
[  481.613457]  [<ffffffff81686aad>] ? sub_preempt_count+0x9d/0xd0
[  481.613502]  [<ffffffff810ad191>] ? mark_held_locks+0x61/0x140
[  481.613545]  [<ffffffff811760a5>] ? kern_path_create+0x85/0x130
[  481.613588]  [<ffffffff816814b4>] schedule+0x24/0x70
[  481.613625]  [<ffffffff81681873>] schedule_preempt_disabled+0x13/0x20
[  481.613670]  [<ffffffff8167fcfd>] mutex_lock_nested+0x18d/0x3d0
[  481.613712]  [<ffffffff811760a5>] ? kern_path_create+0x85/0x130
[  481.613755]  [<ffffffff811760a5>] kern_path_create+0x85/0x130
[  481.613797]  [<ffffffff81172eaf>] ? getname_flags+0x6f/0x270
[  481.613838]  [<ffffffff81176198>] user_path_create+0x48/0x70
[  481.613880]  [<ffffffff8117785c>] sys_mkdirat+0x2c/0xe0
[  481.613918]  [<ffffffff81177924>] sys_mkdir+0x14/0x20
[  481.613956]  [<ffffffff8168bb66>] sysenter_dispatch+0x7/0x26
[  481.613998]  [<ffffffff8128fa6e>] ? trace_hardirqs_on_thunk+0x3a/0x3f
[  481.614064] 1 lock held by systemd/1:
[  481.614094]  #0:  (&type->i_mutex_dir_key#3/1){+.+.+.}, at: [<ffffffff811760a5>] kern_path_create+0x85/0x130
[  481.614208] INFO: task systemd-readahe:313 blocked for more than 120 seconds.
[  481.614256] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message.
[  481.614308] systemd-readahe D 0000000000078000     0   313      1 0x20020000
[  481.614368]  ffff88021d033b78 0000000000000046 ffff88021d033a58 0000000000000000
[  481.614440]  ffff88021d033fd8 ffff880219d5ddf0 ffff88021d033fd8 ffff88021d032000
[  481.614510]  0000000000013b40 ffff88021d032000 ffff88021d033fd8 0000000000013b40
[  481.614581] Call Trace:
[  481.614606]  [<ffffffff810ad191>] ? mark_held_locks+0x61/0x140
[  481.614651]  [<ffffffff81682ee5>] ? _raw_spin_unlock_irqrestore+0x65/0x80
[  481.614699]  [<ffffffff81081991>] ? get_parent_ip+0x11/0x50
[  481.614740]  [<ffffffff81686aad>] ? sub_preempt_count+0x9d/0xd0
[  481.614784]  [<ffffffff81682ec5>] ? _raw_spin_unlock_irqrestore+0x45/0x80
[  481.614834]  [<ffffffff81072689>] ? prepare_to_wait+0x59/0x90
[  481.614878]  [<ffffffff816814b4>] schedule+0x24/0x70
[  481.614943]  [<ffffffffa0068be5>] wait_current_trans.clone.23+0xb5/0x100 [btrfs]
[  481.614996]  [<ffffffff81072390>] ? wake_up_bit+0x40/0x40
[  481.615068]  [<ffffffffa006a16a>] start_transaction+0x12a/0x350 [btrfs]
[  481.615116]  [<ffffffff81686aad>] ? sub_preempt_count+0x9d/0xd0
[  481.617108]  [<ffffffffa006a67e>] btrfs_start_transaction+0xe/0x10 [btrfs]
[  481.619127]  [<ffffffffa00771e1>] btrfs_create+0x41/0x210 [btrfs]
[  481.621129]  [<ffffffff81253d47>] ? security_inode_permission+0x17/0x20
[  481.623136]  [<ffffffff81173e7d>] vfs_create+0xad/0x110
[  481.625118]  [<ffffffff81176bf5>] do_last+0x605/0x930
[  481.627130]  [<ffffffff81177034>] path_openat+0xd4/0x440
[  481.629109]  [<ffffffff81686422>] ? do_page_fault+0xe2/0x560
[  481.631104]  [<ffffffff811774b4>] do_filp_open+0x44/0xa0
[  481.633101]  [<ffffffff81686aad>] ? sub_preempt_count+0x9d/0xd0
[  481.635118]  [<ffffffff81682f30>] ? _raw_spin_unlock+0x30/0x60
[  481.637136]  [<ffffffff81183f0a>] ? alloc_fd+0xda/0x130
[  481.639130]  [<ffffffff8116688d>] do_sys_open+0xfd/0x1d0
[  481.641132]  [<ffffffff811b5706>] compat_sys_open+0x16/0x20
[  481.643114]  [<ffffffff8168bb66>] sysenter_dispatch+0x7/0x26
[  481.645092] 1 lock held by systemd-readahe/313:
[  481.647055]  #0:  (&type->i_mutex_dir_key#3){+.+.+.}, at: [<ffffffff811769ab>] do_last+0x3bb/0x930
[  481.649086] INFO: task libvirtd:550 blocked for more than 120 seconds.
[  481.651082] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message.
[  481.653092] libvirtd        D 0000000000078000     0   550      1 0x20020000
[  481.655123]  ffff88021c07fb78 0000000000200046 ffff88021c07fa58 ffffffff81081991
[  481.657184]  ffff88021c07ffd8 ffff88021ce78000 ffff88021c07ffd8 ffff88021c07e000
[  481.659221]  0000000000013b40 ffff88021c07e000 ffff88021c07ffd8 0000000000013b40
[  481.661246] Call Trace:
[  481.663235]  [<ffffffff81081991>] ? get_parent_ip+0x11/0x50
[  481.665238]  [<ffffffff810ad191>] ? mark_held_locks+0x61/0x140
[  481.667239]  [<ffffffff81682ee5>] ? _raw_spin_unlock_irqrestore+0x65/0x80
[  481.669233]  [<ffffffff81081991>] ? get_parent_ip+0x11/0x50
[  481.671240]  [<ffffffff81686aad>] ? sub_preempt_count+0x9d/0xd0
[  481.673247]  [<ffffffff81682ec5>] ? _raw_spin_unlock_irqrestore+0x45/0x80
[  481.675284]  [<ffffffff81072689>] ? prepare_to_wait+0x59/0x90
[  481.677329]  [<ffffffff816814b4>] schedule+0x24/0x70
[  481.679375]  [<ffffffffa0068be5>] wait_current_trans.clone.23+0xb5/0x100 [btrfs]
[  481.681439]  [<ffffffff81072390>] ? wake_up_bit+0x40/0x40
[  481.683496]  [<ffffffffa006a16a>] start_transaction+0x12a/0x350 [btrfs]
[  481.685528]  [<ffffffff81686aad>] ? sub_preempt_count+0x9d/0xd0
[  481.687590]  [<ffffffffa006a67e>] btrfs_start_transaction+0xe/0x10 [btrfs]
[  481.689653]  [<ffffffffa00771e1>] btrfs_create+0x41/0x210 [btrfs]
[  481.691668]  [<ffffffff81253d47>] ? security_inode_permission+0x17/0x20
[  481.693688]  [<ffffffff81173e7d>] vfs_create+0xad/0x110
[  481.695695]  [<ffffffff81176bf5>] do_last+0x605/0x930
[  481.697694]  [<ffffffff81177034>] path_openat+0xd4/0x440
[  481.699692]  [<ffffffff81185140>] ? vfsmount_lock_local_unlock+0x70/0x70
[  481.701696]  [<ffffffff8117e599>] ? dput+0x29/0x1d0
[  481.703720]  [<ffffffff811774b4>] do_filp_open+0x44/0xa0
[  481.705732]  [<ffffffff81686aad>] ? sub_preempt_count+0x9d/0xd0
[  481.707742]  [<ffffffff81682f30>] ? _raw_spin_unlock+0x30/0x60
[  481.709739]  [<ffffffff81183f0a>] ? alloc_fd+0xda/0x130
[  481.711739]  [<ffffffff8116688d>] do_sys_open+0xfd/0x1d0
[  481.713763]  [<ffffffff811b5706>] compat_sys_open+0x16/0x20
[  481.715776]  [<ffffffff8168bb66>] sysenter_dispatch+0x7/0x26
[  481.717778]  [<ffffffff8128fa6e>] ? trace_hardirqs_on_thunk+0x3a/0x3f
[  481.719807] 1 lock held by libvirtd/550:
[  481.721844]  #0:  (&type->i_mutex_dir_key#3){+.+.+.}, at: [<ffffffff811769ab>] do_last+0x3bb/0x930
[  481.723950] INFO: task gdm:523 blocked for more than 120 seconds.
[  481.726023] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message.
[  481.728145] gdm             D 0000000000000000     0   523    513 0x20020000
[  481.729871]  ffff88021d051ce8 0000000000000046 ffff88021d051ca8 0000000000000046
[  481.731533]  ffff88021d051fd8 ffff880219b33ea0 ffff88021d051fd8 ffff88021d050000
[  481.733189]  0000000000013b40 ffff88021d050000 ffff88021d051fd8 0000000000013b40
[  481.734857] Call Trace:
[  481.736499]  [<ffffffff81072655>] ? prepare_to_wait+0x25/0x90
[  481.738135]  [<ffffffff81682ee5>] ? _raw_spin_unlock_irqrestore+0x65/0x80
[  481.739794]  [<ffffffff81081991>] ? get_parent_ip+0x11/0x50
[  481.741418]  [<ffffffff81686aad>] ? sub_preempt_count+0x9d/0xd0
[  481.743065]  [<ffffffff81682ec5>] ? _raw_spin_unlock_irqrestore+0x45/0x80
[  481.744687]  [<ffffffff81072689>] ? prepare_to_wait+0x59/0x90
[  481.746307]  [<ffffffff816814b4>] schedule+0x24/0x70
[  481.747960]  [<ffffffffa0068be5>] wait_current_trans.clone.23+0xb5/0x100 [btrfs]
[  481.749610]  [<ffffffff81072390>] ? wake_up_bit+0x40/0x40
[  481.751278]  [<ffffffffa006a16a>] start_transaction+0x12a/0x350 [btrfs]
[  481.752934]  [<ffffffffa006a67e>] btrfs_start_transaction+0xe/0x10 [btrfs]
[  481.754606]  [<ffffffffa0074112>] btrfs_evict_inode+0x162/0x310 [btrfs]
[  481.756246]  [<ffffffff8118172e>] evict+0x9e/0x1b0
[  481.757892]  [<ffffffff81181945>] iput+0x105/0x200
[  481.759527]  [<ffffffff8117645f>] do_unlinkat+0x15f/0x1c0
[  481.761159]  [<ffffffff81683259>] ? retint_swapgs+0x13/0x1b
[  481.762774]  [<ffffffff810ad375>] ? trace_hardirqs_on_caller+0x105/0x190
[  481.764387]  [<ffffffff8128fa6e>] ? trace_hardirqs_on_thunk+0x3a/0x3f
[  481.765997]  [<ffffffff811779a1>] sys_unlink+0x11/0x20
[  481.767598]  [<ffffffff8168bb66>] sysenter_dispatch+0x7/0x26
[  481.769203] no locks held by gdm/523.
[  510.761484] Ebtables v2.0 registered
[  511.170456] ip6_tables: (C) 2000-2006 Netfilter Core Team
[  530.237864] ata1.00: configured for UDMA/133
[  530.237873] ata1: EH complete
[  530.482428] EXT4-fs (sda3): re-mounted. Opts: commit=0


More information about the systemd-devel mailing list