Attachment 156329 Details for Bug 242648 – boot log diff

boot log diff

boot.14-15 (text/plain), 15.39 KB, created by Gerd Hoffmann on 2007-06-06 09:20:35 UTC

(hide)

Description:

Filename:

MIME Type:

Creator: Gerd Hoffmann

Created: 2007-06-06 09:20:35 UTC

Size: 15.39 KB

patch

obsolete

>--- boot.14	2007-06-06 11:16:26.000000000 +0200
>+++ boot.15	2007-06-06 11:07:41.000000000 +0200
>@@ -1,4 +1,4 @@
>-Linux version 2.6.18-14.el5 (brewbuilder@hs20-bc2-2.build.redhat.com) (gcc version 4.1.1 20070105 (Red Hat 4.1.1-52)) #1 SMP Wed Apr 4 16:05:53 EDT 2007
>+Linux version 2.6.18-15.el5 (brewbuilder@hs20-bc1-7.build.redhat.com) (gcc version 4.1.1 20070105 (Red Hat 4.1.1-52)) #1 SMP Mon Apr 16 17:34:47 EDT 2007
> Command line: ro root=/dev/VolGroup00/LogVol00 console=ttyS0,115200 console=tty0 crashkernel=16m@16m vga=0x0f05
> BIOS-provided physical RAM map:
>  BIOS-e820: 0000000000000000 - 000000000009fc00 (usable)
>@@ -13,15 +13,17 @@
> Faking a node at 0000000000000000-000000000fff0000
> Bootmem setup node 0 0000000000000000-000000000fff0000
> No mptable found.
>-On node 0 totalpages: 61846
>-  DMA zone: 1741 pages, LIFO batch:0
>+Memory for crash kernel (0x1000000 to 0x1ffffff) notwithin permissible range
>+disabling kdump
>+On node 0 totalpages: 61845
>+  DMA zone: 1740 pages, LIFO batch:0
>   DMA32 zone: 60105 pages, LIFO batch:15
> Nosave address range: 000000000009f000 - 00000000000a0000
> Nosave address range: 00000000000a0000 - 00000000000e8000
> Nosave address range: 00000000000e8000 - 0000000000100000
> Allocating PCI resources starting at 20000000 (gap: 10000000:effc0000)
> SMP: Allowing 0 CPUs, 0 hotplug CPUs
>-Built 1 zonelists.  Total pages: 61846
>+Built 1 zonelists.  Total pages: 61845
> Kernel command line: ro root=/dev/VolGroup00/LogVol00 console=ttyS0,115200 console=tty0 crashkernel=16m@16m vga=0x0f05
> Initializing CPU#0
> PID hash table entries: 1024 (order: 10, 8192 bytes)
>@@ -39,8 +41,8 @@
> Dentry cache hash table entries: 32768 (order: 6, 262144 bytes)
> Inode-cache hash table entries: 16384 (order: 5, 131072 bytes)
> Checking aperture...
>-Memory: 227736k/262080k available (2454k kernel code, 33956k reserved, 1570k data, 184k init)
>-Calibrating delay using timer specific routine.. 3921.36 BogoMIPS (lpj=1960682)
>+Memory: 244116k/262080k available (2456k kernel code, 17576k reserved, 1574k data, 188k init)
>+Calibrating delay using timer specific routine.. 4016.99 BogoMIPS (lpj=2008497)
> Security Framework v1.0.0 initialized
> SELinux:  Initializing.
> SELinux:  Starting in permissive mode
>@@ -54,14 +56,14 @@
> weird, boot CPU (#0) not listed by the BIOS.
> SMP motherboard not detected.
> Using local APIC timer interrupts.
>-result 62498717
>-Detected 62.498 MHz APIC timer.
>+result 62506034
>+Detected 62.506 MHz APIC timer.
> testing NMI watchdog ... CPU#0: NMI appears to be stuck (0->0)!
> SMP disabled
> Brought up 1 CPUs
> testing NMI watchdog ... CPU#0: NMI appears to be stuck (0->0)!
> time.c: Using 1.193182 MHz WALL PIT GTOD PIT/TSC timer.
>-time.c: Detected 1995.005 MHz processor.
>+time.c: Detected 1995.155 MHz processor.
> sizeof(vma)=176 bytes
> sizeof(page)=88 bytes
> sizeof(inode)=1008 bytes
>@@ -78,7 +80,6 @@
> Linux Plug and Play Support v0.97 (c) Adam Belay
> pnp: PnP ACPI: disabled
> usbcore: registered new driver usbfs
>-Losing some ticks... checking if CPU frequency changed.
> usbcore: registered new driver hub
> PCI: Probing PCI hardware
> PCI: Probing PCI hardware (bus 00)
>@@ -86,6 +87,7 @@
> PCI: Using IRQ router PIIX/ICH [8086/7000] at 0000:00:01.0
> NetLabel: Initializing
> NetLabel:  domain hash size = 128
>+Losing some ticks... checking if CPU frequency changed.
> NetLabel:  protocols = UNLABELED CIPSOv4
> NetLabel:  unlabeled traffic allowed by default
> PCI-GART: No AMD northbridge found.
>@@ -97,7 +99,7 @@
> TCP: Hash tables configured (established 8192 bind 4096)
> TCP reno registered
> audit: initializing netlink socket (disabled)
>-audit(1181121264.385:1): initialized
>+audit(1181120678.406:1): initialized
> Total HugeTLB memory allocated, 0
> VFS: Disk quotas dquot_6.5.1
> Dquot-cache hash table entries: 512 (order 0, 4096 bytes)
>@@ -105,14 +107,13 @@
> Initializing Cryptographic API
> ksign: Installing public key data
> Loading keyring
>-- Added public key 31DCCDAF6EF34F82
>+- Added public key 3AA2115FBD989778
> - User ID: Red Hat, Inc. (Kernel Module GPG key)
> io scheduler noop registered
> io scheduler anticipatory registered
> io scheduler deadline registered
> io scheduler cfq registered (default)
> Limiting direct PCI/PCI transfers.
>-PCI: PIIX3: Enabling Passive Release on 0000:00:01.0
> Activating ISA DMA hang workarounds.
> pci_hotplug: PCI Hot Plug PCI Core version: 0.5
> Real Time Clock Driver v1.12ac
>@@ -126,9 +127,8 @@
> PIIX3: IDE controller at PCI slot 0000:00:01.1
> PIIX3: chipset revision 0
> PIIX3: not 100% native mode: will probe irqs later
>-PCI: Setting latency timer of device 0000:00:01.1 to 64
>-    ide0: BM-DMA at 0xc000-0xc007, BIOS settings: hda:pio, hdb:pio
>-    ide1: BM-DMA at 0xc008-0xc00f, BIOS settings: hdc:pio, hdd:pio
>+    ide0: BM-DMA at 0xc000-0xc007, BIOS settings: hda:DMA, hdb:pio
>+    ide1: BM-DMA at 0xc008-0xc00f, BIOS settings: hdc:DMA, hdd:pio
> Probing IDE interface ide0...
> hda: QEMU HARDDISK, ATA DISK drive
> ide0 at 0x1f0-0x1f7,0x3f6 on irq 14
>@@ -153,8 +153,8 @@
> Initializing IPsec netlink socket
> NET: Registered protocol family 1
> NET: Registered protocol family 17
>-Freeing unused kernel memory: 184k freed
>-Write protecting the kernel read-only data: 479k
>+Freeing unused kernel memory: 188k freed
>+Write protecting the kernel read-only data: 480k
> input: AT Translated Set 2 keyboard as /class/input/input0
> input: ImExPS/2 Generic Explorer Mouse as /class/input/input1
> USB Universal Host Controller Interface driver v3.0
>@@ -184,23 +184,20 @@
> SELinux: initialized (dev bdev, type bdev), uses genfs_contexts
> SELinux: initialized (dev rootfs, type rootfs), uses genfs_contexts
> SELinux: initialized (dev sysfs, type sysfs), uses genfs_contexts
>-audit(1181121272.343:2): policy loaded auid=4294967295
>+audit(1181120691.369:2): policy loaded auid=4294967295
> SELinux: initialized (dev usbfs, type usbfs), uses genfs_contexts
>+hdc: ATAPI 4X CD-ROM drive, 512kB Cache, (U)DMA
>+Uniform CD-ROM driver Revision: 3.20
>+input: PC Speaker as /class/input/input2
> ne2k-pci.c:v1.03 9/22/2003 D. Becker/P. Gortmaker
>   http://www.scyld.com/network/ne2k-pci.html
> PCI: setting IRQ 11 as level-triggered
> PCI: Found IRQ 11 for device 0000:00:03.0
> eth0: RealTek RTL-8029 found at 0xc100, IRQ 11, 00:36:34:65:6C:35.
>-hdc: ATAPI 4X CD-ROM drive, 512kB Cache, (U)DMA
>-Uniform CD-ROM driver Revision: 3.20
>-input: PC Speaker as /class/input/input2
> FDC 0 is a S82078B
> parport0: PC-style at 0x378 [PCSPP,EPP]
> lp0: using parport0 (polling).
> lp0: console ready
>-warning: many lost ticks.
>-Your time source seems to be instable or some driver is hogging interupts
>-rip __do_softirq+0x5c/0xf3
> md: Autodetecting RAID arrays.
> md: autorun ...
> md: ... autorun DONE.
>@@ -213,6 +210,9 @@
> Adding 524280k swap on /dev/VolGroup00/LogVol01.  Priority:-1 extents:1 across:524280k
> SELinux: initialized (dev binfmt_misc, type binfmt_misc), uses genfs_contexts
> IA-32 Microcode Update Driver: v1.14a <tigran@veritas.com>
>+warning: many lost ticks.
>+Your time source seems to be instable or some driver is hogging interupts
>+rip __do_softirq+0x5c/0xf3
> NET: Registered protocol family 10
> lo: Disabled Privacy Extensions
> IPv6 over IPv4 tunneling driver
>@@ -220,94 +220,88 @@
> 
> =================================
> [ INFO: inconsistent lock state ]
>-2.6.18-14.el5 #1
>+2.6.18-15.el5 #1
> ---------------------------------
> inconsistent {hardirq-on-W} -> {in-hardirq-W} usage.
>-ifup-eth/1168 [HC1[1]:SC1[2]:HE0:SE0] takes:
>- (&ei_local->page_lock){++..}, at: [<ffffffff880b982d>] ei_interrupt+0x42/0x33e [8390]
>+ifup-eth/1171 [HC1[1]:SC1[2]:HE0:SE0] takes:
>+ (&ei_local->page_lock){++..}, at: [<ffffffff880e982d>] ei_interrupt+0x42/0x33e [8390]
> {hardirq-on-W} state was registered at:
>-  [<ffffffff800a496f>] __lock_acquire+0x3f7/0x9d6
>-  [<ffffffff8006637b>] _spin_unlock_irqrestore+0x3f/0x45
>-  [<ffffffff800a54b6>] lock_acquire+0x44/0x5d
>-  [<ffffffff880b9f04>] ei_start_xmit+0x91/0x231 [8390]
>-  [<ffffffff880b9f04>] ei_start_xmit+0x91/0x231 [8390]
>-  [<ffffffff8006609b>] _spin_lock+0x1e/0x27
>-  [<ffffffff880b9f04>] ei_start_xmit+0x91/0x231 [8390]
>-  [<ffffffff80224428>] __qdisc_run+0x69/0x1bd
>-  [<ffffffff802244a1>] __qdisc_run+0xe2/0x1bd
>-  [<ffffffff802244b3>] __qdisc_run+0xf4/0x1bd
>+  [<ffffffff800a543f>] __lock_acquire+0x3f7/0x9d6
>+  [<ffffffff8006633b>] _spin_unlock_irqrestore+0x3f/0x45
>+  [<ffffffff800a5f86>] lock_acquire+0x44/0x5d
>+  [<ffffffff880e9f04>] ei_start_xmit+0x91/0x231 [8390]
>+  [<ffffffff880e9f04>] ei_start_xmit+0x91/0x231 [8390]
>+  [<ffffffff8006605b>] _spin_lock+0x1e/0x27
>+  [<ffffffff880e9f04>] ei_start_xmit+0x91/0x231 [8390]
>+  [<ffffffff80224d99>] __qdisc_run+0x69/0x1bd
>+  [<ffffffff80224e12>] __qdisc_run+0xe2/0x1bd
>+  [<ffffffff80224e24>] __qdisc_run+0xf4/0x1bd
>   [<ffffffff80030ece>] dev_queue_xmit+0x13b/0x260
>-  [<ffffffff88173b50>] mld_sendpack+0x1d7/0x2f3 [ipv6]
>-  [<ffffffff800a420f>] trace_hardirqs_on+0x101/0x13f
>-  [<ffffffff8817490d>] mld_ifc_timer_expire+0x1cf/0x20b [ipv6]
>-  [<ffffffff8817491a>] mld_ifc_timer_expire+0x1dc/0x20b [ipv6]
>-  [<ffffffff8817473e>] mld_ifc_timer_expire+0x0/0x20b [ipv6]
>-  [<ffffffff80097063>] run_timer_softirq+0x13b/0x1be
>+  [<ffffffff88173b6c>] mld_sendpack+0x1d7/0x2f3 [ipv6]
>+  [<ffffffff800a4cdf>] trace_hardirqs_on+0x101/0x13f
>+  [<ffffffff88174929>] mld_ifc_timer_expire+0x1cf/0x20b [ipv6]
>+  [<ffffffff88174936>] mld_ifc_timer_expire+0x1dc/0x20b [ipv6]
>+  [<ffffffff8817475a>] mld_ifc_timer_expire+0x0/0x20b [ipv6]
>+  [<ffffffff80097b33>] run_timer_softirq+0x13b/0x1be
>   [<ffffffff80012722>] __do_softirq+0x67/0xf3
>-  [<ffffffff8005ef4c>] call_softirq+0x1c/0x28
>-  [<ffffffff8006de7f>] do_softirq+0x35/0xa0
>-  [<ffffffff80122cf1>] selinux_file_alloc_security+0x2a/0x53
>-  [<ffffffff8005e8b7>] apic_timer_interrupt+0x6b/0x70
>+  [<ffffffff8005ef0c>] call_softirq+0x1c/0x28
>+  [<ffffffff8006de3f>] do_softirq+0x35/0xa0
>+  [<ffffffff8005e877>] apic_timer_interrupt+0x6b/0x70
>   [<ffffffffffffffff>] 0xffffffffffffffff
>-irq event stamp: 35971
>-hardirqs last  enabled at (35970): [<ffffffff8006637b>] _spin_unlock_irqrestore+0x3f/0x45
>-hardirqs last disabled at (35971): [<ffffffff80065c18>] trace_hardirqs_off_thunk+0x35/0x67
>-softirqs last  enabled at (35548): [<ffffffff8005ef4c>] call_softirq+0x1c/0x28
>-softirqs last disabled at (35927): [<ffffffff8005ef4c>] call_softirq+0x1c/0x28
>+irq event stamp: 35863
>+hardirqs last  enabled at (35862): [<ffffffff8006633b>] _spin_unlock_irqrestore+0x3f/0x45
>+hardirqs last disabled at (35863): [<ffffffff80065bd8>] trace_hardirqs_off_thunk+0x35/0x67
>+softirqs last  enabled at (35724): [<ffffffff8005ef0c>] call_softirq+0x1c/0x28
>+softirqs last disabled at (35823): [<ffffffff8005ef0c>] call_softirq+0x1c/0x28
> 
> other info that might help us debug this:
>-1 lock held by ifup-eth/1168:
>- #0:  (&dev->_xmit_lock){-...}, at: [<ffffffff80224428>] __qdisc_run+0x69/0x1bd
>+3 locks held by ifup-eth/1171:
>+ #0:  (&mm->mmap_sem){----}, at: [<ffffffff80068353>] do_page_fault+0x411/0x822
>+ #1:  (__pte_lockptr(new)){--..}, at: [<ffffffff8000960c>] __handle_mm_fault+0xcfb/0xdf7
>+ #2:  (&dev->_xmit_lock){-...}, at: [<ffffffff80224d99>] __qdisc_run+0x69/0x1bd
> 
> stack backtrace:
> 
> Call Trace:
>- <IRQ>  [<ffffffff800a3668>] print_usage_bug+0x24d/0x258
>- [<ffffffff800a3cb9>] mark_lock+0xa4/0x3ee
>- [<ffffffff800a48ea>] __lock_acquire+0x372/0x9d6
>- [<ffffffff800a54b6>] lock_acquire+0x44/0x5d
>- [<ffffffff880b982d>] :8390:ei_interrupt+0x42/0x33e
>- [<ffffffff880b982d>] :8390:ei_interrupt+0x42/0x33e
>- [<ffffffff8006609b>] _spin_lock+0x1e/0x27
>- [<ffffffff880b982d>] :8390:ei_interrupt+0x42/0x33e
>+ <IRQ>  [<ffffffff800a4138>] print_usage_bug+0x24d/0x258
>+ [<ffffffff800a4789>] mark_lock+0xa4/0x3ee
>+ [<ffffffff800a53ba>] __lock_acquire+0x372/0x9d6
>+ [<ffffffff800a5f86>] lock_acquire+0x44/0x5d
>+ [<ffffffff880e982d>] :8390:ei_interrupt+0x42/0x33e
>+ [<ffffffff880e982d>] :8390:ei_interrupt+0x42/0x33e
>+ [<ffffffff8006605b>] _spin_lock+0x1e/0x27
>+ [<ffffffff880e982d>] :8390:ei_interrupt+0x42/0x33e
>  [<ffffffff80011217>] handle_IRQ_event+0x22/0x56
>- [<ffffffff800bbc6e>] __do_IRQ+0xa5/0x107
>- [<ffffffff8006dfe0>] do_IRQ+0xf6/0x104
>- [<ffffffff8005e1ce>] ret_from_intr+0x0/0xf
>- [<ffffffff8006637d>] _spin_unlock_irqrestore+0x41/0x45
>- [<ffffffff880ba07f>] :8390:ei_start_xmit+0x20c/0x231
>- [<ffffffff80224428>] __qdisc_run+0x69/0x1bd
>- [<ffffffff802244a1>] __qdisc_run+0xe2/0x1bd
>- [<ffffffff802244b3>] __qdisc_run+0xf4/0x1bd
>+ [<ffffffff800bc7b5>] __do_IRQ+0xa5/0x107
>+ [<ffffffff8006dfa0>] do_IRQ+0xf6/0x104
>+ [<ffffffff8005e18e>] ret_from_intr+0x0/0xf
>+ [<ffffffff8006633d>] _spin_unlock_irqrestore+0x41/0x45
>+ [<ffffffff880ea07f>] :8390:ei_start_xmit+0x20c/0x231
>+ [<ffffffff80224d99>] __qdisc_run+0x69/0x1bd
>+ [<ffffffff80224e12>] __qdisc_run+0xe2/0x1bd
>+ [<ffffffff80224e24>] __qdisc_run+0xf4/0x1bd
>  [<ffffffff80030ece>] dev_queue_xmit+0x13b/0x260
>- [<ffffffff88173b50>] :ipv6:mld_sendpack+0x1d7/0x2f3
>- [<ffffffff800a420f>] trace_hardirqs_on+0x101/0x13f
>- [<ffffffff8817490d>] :ipv6:mld_ifc_timer_expire+0x1cf/0x20b
>- [<ffffffff8817491a>] :ipv6:mld_ifc_timer_expire+0x1dc/0x20b
>- [<ffffffff8817473e>] :ipv6:mld_ifc_timer_expire+0x0/0x20b
>- [<ffffffff80097063>] run_timer_softirq+0x13b/0x1be
>+ [<ffffffff88173b6c>] :ipv6:mld_sendpack+0x1d7/0x2f3
>+ [<ffffffff800a4cdf>] trace_hardirqs_on+0x101/0x13f
>+ [<ffffffff88174929>] :ipv6:mld_ifc_timer_expire+0x1cf/0x20b
>+ [<ffffffff88174936>] :ipv6:mld_ifc_timer_expire+0x1dc/0x20b
>+ [<ffffffff8817475a>] :ipv6:mld_ifc_timer_expire+0x0/0x20b
>+ [<ffffffff80097b33>] run_timer_softirq+0x13b/0x1be
>  [<ffffffff80012722>] __do_softirq+0x67/0xf3
>- [<ffffffff8005ef4c>] call_softirq+0x1c/0x28
>- [<ffffffff8006de7f>] do_softirq+0x35/0xa0
>- [<ffffffff80122cf1>] selinux_file_alloc_security+0x2a/0x53
>- [<ffffffff8005e8b7>] apic_timer_interrupt+0x6b/0x70
>- <EOI>  [<ffffffff80122cf1>] selinux_file_alloc_security+0x2a/0x53
>- [<ffffffff80007284>] check_poison_obj+0x1c3/0x1c8
>- [<ffffffff80122cf1>] selinux_file_alloc_security+0x2a/0x53
>- [<ffffffff8000c993>] cache_alloc_debugcheck_after+0x30/0x1b8
>- [<ffffffff80122cf1>] selinux_file_alloc_security+0x2a/0x53
>- [<ffffffff800d61a5>] kmem_cache_zalloc+0xe0/0x106
>- [<ffffffff80122cf1>] selinux_file_alloc_security+0x2a/0x53
>- [<ffffffff80012c25>] get_empty_filp+0x98/0x17d
>- [<ffffffff80050388>] do_pipe+0x1e/0x2bd
>- [<ffffffff80065be1>] trace_hardirqs_on_thunk+0x35/0x37
>- [<ffffffff800a4229>] trace_hardirqs_on+0x11b/0x13f
>- [<ffffffff80034b6d>] sys_pipe+0x13/0x3e
>- [<ffffffff8005dc96>] system_call+0x7e/0x83
>+ [<ffffffff8005ef0c>] call_softirq+0x1c/0x28
>+ [<ffffffff8006de3f>] do_softirq+0x35/0xa0
>+ [<ffffffff8005e877>] apic_timer_interrupt+0x6b/0x70
>+ <EOI>  [<ffffffff80011956>] do_wp_page+0x60d/0x685
>+ [<ffffffff800113b8>] do_wp_page+0x6f/0x685
>+ [<ffffffff80009645>] __handle_mm_fault+0xd34/0xdf7
>+ [<ffffffff80068353>] do_page_fault+0x411/0x822
>+ [<ffffffff800683ff>] do_page_fault+0x4bd/0x822
>+ [<ffffffff800662d2>] _spin_unlock_irq+0x24/0x27
>+ [<ffffffff80065ba1>] trace_hardirqs_on_thunk+0x35/0x37
>+ [<ffffffff8005e9d9>] error_exit+0x0/0x96
> 
>-audit(1181121292.069:3): audit_pid=1429 old=0 by auid=4294967295 subj=system_u:system_r:auditd_t:s0
>+audit(1181120713.343:3): audit_pid=1432 old=0 by auid=4294967295 subj=system_u:system_r:auditd_t:s0
> SELinux: initialized (dev rpc_pipefs, type rpc_pipefs), uses genfs_contexts
>-eth0: no IPv6 routers present
> Bluetooth: Core ver 2.10
> NET: Registered protocol family 31
> Bluetooth: HCI device and connection manager initialized
>@@ -324,6 +318,7 @@
> SELinux: initialized (dev autofs, type autofs), uses genfs_contexts
> SELinux: initialized (dev autofs, type autofs), uses genfs_contexts
> SELinux: initialized (dev autofs, type autofs), uses genfs_contexts
>+eth0: no IPv6 routers present
> Bridge firewalling registered
> ip_tables: (C) 2000-2006 Netfilter Core Team
> Netfilter messages via NETLINK v0.30.

Actions: View

Attachments on bug 242648: 156327 | 156329 | 156376