Your message dated Sun, 01 Mar 2015 02:54:52 +0000
with message-id <1425178492.28544.106.ca...@decadent.org.uk>
and subject line Re: Bug#779469: linux-image-3.2.0-4-amd64: Call trace with
3.2.0-4-amd64 3.2.65-1+deb7u2
has caused the Debian Bug report #779469,
regarding linux-image-3.2.0-4-amd64: Call trace with 3.2.0-4-amd64
3.2.65-1+deb7u2
to be marked as done.
This means that you claim that the problem has been dealt with.
If this is not the case it is now your responsibility to reopen the
Bug report if necessary, and/or fix the problem forthwith.
(NB: If you are a system administrator and have no idea what this
message is talking about, this may indicate a serious mail system
misconfiguration somewhere. Please contact ow...@bugs.debian.org
immediately.)
--
779469: http://bugs.debian.org/cgi-bin/bugreport.cgi?bug=779469
Debian Bug Tracking System
Contact ow...@bugs.debian.org with problems
--- Begin Message ---
Package: src:linux
Version: 3.2.65-1+deb7u2
Severity: normal
After I upgraded to the latest kernel (3.2.0-4-amd64 3.2.65-1+deb7u) I'm seeing
my
server (KVM VPS) turn unresponsive. The log shows the following:
Feb 28 22:28:38 tux kernel: [114568.642541] sqlite3 invoked oom-killer:
gfp_mask=0x200da, order=0, oom_adj=0, oom_score_adj=0
Feb 28 22:28:38 tux kernel: [114568.642554] sqlite3 cpuset=/ mems_allowed=0
Feb 28 22:28:38 tux kernel: [114568.642567] Pid: 7688, comm: sqlite3 Not
tainted 3.2.0-4-amd64 #1 Debian 3.2.65-1+deb7u2
Feb 28 22:28:38 tux kernel: [114568.642571] Call Trace:
Feb 28 22:28:39 tux kernel: [114568.642609] [<ffffffff810b789a>] ?
dump_header+0x78/0x1bd
Feb 28 22:28:40 tux kernel: [114568.642624] [<ffffffff811655c6>] ?
security_real_capable_noaudit+0x40/0x4f
Feb 28 22:28:40 tux kernel: [114568.642629] [<ffffffff810b76a4>] ?
oom_unkillable_task+0x20/0x91
Feb 28 22:28:40 tux kernel: [114568.642647] [<ffffffff81350f2f>] ?
_raw_spin_unlock_irqrestore+0xe/0xf
Feb 28 22:28:40 tux kernel: [114568.642650] [<ffffffff810b7c6f>] ?
oom_kill_process+0x49/0x271
Feb 28 22:28:40 tux kernel: [114568.642653] [<ffffffff810b836a>] ?
out_of_memory+0x2ea/0x337
Feb 28 22:28:40 tux kernel: [114568.642656] [<ffffffff810bc002>] ?
__alloc_pages_nodemask+0x62a/0x7ab
Feb 28 22:28:40 tux kernel: [114568.642671] [<ffffffff810e6f09>] ?
alloc_pages_vma+0x12d/0x136
Feb 28 22:28:40 tux kernel: [114568.642675] [<ffffffff810e0fe1>] ?
map_swap_page+0x9/0xa
Feb 28 22:28:40 tux kernel: [114568.642678] [<ffffffff810ded53>] ?
read_swap_cache_async+0x67/0x142
Feb 28 22:28:40 tux kernel: [114568.642681] [<ffffffff810dee85>] ?
swapin_readahead+0x57/0x9a
Feb 28 22:28:40 tux kernel: [114568.642683] [<ffffffff81350ed5>] ?
_raw_spin_trylock+0x5/0x13
Feb 28 22:28:40 tux kernel: [114568.642689] [<ffffffff810d1b66>] ?
handle_pte_fault+0x347/0x79f
Feb 28 22:28:40 tux kernel: [114568.642692] [<ffffffff810cf04d>] ?
pte_offset_kernel+0x16/0x35
Feb 28 22:28:40 tux kernel: [114568.642695] [<ffffffff81353f34>] ?
do_page_fault+0x320/0x345
Feb 28 22:28:40 tux kernel: [114568.642705] [<ffffffff810380ed>] ?
set_next_entity+0x32/0x55
Feb 28 22:28:40 tux kernel: [114568.642713] [<ffffffff8100d025>] ?
paravirt_write_msr+0xb/0xe
Feb 28 22:28:40 tux kernel: [114568.642716] [<ffffffff8100d6f9>] ?
__switch_to+0x18e/0x265
Feb 28 22:28:40 tux kernel: [114568.642719] [<ffffffff81039aa2>] ?
finish_task_switch+0x4e/0xb9
Feb 28 22:28:40 tux kernel: [114568.642721] [<ffffffff8134fb09>] ?
__schedule+0x5f9/0x610
Feb 28 22:28:40 tux kernel: [114568.642724] [<ffffffff813514d5>] ?
page_fault+0x25/0x30
Feb 28 22:28:40 tux kernel: [114568.642726] Mem-Info:
Feb 28 22:28:40 tux kernel: [114568.642730] Node 0 DMA per-cpu:
Feb 28 22:28:40 tux kernel: [114568.642735] CPU 0: hi: 0, btch: 1 usd:
0
Feb 28 22:28:40 tux kernel: [114568.642737] CPU 1: hi: 0, btch: 1 usd:
0
Feb 28 22:28:40 tux kernel: [114568.642738] Node 0 DMA32 per-cpu:
Feb 28 22:28:40 tux kernel: [114568.642740] CPU 0: hi: 186, btch: 31 usd:
0
Feb 28 22:28:40 tux kernel: [114568.642741] CPU 1: hi: 186, btch: 31 usd:
14
Feb 28 22:28:40 tux kernel: [114568.642745] active_anon:44499
inactive_anon:44605 isolated_anon:32
Feb 28 22:28:40 tux kernel: [114568.642749] active_file:19 inactive_file:63
isolated_file:32
Feb 28 22:28:40 tux kernel: [114568.642750] unevictable:0 dirty:0 writeback:92
unstable:0
Feb 28 22:28:40 tux kernel: [114568.642751] free:1219 slab_reclaimable:2129
slab_unreclaimable:8735
Feb 28 22:28:40 tux kernel: [114568.642752] mapped:34 shmem:15
pagetables:14272 bounce:0
Feb 28 22:28:40 tux kernel: [114568.642754] Node 0 DMA free:2048kB min:84kB
low:104kB high:124kB active_anon:100kB inactive_anon:296kB active_file:0kB
inactive_file:12kB unevictable:0kB isola
ted(anon):0kB isolated(file):0kB present:15688kB mlocked:0kB dirty:0kB
writeback:16kB mapped:20kB shmem:0kB slab_reclaimable:8kB
slab_unreclaimable:3652kB kernel_stack:7432kB pagetables:1320k
B unstable:0kB bounce:0kB writeback_tmp:0kB pages_scanned:0 all_unreclaimable?
yes
Feb 28 22:28:40 tux kernel: [114568.642765] lowmem_reserve[]: 0 489 489 489
Feb 28 22:28:40 tux kernel: [114568.642772] Node 0 DMA32 free:2828kB min:2784kB
low:3480kB high:4176kB active_anon:177896kB inactive_anon:178124kB
active_file:80kB inactive_file:240kB unevict
able:0kB isolated(anon):128kB isolated(file):128kB present:500896kB mlocked:0kB
dirty:0kB writeback:352kB mapped:116kB shmem:60kB slab_reclaimable:8508kB
slab_unreclaimable:31288kB kernel_sta
ck:2848kB pagetables:55768kB unstable:0kB bounce:0kB writeback_tmp:0kB
pages_scanned:74 all_unreclaimable? no
Feb 28 22:28:40 tux kernel: [114568.642780] lowmem_reserve[]: 0 0 0 0
Feb 28 22:28:40 tux kernel: [114568.642783] Node 0 DMA: 190*4kB 62*8kB 18*16kB
2*32kB 1*64kB 1*128kB 1*256kB 0*512kB 0*1024kB 0*2048kB 0*4096kB = 2056kB
Feb 28 22:28:40 tux kernel: [114568.642798] Node 0 DMA32: 335*4kB 184*8kB
1*16kB 0*32kB 0*64kB 0*128kB 0*256kB 0*512kB 0*1024kB 0*2048kB 0*4096kB = 2828kB
Feb 28 22:28:40 tux kernel: [114568.642805] 11647 total pagecache pages
Feb 28 22:28:40 tux kernel: [114568.642806] 11507 pages in swap cache
Feb 28 22:28:40 tux kernel: [114568.642808] Swap cache stats: add 5571578,
delete 5560071, find 873084/1520211
Feb 28 22:28:40 tux kernel: [114568.642809] Free swap = 0kB
Feb 28 22:28:40 tux kernel: [114568.642810] Total swap = 1045500kB
Feb 28 22:28:40 tux kernel: [114568.645927] 131040 pages RAM
Feb 28 22:28:40 tux kernel: [114568.645930] 4225 pages reserved
Feb 28 22:28:40 tux kernel: [114568.645931] 2063 pages shared
Feb 28 22:28:40 tux kernel: [114568.645932] 122333 pages non-shared
Feb 28 22:28:40 tux kernel: [114568.645934] [ pid ] uid tgid total_vm
rss cpu oom_adj oom_score_adj name
Feb 28 22:28:40 tux kernel: [114568.645945] [ 299] 0 299 5330
1 0 -17 -1000 udevd
Feb 28 22:28:40 tux kernel: [114568.645949] [ 400] 0 400 5329
0 1 -17 -1000 udevd
Feb 28 22:28:40 tux kernel: [114568.645952] [ 401] 0 401 5329
0 0 -17 -1000 udevd
Feb 28 22:28:40 tux kernel: [114568.645956] [ 1566] 0 1566 2490
0 1 -17 -1000 dhclient
Feb 28 22:28:40 tux kernel: [114568.645960] [ 1808] 0 1808 29848
178 1 0 0 rsyslogd
Feb 28 22:28:40 tux kernel: [114568.645963] [ 1849] 0 1849 1029
0 1 0 0 acpid
Feb 28 22:28:40 tux kernel: [114568.645966] [ 1919] 0 1919 4168
0 0 0 0 atd
Feb 28 22:28:40 tux kernel: [114568.645969] [ 1969] 0 1969 5102
15 1 0 0 cron
Feb 28 22:28:40 tux kernel: [114568.645972] [ 1985] 104 1985 9769
19 0 0 0 ntpd
Feb 28 22:28:40 tux kernel: [114568.645975] [ 2082] 0 2082 12483
0 1 -17 -1000 sshd
Feb 28 22:28:40 tux kernel: [114568.645979] [ 2129] 0 2129 4064
1 0 0 0 getty
Feb 28 22:28:40 tux kernel: [114568.645982] [ 2130] 0 2130 4064
1 1 0 0 getty
Feb 28 22:28:40 tux kernel: [114568.645985] [ 2131] 0 2131 4064
1 1 0 0 getty
Feb 28 22:28:40 tux kernel: [114568.645988] [ 2132] 0 2132 4064
1 1 0 0 getty
Feb 28 22:28:40 tux kernel: [114568.645991] [ 2133] 0 2133 4064
1 0 0 0 getty
Feb 28 22:28:40 tux kernel: [114568.645994] [ 2134] 0 2134 4064
1 1 0 0 getty
Feb 28 22:28:40 tux kernel: [114568.645998] [24202] 0 24202 19540
15 0 0 0 apache2
Feb 28 22:28:40 tux kernel: [114568.646001] [ 6778] 33 6778 19546
20 1 0 0 apache2
Feb 28 22:28:40 tux kernel: [114568.646005] [15149] 33 15149 68357
44 1 0 0 apache2
Feb 28 22:28:40 tux kernel: [114568.646009] [16368] 33 16368 75180
85 1 0 0 apache2
Feb 28 22:28:40 tux kernel: [114568.646012] [16541] 33 16541 47444
66 1 0 0 apache2
Feb 28 22:28:40 tux kernel: [114568.646015] [17094] 1000 17094 2688
1 0 0 0 cron-exchangewa
Feb 28 22:28:40 tux kernel: [114568.646018] [17096] 1000 17096 2694
1 1 0 0 grabdata.sh
Feb 28 22:28:40 tux kernel: [114568.646027] [17381] 1000 17381 10873
174 0 0 0 perl
Feb 28 22:28:40 tux kernel: [114568.646031] [25611] 1000 25611 1045
0 1 0 0 sh
Feb 28 22:28:40 tux kernel: [114568.646034] [25612] 1000 25612 1045
0 0 0 0 sh
Feb 28 22:28:40 tux kernel: [114568.646037] [25615] 1000 25615 2737
43 1 0 0 bleutrade.sh
Feb 28 22:28:40 tux kernel: [114568.646041] [20892] 33 20892 1394
1 1 0 0 flock
Feb 28 22:28:40 tux kernel: [114568.646049] [20902] 33 20902 1045
0 1 0 0 sh
Feb 28 22:28:40 tux kernel: [114568.646052] [20916] 33 20916 4831
0 1 0 0 coinstart.sh
Feb 28 22:28:40 tux kernel: [114568.646055] [20982] 33 20982 4833
0 1 0 0 coinstart.sh
Feb 28 22:28:40 tux kernel: [114568.646059] [21005] 33 21005 1394
1 1 0 0 flock
Feb 28 22:28:40 tux kernel: [114568.646062] [21033] 33 21033 1045
0 1 0 0 sh
Feb 28 22:28:40 tux kernel: [114568.646065] [21067] 33 21067 4831
0 1 0 0 coinstart.sh
Feb 28 22:28:40 tux kernel: [114568.646068] [21132] 33 21132 4833
0 0 0 0 coinstart.sh
Feb 28 22:28:40 tux kernel: [114568.646072] [21527] 33 21527 1394
1 1 0 0 flock
Feb 28 22:28:40 tux kernel: [114568.646075] [21539] 33 21539 1045
0 1 0 0 sh
Feb 28 22:28:40 tux kernel: [114568.646079] [21559] 33 21559 4831
0 1 0 0 coinstart.sh
Feb 28 22:28:40 tux kernel: [114568.646082] [21620] 33 21620 4834
39 1 0 0 coinstart.sh
Feb 28 22:28:40 tux kernel: [114568.646085] [21794] 33 21794 1394
1 0 0 0 flock
Feb 28 22:28:40 tux kernel: [114568.646092] [21832] 33 21832 1045
0 0 0 0 sh
Feb 28 22:28:40 tux kernel: [114568.646095] [21863] 33 21863 4831
0 0 0 0 coinstart.sh
Feb 28 22:28:40 tux kernel: [114568.646098] [21900] 33 21900 1394
1 0 0 0 flock
Feb 28 22:28:40 tux kernel: [114568.646101] [21913] 33 21913 1045
0 0 0 0 sh
Feb 28 22:28:40 tux kernel: [114568.646104] [21933] 33 21933 4831
0 0 0 0 coinstart.sh
Feb 28 22:28:40 tux kernel: [114568.646108] [21936] 33 21936 4835
0 0 0 0 coinstart.sh
Feb 28 22:28:40 tux kernel: [114568.646185] [22024] 33 22024 1394
1 0 0 0 flock
Feb 28 22:28:40 tux kernel: [114568.646188] [22033] 33 22033 1045
0 0 0 0 sh
And the list goes on... It seems it run out of memory? But why does it
not happened before?
This issue started just after upgrading the kernel...
-- Package-specific info:
** Version:
Linux version 3.2.0-4-amd64 (debian-kernel@lists.debian.org) (gcc version 4.6.3
(Debian 4.6.3-14) ) #1 SMP Debian 3.2.65-1+deb7u2
** Command line:
BOOT_IMAGE=/boot/vmlinuz-3.2.0-4-amd64
root=UUID=ea2d96d4-2b00-4c0f-9eaa-d65e45ba088e ro quiet
** Not tainted
** Kernel log:
[ 0.850019] uhci_hcd 0000:00:01.2: UHCI Host Controller
[ 0.850074] uhci_hcd 0000:00:01.2: new USB bus registered, assigned bus
number 1
[ 0.850183] uhci_hcd 0000:00:01.2: irq 11, io base 0x0000c020
[ 0.850280] usb usb1: New USB device found, idVendor=1d6b, idProduct=0001
[ 0.850282] usb usb1: New USB device strings: Mfr=3, Product=2,
SerialNumber=1
[ 0.850284] usb usb1: Product: UHCI Host Controller
[ 0.850285] usb usb1: Manufacturer: Linux 3.2.0-4-amd64 uhci_hcd
[ 0.850287] usb usb1: SerialNumber: 0000:00:01.2
[ 0.850438] hub 1-0:1.0: USB hub found
[ 0.850443] hub 1-0:1.0: 2 ports detected
[ 0.850623] ata_piix 0000:00:01.1: version 2.13
[ 0.850966] ata_piix 0000:00:01.1: setting latency timer to 64
[ 0.853211] scsi0 : ata_piix
[ 0.853350] scsi1 : ata_piix
[ 0.853393] ata1: PATA max MWDMA2 cmd 0x1f0 ctl 0x3f6 bmdma 0xc000 irq 14
[ 0.853396] ata2: PATA max MWDMA2 cmd 0x170 ctl 0x376 bmdma 0xc008 irq 15
[ 1.010092] ata2.01: NODEV after polling detection
[ 1.010520] ata1.01: NODEV after polling detection
[ 1.010773] ata1.00: ATA-7: QEMU HARDDISK, 0.9.1, max UDMA/100
[ 1.010775] ata1.00: 52428800 sectors, multi 16: LBA48
[ 1.010992] ata2.00: ATAPI: QEMU DVD-ROM, 0.9.1, max UDMA/100
[ 1.011414] ata1.00: configured for MWDMA2
[ 1.011588] scsi 0:0:0:0: Direct-Access ATA QEMU HARDDISK 0.9.
PQ: 0 ANSI: 5
[ 1.011976] ata2.00: configured for MWDMA2
[ 1.012574] scsi 1:0:0:0: CD-ROM QEMU QEMU DVD-ROM 0.9.
PQ: 0 ANSI: 5
[ 1.023129] sd 0:0:0:0: [sda] 52428800 512-byte logical blocks: (26.8
GB/25.0 GiB)
[ 1.023172] sd 0:0:0:0: [sda] Write Protect is off
[ 1.023175] sd 0:0:0:0: [sda] Mode Sense: 00 3a 00 00
[ 1.023191] sd 0:0:0:0: [sda] Write cache: disabled, read cache: enabled,
doesn't support DPO or FUA
[ 1.024521] sda: sda1 sda2 < sda5 >
[ 1.025335] sd 0:0:0:0: [sda] Attached SCSI disk
[ 1.025403] sr0: scsi3-mmc drive: 4x/4x xa/form2 tray
[ 1.025407] cdrom: Uniform CD-ROM driver Revision: 3.20
[ 1.025633] sr 1:0:0:0: Attached scsi CD-ROM sr0
[ 1.032046] sd 0:0:0:0: Attached scsi generic sg0 type 0
[ 1.032116] sr 1:0:0:0: Attached scsi generic sg1 type 5
[ 1.160958] usb 1-2: new full-speed USB device number 2 using uhci_hcd
[ 1.328370] Refined TSC clocksource calibration: 2992.401 MHz.
[ 1.479161] PM: Starting manual resume from disk
[ 1.479165] PM: Hibernation image partition 8:5 present
[ 1.479166] PM: Looking for hibernation image.
[ 1.479439] PM: Image not found (code -22)
[ 1.479441] PM: Hibernation image not present or could not be loaded.
[ 1.499037] EXT4-fs (sda1): INFO: recovery required on readonly filesystem
[ 1.499041] EXT4-fs (sda1): write access will be enabled during recovery
[ 1.499085] usb 1-2: New USB device found, idVendor=0627, idProduct=0001
[ 1.499089] usb 1-2: New USB device strings: Mfr=3, Product=2, SerialNumber=1
[ 1.499091] usb 1-2: Product: QEMU USB Tablet
[ 1.499093] usb 1-2: Manufacturer: QEMU 0.9.1
[ 1.499094] usb 1-2: SerialNumber: 1
[ 1.579774] input: QEMU 0.9.1 QEMU USB Tablet as
/devices/pci0000:00/0000:00:01.2/usb1/1-2/1-2:1.0/input/input1
[ 1.580031] generic-usb 0003:0627:0001.0001: input,hidraw0: USB HID v0.01
Pointer [QEMU 0.9.1 QEMU USB Tablet] on usb-0000:00:01.2-2/input0
[ 1.580330] usbcore: registered new interface driver usbhid
[ 1.580332] usbhid: USB HID core driver
[ 2.603151] EXT4-fs (sda1): orphan cleanup on readonly fs
[ 2.603169] EXT4-fs (sda1): ext4_orphan_cleanup: deleting unreferenced inode
663488
[ 2.603223] EXT4-fs (sda1): ext4_orphan_cleanup: deleting unreferenced inode
663386
[ 2.603232] EXT4-fs (sda1): ext4_orphan_cleanup: deleting unreferenced inode
661569
[ 2.607272] EXT4-fs (sda1): ext4_orphan_cleanup: deleting unreferenced inode
657421
[ 2.607327] EXT4-fs (sda1): 4 orphan inodes deleted
[ 2.607329] EXT4-fs (sda1): recovery complete
[ 2.612998] EXT4-fs (sda1): mounted filesystem with ordered data mode. Opts:
(null)
[ 5.127692] udevd[295]: starting version 175
[ 5.461941] input: Power Button as
/devices/LNXSYSTM:00/LNXPWRBN:00/input/input2
[ 5.461953] ACPI: Power Button [PWRF]
[ 5.541906] input: PC Speaker as /devices/platform/pcspkr/input/input3
[ 5.564376] piix4_smbus 0000:00:01.3: SMBus Host Controller at 0xb100,
revision 0
[ 6.030196] Error: Driver 'pcspkr' is already registered, aborting...
[ 6.220265] input: ImExPS/2 Generic Explorer Mouse as
/devices/platform/i8042/serio1/input/input4
[ 7.374180] Adding 1045500k swap on /dev/sda5. Priority:-1 extents:1
across:1045500k
[ 7.422720] EXT4-fs (sda1): re-mounted. Opts: (null)
[ 7.681848] EXT4-fs (sda1): re-mounted. Opts: errors=remount-ro
[ 7.833801] loop: module loaded
[ 9.993936] ip_tables: (C) 2000-2006 Netfilter Core Team
[ 10.053324] nf_conntrack version 0.5.0 (3962 buckets, 15848 max)
[ 11.567043] ADDRCONF(NETDEV_UP): eth0: link is not ready
[ 11.569813] e1000: eth0 NIC Link is Up 1000 Mbps Full Duplex, Flow Control:
RX
[ 11.570394] ADDRCONF(NETDEV_CHANGE): eth0: link becomes ready
[ 131.154536] iptables denied: IN=eth0 OUT=
MAC=00:16:3c:85:ea:94:00:d0:00:a7:f0:00:08:00 SRC=178.19.108.164
DST=199.167.30.163 LEN=40 TOS=0x00 PREC=0x00 TTL=119 ID=256 DF PROTO=TCP
SPT=12200 DPT=9064 WINDOW=8192 RES=0x00 SYN URGP=0
[ 240.224924] iptables denied: IN=eth0 OUT=
MAC=00:16:3c:85:ea:94:00:d0:00:9e:24:00:08:00 SRC=74.122.198.123
DST=199.167.30.163 LEN=118 TOS=0x00 PREC=0x00 TTL=56 ID=0 DF PROTO=UDP
SPT=52757 DPT=1900 LEN=98
[ 422.034358] iptables denied: IN=eth0 OUT=
MAC=00:16:3c:85:ea:94:00:d0:00:9e:24:00:08:00 SRC=5.100.249.197
DST=199.167.30.163 LEN=40 TOS=0x00 PREC=0x00 TTL=115 ID=3869 DF PROTO=TCP
SPT=443 DPT=57879 WINDOW=0 RES=0x00 ACK RST URGP=0
[ 422.034523] iptables denied: IN=eth0 OUT=
MAC=00:16:3c:85:ea:94:00:d0:00:9e:24:00:08:00 SRC=5.100.249.197
DST=199.167.30.163 LEN=40 TOS=0x00 PREC=0x00 TTL=115 ID=3871 DF PROTO=TCP
SPT=443 DPT=57881 WINDOW=0 RES=0x00 ACK RST URGP=0
[ 422.034604] iptables denied: IN=eth0 OUT=
MAC=00:16:3c:85:ea:94:00:d0:00:a7:f0:00:08:00 SRC=5.100.249.197
DST=199.167.30.163 LEN=40 TOS=0x00 PREC=0x00 TTL=115 ID=3870 DF PROTO=TCP
SPT=443 DPT=57880 WINDOW=0 RES=0x00 ACK RST URGP=0
[ 662.530569] iptables denied: IN=eth0 OUT=
MAC=00:16:3c:85:ea:94:00:d0:00:a7:f0:00:08:00 SRC=202.56.13.138
DST=199.167.30.163 LEN=40 TOS=0x00 PREC=0x00 TTL=118 ID=12930 DF PROTO=TCP
SPT=443 DPT=41057 WINDOW=0 RES=0x00 ACK RST URGP=0
[ 662.530582] iptables denied: IN=eth0 OUT=
MAC=00:16:3c:85:ea:94:00:d0:00:9e:24:00:08:00 SRC=202.56.13.138
DST=199.167.30.163 LEN=40 TOS=0x00 PREC=0x00 TTL=118 ID=12931 DF PROTO=TCP
SPT=443 DPT=41058 WINDOW=0 RES=0x00 ACK RST URGP=0
[ 662.530592] iptables denied: IN=eth0 OUT=
MAC=00:16:3c:85:ea:94:00:d0:00:a7:f0:00:08:00 SRC=202.56.13.138
DST=199.167.30.163 LEN=40 TOS=0x00 PREC=0x00 TTL=118 ID=12932 DF PROTO=TCP
SPT=443 DPT=41059 WINDOW=0 RES=0x00 ACK RST URGP=0
[ 1027.044915] iptables denied: IN=eth0 OUT=
MAC=00:16:3c:85:ea:94:00:d0:00:a7:f0:00:08:00 SRC=5.100.249.197
DST=199.167.30.163 LEN=40 TOS=0x00 PREC=0x00 TTL=115 ID=6724 DF PROTO=TCP
SPT=443 DPT=58414 WINDOW=0 RES=0x00 ACK RST URGP=0
[ 1027.060376] iptables denied: IN=eth0 OUT=
MAC=00:16:3c:85:ea:94:00:d0:00:9e:24:00:08:00 SRC=5.100.249.197
DST=199.167.30.163 LEN=40 TOS=0x00 PREC=0x00 TTL=108 ID=6730 DF PROTO=TCP
SPT=443 DPT=58415 WINDOW=0 RES=0x00 ACK RST URGP=0
[ 1027.061031] iptables denied: IN=eth0 OUT=
MAC=00:16:3c:85:ea:94:00:d0:00:a7:f0:00:08:00 SRC=5.100.249.197
DST=199.167.30.163 LEN=40 TOS=0x00 PREC=0x00 TTL=108 ID=6731 DF PROTO=TCP
SPT=443 DPT=58416 WINDOW=0 RES=0x00 ACK RST URGP=0
[ 1209.910200] iptables denied: IN=eth0 OUT=
MAC=00:16:3c:85:ea:94:00:d0:00:a7:f0:00:08:00 SRC=216.218.206.87
DST=199.167.30.163 LEN=78 TOS=0x00 PREC=0x00 TTL=54 ID=31433 DF PROTO=UDP
SPT=50194 DPT=137 LEN=58
[ 1267.547582] iptables denied: IN=eth0 OUT=
MAC=00:16:3c:85:ea:94:00:d0:00:9e:24:00:08:00 SRC=202.56.13.138
DST=199.167.30.163 LEN=40 TOS=0x00 PREC=0x00 TTL=118 ID=18259 DF PROTO=TCP
SPT=443 DPT=41596 WINDOW=0 RES=0x00 ACK RST URGP=0
[ 1267.547603] iptables denied: IN=eth0 OUT=
MAC=00:16:3c:85:ea:94:00:d0:00:a7:f0:00:08:00 SRC=202.56.13.138
DST=199.167.30.163 LEN=40 TOS=0x00 PREC=0x00 TTL=118 ID=18260 DF PROTO=TCP
SPT=443 DPT=41597 WINDOW=0 RES=0x00 ACK RST URGP=0
[ 1267.547613] iptables denied: IN=eth0 OUT=
MAC=00:16:3c:85:ea:94:00:d0:00:9e:24:00:08:00 SRC=202.56.13.138
DST=199.167.30.163 LEN=40 TOS=0x00 PREC=0x00 TTL=118 ID=18261 DF PROTO=TCP
SPT=443 DPT=41598 WINDOW=0 RES=0x00 ACK RST URGP=0
[ 1383.743219] iptables denied: IN=eth0 OUT=
MAC=00:16:3c:85:ea:94:00:d0:00:9e:24:00:08:00 SRC=177.156.201.21
DST=199.167.30.163 LEN=60 TOS=0x00 PREC=0x00 TTL=50 ID=34213 DF PROTO=TCP
SPT=3742 DPT=23 WINDOW=5808 RES=0x00 SYN URGP=0
[ 1386.742213] iptables denied: IN=eth0 OUT=
MAC=00:16:3c:85:ea:94:00:d0:00:9e:24:00:08:00 SRC=177.156.201.21
DST=199.167.30.163 LEN=60 TOS=0x00 PREC=0x00 TTL=50 ID=34214 DF PROTO=TCP
SPT=3742 DPT=23 WINDOW=5808 RES=0x00 SYN URGP=0
[ 1462.346116] iptables denied: IN=eth0 OUT=
MAC=00:16:3c:85:ea:94:00:d0:00:a7:f0:00:08:00 SRC=222.186.21.201
DST=199.167.30.163 LEN=40 TOS=0x00 PREC=0x00 TTL=101 ID=256 PROTO=TCP SPT=6000
DPT=22001 WINDOW=16384 RES=0x00 SYN URGP=0
[ 1481.180766] iptables denied: IN=eth0 OUT=
MAC=00:16:3c:85:ea:94:00:d0:00:9e:24:00:08:00 SRC=222.186.21.201
DST=199.167.30.163 LEN=40 TOS=0x00 PREC=0x00 TTL=101 ID=256 PROTO=TCP SPT=6000
DPT=22002 WINDOW=16384 RES=0x00 SYN URGP=0
[ 1483.703713] iptables denied: IN=eth0 OUT=
MAC=00:16:3c:85:ea:94:00:d0:00:a7:f0:00:08:00 SRC=222.186.21.201
DST=199.167.30.163 LEN=40 TOS=0x00 PREC=0x00 TTL=101 ID=256 PROTO=TCP SPT=6000
DPT=22003 WINDOW=16384 RES=0x00 SYN URGP=0
[ 1487.365617] iptables denied: IN=eth0 OUT=
MAC=00:16:3c:85:ea:94:00:d0:00:9e:24:00:08:00 SRC=222.186.21.201
DST=199.167.30.163 LEN=40 TOS=0x00 PREC=0x00 TTL=101 ID=256 PROTO=TCP SPT=6000
DPT=22331 WINDOW=16384 RES=0x00 SYN URGP=0
[ 1489.165314] iptables denied: IN=eth0 OUT=
MAC=00:16:3c:85:ea:94:00:d0:00:a7:f0:00:08:00 SRC=222.186.21.201
DST=199.167.30.163 LEN=40 TOS=0x00 PREC=0x00 TTL=101 ID=256 PROTO=TCP SPT=6000
DPT=22102 WINDOW=16384 RES=0x00 SYN URGP=0
** Model information
sys_vendor: Red Hat
product_name: KVM
product_version:
chassis_vendor: RED HAT
chassis_version:
bios_vendor: QEMU
bios_version: QEMU
** Loaded modules:
ipt_LOG
xt_limit
xt_tcpudp
nf_conntrack_ipv4
nf_defrag_ipv4
xt_state
nf_conntrack
iptable_filter
ip_tables
x_tables
loop
snd_pcm
snd_page_alloc
snd_timer
snd
processor
soundcore
psmouse
i2c_piix4
joydev
serio_raw
pcspkr
thermal_sys
evdev
i2c_core
button
virtio_balloon
usbhid
hid
ext4
crc16
jbd2
mbcache
sg
sr_mod
sd_mod
cdrom
crc_t10dif
ata_generic
floppy
ata_piix
libata
scsi_mod
uhci_hcd
ehci_hcd
usbcore
e1000
usb_common
virtio_pci
virtio_ring
virtio
** Network interface configuration:
# This file describes the network interfaces available on your system
# and how to activate them. For more information, see interfaces(5).
# The loopback network interface
auto lo
iface lo inet loopback
# The primary network interface
allow-hotplug eth0
iface eth0 inet dhcp
** Network status:
*** IP interfaces and addresses:
1: lo: <LOOPBACK,UP,LOWER_UP> mtu 16436 qdisc noqueue state UNKNOWN
link/loopback 00:00:00:00:00:00 brd 00:00:00:00:00:00
inet 127.0.0.1/8 scope host lo
inet6 ::1/128 scope host
valid_lft forever preferred_lft forever
2: eth0: <BROADCAST,MULTICAST,UP,LOWER_UP> mtu 1500 qdisc pfifo_fast state UP
qlen 1000
link/ether 00:16:3c:85:ea:94 brd ff:ff:ff:ff:ff:ff
inet 199.167.30.163/24 brd 199.167.30.255 scope global eth0
inet6 fe80::216:3cff:fe85:ea94/64 scope link
valid_lft forever preferred_lft forever
*** Device statistics:
Inter-| Receive | Transmit
face |bytes packets errs drop fifo frame compressed multicast|bytes
packets errs drop fifo colls carrier compressed
lo: 300 6 0 0 0 0 0 0 300
6 0 0 0 0 0 0
eth0: 27408003 60907 0 0 0 0 0 0 13307648
36683 0 0 0 0 0 0
*** Protocol statistics:
Ip:
39153 total packets received
2 with invalid addresses
0 forwarded
0 incoming packets discarded
39129 incoming packets delivered
34885 requests sent out
Icmp:
1 ICMP messages received
0 input ICMP message failed.
ICMP input histogram:
echo requests: 1
1 ICMP messages sent
0 ICMP messages failed
ICMP output histogram:
echo replies: 1
IcmpMsg:
InType8: 1
OutType0: 1
Tcp:
1190 active connections openings
281 passive connection openings
17 failed connection attempts
11 connection resets received
4 connections established
36602 segments received
34019 segments send out
105 segments retransmited
0 bad segments received.
130 resets sent
Udp:
2526 packets received
0 packets to unknown port received.
0 packet receive errors
2528 packets sent
UdpLite:
TcpExt:
12 resets received for embryonic SYN_RECV sockets
1327 TCP sockets finished time wait in fast timer
120 delayed acks sent
Quick ack mode was activated 197 times
1 packets directly queued to recvmsg prequeue.
15271 packet headers predicted
4978 acknowledgments not containing data payload received
8438 predicted acknowledgments
1 times recovered from packet loss by selective acknowledgements
7 congestion windows recovered without slow start after partial ack
3 timeouts after SACK recovery
1 fast retransmits
35 other TCP timeouts
198 DSACKs sent for old packets
1 DSACKs received
38 connections reset due to unexpected data
11 connections reset due to early user close
2 connections aborted due to timeout
TCPSackShifted: 1
TCPSackMerged: 1
TCPSackShiftFallback: 10
TCPDeferAcceptDrop: 274
IpExt:
InOctets: 25553795
OutOctets: 12716622
** PCI devices:
00:00.0 Host bridge [0600]: Intel Corporation 440FX - 82441FX PMC [Natoma]
[8086:1237] (rev 02)
Subsystem: Red Hat, Inc Qemu virtual machine [1af4:1100]
Control: I/O- Mem- BusMaster- SpecCycle- MemWINV- VGASnoop- ParErr-
Stepping- SERR- FastB2B- DisINTx-
Status: Cap- 66MHz- UDF- FastB2B- ParErr- DEVSEL=fast >TAbort- <TAbort-
<MAbort- >SERR- <PERR- INTx-
00:01.0 ISA bridge [0601]: Intel Corporation 82371SB PIIX3 ISA [Natoma/Triton
II] [8086:7000]
Subsystem: Red Hat, Inc Qemu virtual machine [1af4:1100]
Physical Slot: 1
Control: I/O+ Mem+ BusMaster+ SpecCycle- MemWINV- VGASnoop- ParErr-
Stepping- SERR- FastB2B- DisINTx-
Status: Cap- 66MHz- UDF- FastB2B- ParErr- DEVSEL=medium >TAbort-
<TAbort- <MAbort- >SERR- <PERR- INTx-
Latency: 0
00:01.1 IDE interface [0101]: Intel Corporation 82371SB PIIX3 IDE
[Natoma/Triton II] [8086:7010] (prog-if 80 [Master])
Subsystem: Red Hat, Inc Qemu virtual machine [1af4:1100]
Physical Slot: 1
Control: I/O+ Mem- BusMaster+ SpecCycle- MemWINV- VGASnoop- ParErr-
Stepping- SERR- FastB2B- DisINTx-
Status: Cap- 66MHz- UDF- FastB2B+ ParErr- DEVSEL=medium >TAbort-
<TAbort- <MAbort- >SERR- <PERR- INTx-
Latency: 64
Region 0: [virtual] Memory at 000001f0 (32-bit, non-prefetchable)
[size=8]
Region 1: [virtual] Memory at 000003f0 (type 3, non-prefetchable)
[size=1]
Region 2: [virtual] Memory at 00000170 (32-bit, non-prefetchable)
[size=8]
Region 3: [virtual] Memory at 00000370 (type 3, non-prefetchable)
[size=1]
Region 4: I/O ports at c000 [size=16]
Kernel driver in use: ata_piix
00:01.2 USB controller [0c03]: Intel Corporation 82371SB PIIX3 USB
[Natoma/Triton II] [8086:7020] (rev 01) (prog-if 00 [UHCI])
Subsystem: Red Hat, Inc Qemu virtual machine [1af4:1100]
Physical Slot: 1
Control: I/O+ Mem- BusMaster+ SpecCycle- MemWINV- VGASnoop- ParErr-
Stepping- SERR- FastB2B- DisINTx-
Status: Cap- 66MHz- UDF- FastB2B- ParErr- DEVSEL=fast >TAbort- <TAbort-
<MAbort- >SERR- <PERR- INTx-
Latency: 64
Interrupt: pin D routed to IRQ 11
Region 4: I/O ports at c020 [size=32]
Kernel driver in use: uhci_hcd
00:01.3 Bridge [0680]: Intel Corporation 82371AB/EB/MB PIIX4 ACPI [8086:7113]
(rev 03)
Subsystem: Red Hat, Inc Qemu virtual machine [1af4:1100]
Physical Slot: 1
Control: I/O- Mem- BusMaster- SpecCycle- MemWINV- VGASnoop- ParErr-
Stepping- SERR- FastB2B- DisINTx-
Status: Cap- 66MHz- UDF- FastB2B+ ParErr- DEVSEL=medium >TAbort-
<TAbort- <MAbort- >SERR- <PERR- INTx-
Interrupt: pin A routed to IRQ 9
Kernel driver in use: piix4_smbus
00:02.0 VGA compatible controller [0300]: Cirrus Logic GD 5446 [1013:00b8]
(prog-if 00 [VGA controller])
Subsystem: Red Hat, Inc Device [1af4:1100]
Physical Slot: 2
Control: I/O+ Mem+ BusMaster- SpecCycle- MemWINV- VGASnoop- ParErr-
Stepping- SERR- FastB2B- DisINTx-
Status: Cap- 66MHz- UDF- FastB2B- ParErr- DEVSEL=fast >TAbort- <TAbort-
<MAbort- >SERR- <PERR- INTx-
Region 0: Memory at c2000000 (32-bit, prefetchable) [size=32M]
Region 1: Memory at c4000000 (32-bit, non-prefetchable) [size=4K]
Expansion ROM at <unassigned> [disabled]
00:03.0 Ethernet controller [0200]: Intel Corporation 82540EM Gigabit Ethernet
Controller [8086:100e] (rev 03)
Subsystem: Red Hat, Inc Device [1af4:1100]
Physical Slot: 3
Control: I/O+ Mem+ BusMaster+ SpecCycle- MemWINV- VGASnoop- ParErr-
Stepping- SERR- FastB2B- DisINTx-
Status: Cap+ 66MHz- UDF- FastB2B- ParErr- DEVSEL=fast >TAbort- <TAbort-
<MAbort- >SERR- <PERR- INTx-
Latency: 64, Cache Line Size: 64 bytes
Interrupt: pin A routed to IRQ 10
Region 0: Memory at c4020000 (32-bit, non-prefetchable) [size=128K]
Region 1: I/O ports at c040 [size=64]
Kernel driver in use: e1000
00:04.0 RAM memory [0500]: Red Hat, Inc Virtio memory balloon [1af4:1002]
Subsystem: Red Hat, Inc Device [1af4:0005]
Physical Slot: 4
Control: I/O+ Mem- BusMaster+ SpecCycle- MemWINV- VGASnoop- ParErr-
Stepping- SERR- FastB2B- DisINTx-
Status: Cap- 66MHz- UDF- FastB2B- ParErr- DEVSEL=fast >TAbort- <TAbort-
<MAbort- >SERR- <PERR- INTx-
Latency: 64
Interrupt: pin A routed to IRQ 11
Region 0: I/O ports at c080 [size=32]
Kernel driver in use: virtio-pci
** USB devices:
Bus 001 Device 001: ID 1d6b:0001 Linux Foundation 1.1 root hub
Bus 001 Device 002: ID 0627:0001 Adomax Technology Co., Ltd
-- System Information:
Debian Release: 7.8
APT prefers stable-updates
APT policy: (500, 'stable-updates'), (500, 'stable')
Architecture: amd64 (x86_64)
Kernel: Linux 3.2.0-4-amd64 (SMP w/2 CPU cores)
Locale: LANG=en_US.UTF-8, LC_CTYPE=en_US.UTF-8 (charmap=UTF-8)
Shell: /bin/sh linked to /bin/dash
Versions of packages linux-image-3.2.0-4-amd64 depends on:
ii debconf [debconf-2.0] 1.5.49
ii initramfs-tools [linux-initramfs-tool] 0.109.1
ii kmod 9-3
ii linux-base 3.5
ii module-init-tools 9-3
Versions of packages linux-image-3.2.0-4-amd64 recommends:
pn firmware-linux-free <none>
Versions of packages linux-image-3.2.0-4-amd64 suggests:
pn debian-kernel-handbook <none>
ii grub-pc 1.99-27+deb7u2
pn linux-doc-3.2 <none>
Versions of packages linux-image-3.2.0-4-amd64 is related to:
pn firmware-atheros <none>
pn firmware-bnx2 <none>
pn firmware-bnx2x <none>
pn firmware-brcm80211 <none>
pn firmware-intelwimax <none>
pn firmware-ipw2x00 <none>
pn firmware-ivtv <none>
pn firmware-iwlwifi <none>
pn firmware-libertas <none>
pn firmware-linux <none>
pn firmware-linux-nonfree <none>
pn firmware-myricom <none>
pn firmware-netxen <none>
pn firmware-qlogic <none>
pn firmware-ralink <none>
pn firmware-realtek <none>
pn xen-hypervisor <none>
-- debconf information:
linux-image-3.2.0-4-amd64/postinst/depmod-error-initrd-3.2.0-4-amd64: false
linux-image-3.2.0-4-amd64/prerm/removing-running-kernel-3.2.0-4-amd64: true
linux-image-3.2.0-4-amd64/postinst/ignoring-ramdisk:
linux-image-3.2.0-4-amd64/postinst/missing-firmware-3.2.0-4-amd64:
--- End Message ---
--- Begin Message ---
On Sat, 2015-02-28 at 23:16 -0300, Daniel Fraga wrote:
> Package: src:linux
> Version: 3.2.65-1+deb7u2
> Severity: normal
>
> After I upgraded to the latest kernel (3.2.0-4-amd64 3.2.65-1+deb7u) I'm
> seeing my
> server (KVM VPS) turn unresponsive. The log shows the following:
>
> Feb 28 22:28:38 tux kernel: [114568.642541] sqlite3 invoked oom-killer:
> gfp_mask=0x200da, order=0, oom_adj=0, oom_score_adj=0
> Feb 28 22:28:38 tux kernel: [114568.642554] sqlite3 cpuset=/ mems_allowed=0
[...]
> Feb 28 22:28:40 tux kernel: [114568.645927] 131040 pages RAM
512 MB RAM...
> Feb 28 22:28:40 tux kernel: [114568.645930] 4225 pages reserved
> Feb 28 22:28:40 tux kernel: [114568.645931] 2063 pages shared
> Feb 28 22:28:40 tux kernel: [114568.645932] 122333 pages non-shared
> Feb 28 22:28:40 tux kernel: [114568.645934] [ pid ] uid tgid total_vm
> rss cpu oom_adj oom_score_adj name
[...]
> Feb 28 22:28:40 tux kernel: [114568.645998] [24202] 0 24202 19540
> 15 0 0 0 apache2
> Feb 28 22:28:40 tux kernel: [114568.646001] [ 6778] 33 6778 19546
> 20 1 0 0 apache2
> Feb 28 22:28:40 tux kernel: [114568.646005] [15149] 33 15149 68357
> 44 1 0 0 apache2
> Feb 28 22:28:40 tux kernel: [114568.646009] [16368] 33 16368 75180
> 85 1 0 0 apache2
> Feb 28 22:28:40 tux kernel: [114568.646012] [16541] 33 16541 47444
> 66 1 0 0 apache2
and multiple Apache processes that use up to 300 MB VM each (total_vm is
a number of pages). Sorry, this isn't going to fit.
[...]
> And the list goes on... It seems it run out of memory? But why does it
> not happened before?
Luck?
> This issue started just after upgrading the kernel...
https://en.wikipedia.org/wiki/Post_hoc_ergo_propter_hoc
Ben.
--
Ben Hutchings
Absolutum obsoletum. (If it works, it's out of date.) - Stafford Beer
signature.asc
Description: This is a digitally signed message part
--- End Message ---
