* [BUG] "block: make generic_make_request handle arbitrarily sized bios" breaks boot on parisc-linux
@ 2016-02-24 2:28 John David Anglin
2016-02-24 7:59 ` Ming Lei
0 siblings, 1 reply; 14+ messages in thread
From: John David Anglin @ 2016-02-24 2:28 UTC (permalink / raw)
To: linux-block
Cc: linux-scsi, Helge Deller, James Bottomley, linux-parisc List,
kent.overstreet
The following block change breaks boot on parisc-linux:
commit 54efd50bfd873e2dbf784e0b21a8027ba4299a3e
Author: Kent Overstreet <kent.overstreet@gmail.com>
Date: Thu Apr 23 22:37:18 2015 -0700
block: make generic_make_request handle arbitrarily sized bios
The way the block layer is currently written, it goes to great lengths
to avoid having to split bios; upper layer code (such as bio_add_page())
checks what the underlying device can handle and tries to always create
bios that don't need to be split.
But this approach becomes unwieldy and eventually breaks down with
stacked devices and devices with dynamic limits, and it adds a lot of
complexity. If the block layer could split bios as needed, we could
eliminate a lot of complexity elsewhere - particularly in stacked
drivers. Code that creates bios can then create whatever size bios are
convenient, and more importantly stacked drivers don't have to deal with
both their own bio size limitations and the limitations of the
(potentially multiple) devices underneath them. In the future this will
let us delete merge_bvec_fn and a bunch of other code.
We do this by adding calls to blk_queue_split() to the various
make_request functions that need it - a few can already handle arbitrary
size bios. Note that we add the call _after_ any call to
blk_queue_bounce(); this means that blk_queue_split() and
blk_recalc_rq_segments() don't need to be concerned with bouncing
affecting segment merging.
Some make_request_fn() callbacks were simple enough to audit and verify
they don't need blk_queue_split() calls. The skipped ones are:
* nfhd_make_request (arch/m68k/emu/nfblock.c)
* axon_ram_make_request (arch/powerpc/sysdev/axonram.c)
* simdisk_make_request (arch/xtensa/platforms/iss/simdisk.c)
* brd_make_request (ramdisk - drivers/block/brd.c)
* mtip_submit_request (drivers/block/mtip32xx/mtip32xx.c)
* loop_make_request
* null_queue_bio
* bcache's make_request fns
Some others are almost certainly safe to remove now, but will be left
for future patches.
Cc: Jens Axboe <axboe@kernel.dk>
Cc: Christoph Hellwig <hch@infradead.org>
Cc: Al Viro <viro@zeniv.linux.org.uk>
Cc: Ming Lei <ming.lei@canonical.com>
Cc: Neil Brown <neilb@suse.de>
Cc: Alasdair Kergon <agk@redhat.com>
Cc: Mike Snitzer <snitzer@redhat.com>
Cc: dm-devel@redhat.com
Cc: Lars Ellenberg <drbd-dev@lists.linbit.com>
Cc: drbd-user@lists.linbit.com
Cc: Jiri Kosina <jkosina@suse.cz>
Cc: Geoff Levand <geoff@infradead.org>
Cc: Jim Paris <jim@jtan.com>
Cc: Philip Kelleher <pjk1939@linux.vnet.ibm.com>
Cc: Minchan Kim <minchan@kernel.org>
Cc: Nitin Gupta <ngupta@vflare.org>
Cc: Oleg Drokin <oleg.drokin@intel.com>
Cc: Andreas Dilger <andreas.dilger@intel.com>
Acked-by: NeilBrown <neilb@suse.de> (for the 'md/md.c' bits)
Acked-by: Mike Snitzer <snitzer@redhat.com>
Reviewed-by: Martin K. Petersen <martin.petersen@oracle.com>
Signed-off-by: Kent Overstreet <kent.overstreet@gmail.com>
[dpark: skip more mq-based drivers, resolve merge conflicts, etc.]
Signed-off-by: Dongsu Park <dpark@posteo.net>
Signed-off-by: Ming Lin <ming.l@ssi.samsung.com>
Signed-off-by: Jens Axboe <axboe@fb.com>
This thread on the linux-parisc has most of the discussion and analysis:
http://www.spinics.net/lists/linux-parisc/msg06710.html
Essentially, the SCSI layer underestimates the number of sg segments needed and we run off the end of the sg list and crash.
This happens because the protect bit is ignored. As a result 4.3 and later kernels fail to boot. This includes the current Debian
kernel for hppa.
Hopefully, the block group can help resolve this issue. We can help with testing if needed.
Thanks,
Dave Anglin
--
John David Anglin dave.anglin@bell.net
^ permalink raw reply [flat|nested] 14+ messages in thread
* Re: [BUG] "block: make generic_make_request handle arbitrarily sized bios" breaks boot on parisc-linux
2016-02-24 2:28 [BUG] "block: make generic_make_request handle arbitrarily sized bios" breaks boot on parisc-linux John David Anglin
@ 2016-02-24 7:59 ` Ming Lei
2016-02-24 21:36 ` Helge Deller
0 siblings, 1 reply; 14+ messages in thread
From: Ming Lei @ 2016-02-24 7:59 UTC (permalink / raw)
To: John David Anglin
Cc: linux-block, Linux SCSI List, Helge Deller, James Bottomley,
linux-parisc List, Kent Overstreet
[-- Attachment #1: Type: text/plain, Size: 4214 bytes --]
On Wed, Feb 24, 2016 at 10:28 AM, John David Anglin
<dave.anglin@bell.net> wrote:
> The following block change breaks boot on parisc-linux:
>
> commit 54efd50bfd873e2dbf784e0b21a8027ba4299a3e
> Author: Kent Overstreet <kent.overstreet@gmail.com>
> Date: Thu Apr 23 22:37:18 2015 -0700
>
> block: make generic_make_request handle arbitrarily sized bios
>
> The way the block layer is currently written, it goes to great lengths
> to avoid having to split bios; upper layer code (such as bio_add_page())
> checks what the underlying device can handle and tries to always create
> bios that don't need to be split.
>
> But this approach becomes unwieldy and eventually breaks down with
> stacked devices and devices with dynamic limits, and it adds a lot of
> complexity. If the block layer could split bios as needed, we could
> eliminate a lot of complexity elsewhere - particularly in stacked
> drivers. Code that creates bios can then create whatever size bios are
> convenient, and more importantly stacked drivers don't have to deal with
> both their own bio size limitations and the limitations of the
> (potentially multiple) devices underneath them. In the future this will
> let us delete merge_bvec_fn and a bunch of other code.
>
> We do this by adding calls to blk_queue_split() to the various
> make_request functions that need it - a few can already handle arbitrary
> size bios. Note that we add the call _after_ any call to
> blk_queue_bounce(); this means that blk_queue_split() and
> blk_recalc_rq_segments() don't need to be concerned with bouncing
> affecting segment merging.
>
> Some make_request_fn() callbacks were simple enough to audit and verify
> they don't need blk_queue_split() calls. The skipped ones are:
>
> * nfhd_make_request (arch/m68k/emu/nfblock.c)
> * axon_ram_make_request (arch/powerpc/sysdev/axonram.c)
> * simdisk_make_request (arch/xtensa/platforms/iss/simdisk.c)
> * brd_make_request (ramdisk - drivers/block/brd.c)
> * mtip_submit_request (drivers/block/mtip32xx/mtip32xx.c)
> * loop_make_request
> * null_queue_bio
> * bcache's make_request fns
>
> Some others are almost certainly safe to remove now, but will be left
> for future patches.
>
> Cc: Jens Axboe <axboe@kernel.dk>
> Cc: Christoph Hellwig <hch@infradead.org>
> Cc: Al Viro <viro@zeniv.linux.org.uk>
> Cc: Ming Lei <ming.lei@canonical.com>
> Cc: Neil Brown <neilb@suse.de>
> Cc: Alasdair Kergon <agk@redhat.com>
> Cc: Mike Snitzer <snitzer@redhat.com>
> Cc: dm-devel@redhat.com
> Cc: Lars Ellenberg <drbd-dev@lists.linbit.com>
> Cc: drbd-user@lists.linbit.com
> Cc: Jiri Kosina <jkosina@suse.cz>
> Cc: Geoff Levand <geoff@infradead.org>
> Cc: Jim Paris <jim@jtan.com>
> Cc: Philip Kelleher <pjk1939@linux.vnet.ibm.com>
> Cc: Minchan Kim <minchan@kernel.org>
> Cc: Nitin Gupta <ngupta@vflare.org>
> Cc: Oleg Drokin <oleg.drokin@intel.com>
> Cc: Andreas Dilger <andreas.dilger@intel.com>
> Acked-by: NeilBrown <neilb@suse.de> (for the 'md/md.c' bits)
> Acked-by: Mike Snitzer <snitzer@redhat.com>
> Reviewed-by: Martin K. Petersen <martin.petersen@oracle.com>
> Signed-off-by: Kent Overstreet <kent.overstreet@gmail.com>
> [dpark: skip more mq-based drivers, resolve merge conflicts, etc.]
> Signed-off-by: Dongsu Park <dpark@posteo.net>
> Signed-off-by: Ming Lin <ming.l@ssi.samsung.com>
> Signed-off-by: Jens Axboe <axboe@fb.com>
>
> This thread on the linux-parisc has most of the discussion and analysis:
> http://www.spinics.net/lists/linux-parisc/msg06710.html
>
> Essentially, the SCSI layer underestimates the number of sg segments needed and we run off the end of the sg list and crash.
> This happens because the protect bit is ignored. As a result 4.3 and later kernels fail to boot. This includes the current Debian
> kernel for hppa.
>
> Hopefully, the block group can help resolve this issue. We can help with testing if needed.
>
We fixed several similar bugs, but maybe there is another one, :-(
Could you apply the attached debug patch and post the log after the issue is
triggered?
Thanks,
Ming Lei
[-- Attachment #2: blk-merge_check-bvec.patch --]
[-- Type: text/x-patch, Size: 1831 bytes --]
diff --git a/block/blk-merge.c b/block/blk-merge.c
index 2613531..1a73eb6 100644
--- a/block/blk-merge.c
+++ b/block/blk-merge.c
@@ -416,6 +416,24 @@ single_segment:
return nsegs;
}
+static void check_bvec(struct request *req)
+{
+ struct bio_vec bvec;
+ struct req_iterator iter;
+ int i = 0;
+
+ printk("%s: dump bvec for %p(f:%llx, t:%d)\n",
+ __func__, req, req->cmd_flags,
+ req->cmd_type);
+ rq_for_each_segment(bvec, req, iter) {
+ printk("\t %4d: %u %u %lu %p\n",
+ i, bvec.bv_offset, bvec.bv_len,
+ (unsigned long)page_to_pfn(bvec.bv_page),
+ iter.bio);
+ i++;
+ }
+}
+
/*
* map a request to scatterlist, return number of sg entries setup. Caller
* must make sure sg can hold rq->nr_phys_segments entries
@@ -425,6 +443,7 @@ int blk_rq_map_sg(struct request_queue *q, struct request *rq,
{
struct scatterlist *sg = NULL;
int nsegs = 0;
+ bool extra_len = false, dma_drain = false;
if (rq->bio)
nsegs = __blk_bios_map_sg(q, rq->bio, sglist, &sg);
@@ -436,6 +455,7 @@ int blk_rq_map_sg(struct request_queue *q, struct request *rq,
sg->length += pad_len;
rq->extra_len += pad_len;
+ extra_len = true;
}
if (q->dma_drain_size && q->dma_drain_needed(rq)) {
@@ -450,6 +470,7 @@ int blk_rq_map_sg(struct request_queue *q, struct request *rq,
(PAGE_SIZE - 1));
nsegs++;
rq->extra_len += q->dma_drain_size;
+ dma_drain = true;
}
if (sg)
@@ -460,6 +481,12 @@ int blk_rq_map_sg(struct request_queue *q, struct request *rq,
* segment is bigger than number of req's physical segments
*/
WARN_ON(nsegs > rq->nr_phys_segments);
+ if (nsegs > rq->nr_phys_segments) {
+ printk("%s: merge bug: %d %d, extra_len %d, dma_drain %d\n",
+ __func__, nsegs, rq->nr_phys_segments,
+ extra_len, dma_drain);
+ check_bvec(rq);
+ }
return nsegs;
}
^ permalink raw reply related [flat|nested] 14+ messages in thread
* Re: [BUG] "block: make generic_make_request handle arbitrarily sized bios" breaks boot on parisc-linux
2016-02-24 7:59 ` Ming Lei
@ 2016-02-24 21:36 ` Helge Deller
2016-02-24 23:28 ` John David Anglin
0 siblings, 1 reply; 14+ messages in thread
From: Helge Deller @ 2016-02-24 21:36 UTC (permalink / raw)
To: Ming Lei, John David Anglin
Cc: linux-block, Linux SCSI List, James Bottomley, linux-parisc List,
Kent Overstreet
Hi Ming Lei,
On 24.02.2016 08:59, Ming Lei wrote:
> On Wed, Feb 24, 2016 at 10:28 AM, John David Anglin
> <dave.anglin@bell.net> wrote:
>> The following block change breaks boot on parisc-linux:
>>
>> commit 54efd50bfd873e2dbf784e0b21a8027ba4299a3e
>> Author: Kent Overstreet <kent.overstreet@gmail.com>
>> Date: Thu Apr 23 22:37:18 2015 -0700
>>
>> block: make generic_make_request handle arbitrarily sized bios
>>
>> The way the block layer is currently written, it goes to great lengths
>> to avoid having to split bios; upper layer code (such as bio_add_page())
>> checks what the underlying device can handle and tries to always create
>> bios that don't need to be split.
>>
>> But this approach becomes unwieldy and eventually breaks down with
>> stacked devices and devices with dynamic limits, and it adds a lot of
>> complexity. If the block layer could split bios as needed, we could
>> eliminate a lot of complexity elsewhere - particularly in stacked
>> drivers. Code that creates bios can then create whatever size bios are
>> convenient, and more importantly stacked drivers don't have to deal with
>> both their own bio size limitations and the limitations of the
>> (potentially multiple) devices underneath them. In the future this will
>> let us delete merge_bvec_fn and a bunch of other code.
>>
>> We do this by adding calls to blk_queue_split() to the various
>> make_request functions that need it - a few can already handle arbitrary
>> size bios. Note that we add the call _after_ any call to
>> blk_queue_bounce(); this means that blk_queue_split() and
>> blk_recalc_rq_segments() don't need to be concerned with bouncing
>> affecting segment merging.
>>
>> Some make_request_fn() callbacks were simple enough to audit and verify
>> they don't need blk_queue_split() calls. The skipped ones are:
>>
>> * nfhd_make_request (arch/m68k/emu/nfblock.c)
>> * axon_ram_make_request (arch/powerpc/sysdev/axonram.c)
>> * simdisk_make_request (arch/xtensa/platforms/iss/simdisk.c)
>> * brd_make_request (ramdisk - drivers/block/brd.c)
>> * mtip_submit_request (drivers/block/mtip32xx/mtip32xx.c)
>> * loop_make_request
>> * null_queue_bio
>> * bcache's make_request fns
>>
>> Some others are almost certainly safe to remove now, but will be left
>> for future patches.
>>
>> Cc: Jens Axboe <axboe@kernel.dk>
>> Cc: Christoph Hellwig <hch@infradead.org>
>> Cc: Al Viro <viro@zeniv.linux.org.uk>
>> Cc: Ming Lei <ming.lei@canonical.com>
>> Cc: Neil Brown <neilb@suse.de>
>> Cc: Alasdair Kergon <agk@redhat.com>
>> Cc: Mike Snitzer <snitzer@redhat.com>
>> Cc: dm-devel@redhat.com
>> Cc: Lars Ellenberg <drbd-dev@lists.linbit.com>
>> Cc: drbd-user@lists.linbit.com
>> Cc: Jiri Kosina <jkosina@suse.cz>
>> Cc: Geoff Levand <geoff@infradead.org>
>> Cc: Jim Paris <jim@jtan.com>
>> Cc: Philip Kelleher <pjk1939@linux.vnet.ibm.com>
>> Cc: Minchan Kim <minchan@kernel.org>
>> Cc: Nitin Gupta <ngupta@vflare.org>
>> Cc: Oleg Drokin <oleg.drokin@intel.com>
>> Cc: Andreas Dilger <andreas.dilger@intel.com>
>> Acked-by: NeilBrown <neilb@suse.de> (for the 'md/md.c' bits)
>> Acked-by: Mike Snitzer <snitzer@redhat.com>
>> Reviewed-by: Martin K. Petersen <martin.petersen@oracle.com>
>> Signed-off-by: Kent Overstreet <kent.overstreet@gmail.com>
>> [dpark: skip more mq-based drivers, resolve merge conflicts, etc.]
>> Signed-off-by: Dongsu Park <dpark@posteo.net>
>> Signed-off-by: Ming Lin <ming.l@ssi.samsung.com>
>> Signed-off-by: Jens Axboe <axboe@fb.com>
>>
>> This thread on the linux-parisc has most of the discussion and analysis:
>> http://www.spinics.net/lists/linux-parisc/msg06710.html
>>
>> Essentially, the SCSI layer underestimates the number of sg segments needed and we run off the end of the sg list and crash.
>> This happens because the protect bit is ignored. As a result 4.3 and later kernels fail to boot. This includes the current Debian
>> kernel for hppa.
>>
>> Hopefully, the block group can help resolve this issue. We can help with testing if needed.
>>
>
> We fixed several similar bugs, but maybe there is another one, :-(
Thanks for your help!
> Could you apply the attached debug patch and post the log after the issue is
> triggered?
Sadly I was not yet able to produce the requested output for you.
It seems we have - probably triggered due to the block splitting itself - some kind of memory/stack
corruption in here as well. Note, the stack grows upwards(!) on parisc, so maybe local variables
get overwritten somehow...?
First I applied your patch as is.
Here is the system log so far:
[ 24.940000] cdrom: Uniform CD-ROM driver Revision: 3.20
[ 25.000000] sd 3:0:6:0: [sdb] 71132960 512-byte logical blocks: (36.4 GB/33.9 GiB)
[ 25.092000] sd 3:0:5:0: [sda] Write Protect is off
[ 25.152000] sd 3:0:5:0: [sda] Write cache: disabled, read cache: enabled, supports DPO and FUA
[ 25.268000] sd 3:0:6:0: [sdb] Write Protect is off
[ 25.328000] sd 3:0:6:0: [sdb] Write cache: disabled, read cache: enabled, supports DPO and FUA
[ 25.452000] sda: sda1 sda2 sda3 < sda5 sda6 >
[ 25.508000] sdb: sdb1 sdb2 sdb3 < sdb5 sdb6 >
[ 25.584000] scsi_id(112): unaligned access to 0x00000000facac009 at ip=0x000000004100390b
[ 25.688000] sd 3:0:6:0: [sdb] Attached SCSI disk
[ 25.752000] sd 3:0:5:0: [sda] Attached SCSI disk
[ 25.840000] scsi_id(113): unaligned access to 0x00000000fa799009 at ip=0x000000004100390b
[ 25.972000] random: nonblocking pool is initialized
[ 26.064000] ------------[ cut here ]------------
[ 26.120000] WARNING: at /build/linux-4.4/linux-4.4.2/block/blk-merge.c:484
[ 26.200000] Modules linked in: sd_mod sr_mod cdrom ata_generic ohci_pci ehci_pci ohci_hcd ehci_hcd pata_ns87415 libata sym53c8xx scsi_transport_spi usbcore usb_common scsi_mod tulip
[ 26.396000] CPU: 0 PID: 67 Comm: systemd-udevd Not tainted 4.4.0-1-parisc64-smp #7 Debian 4.4.2-2
[ 26.504000] task: 00000000bbe96b18 ti: 00000000bbf00000 task.ti: 00000000bbf00000
[ 26.592000]
[ 26.608000] YZrvWESTHLNXBCVMcbcbcbcbOGFRQPDI
[ 26.664000] PSW: 00001000000001001111111100001110 Not tainted
[ 26.736000] r00-03 000000ff0804ff0e 00000000409e9280 00000000404f22a4 00000000bbf011e0
Here it stops. Usually you would see a stack backtrace now, but as I mentioned above
maybe the stack got corrupted and as such your tracing code is not being executed.
Then I moved the WARN_ON behind you tracing code. With that I got:
[ 25.352000] cdrom: Uniform CD-ROM driver Revision: 3.20
[ 25.444000] sda: sda1 sda2 sda3 < sda5 sda6 >
[ 25.496000] sdb: sdb1 sdb2 sdb3 < sdb5 sdb6 >
[ 25.568000] sd 3:0:5:0: [sda] Attached SCSI disk
[ 25.644000] scsi_id(112): unaligned access to 0x00000000fae80009 at ip=0x000000004100390b
[ 25.752000] sd 3:0:6:0: [sdb] Attached SCSI disk
[ 25.836000] scsi_id(113): unaligned access to 0x00000000fac76009 at ip=0x000000004100390b
[ 25.988000] random: nonblocking pool is initialized
[ 26.048000] ------------[ cut here ]------------
[ 26.104000] kernel BUG at /build/linux-4.4/linux-4.4.2/include/linux/scatterlist.h:92!
[ 26.196000] CPU: 0 PID: 68 Comm: systemd-udevd Not tainted 4.4.0-1-parisc64-smp #8 Debian 4.4.2-2
[ 26.304000] task: 00000000bbeb40f8 ti: 00000000bbf08000 task.ti: 00000000bbf08000
[ 26.392000]
[ 26.412000] YZrvWESTHLNXBCVMcbcbcbcbOGFRQPDI
[ 26.468000] PSW: 00001000000001001111111100001110 Not tainted
[ 26.536000] r00-03 000000ff0804ff0e 00000000bbf091e0 00000000404f228c 00000000bbf091e0
[ 26.632000] r04-07 00000000409b3a80 0000000000005000 0000000000000000 0000000000001000
[ 26.728000] r08-11 000000000000001b 00000000000001b0 00000000bfd6e0f0 00000000bbe15a60
[ 26.824000] r12-15 0000000000000000 0000000000000000 0000000000000003 000000007fa95178
Again, no stack backtrace.
Maybe Dave has more luck, otherwise I'll continue to try to get some info.
Helge
^ permalink raw reply [flat|nested] 14+ messages in thread
* Re: [BUG] "block: make generic_make_request handle arbitrarily sized bios" breaks boot on parisc-linux
2016-02-24 21:36 ` Helge Deller
@ 2016-02-24 23:28 ` John David Anglin
2016-02-25 3:38 ` Ming Lei
0 siblings, 1 reply; 14+ messages in thread
From: John David Anglin @ 2016-02-24 23:28 UTC (permalink / raw)
To: Helge Deller
Cc: Ming Lei, linux-block, Linux SCSI List, James Bottomley,
linux-parisc List, Kent Overstreet
[-- Attachment #1: Type: text/plain, Size: 1132 bytes --]
On 2016-02-24, at 4:36 PM, Helge Deller wrote:
> Maybe Dave has more luck, otherwise I'll continue to try to get some info.
I tried your patch on the commit in linux-block which first failed to boot. As with Helge, the
system crashed and no useful data was output on console. I then applied following patch
to give some extra segments and tired again:
diff --git a/drivers/scsi/scsi_lib.c b/drivers/scsi/scsi_lib.c
index b1a2631..b421f03 100644
--- a/drivers/scsi/scsi_lib.c
+++ b/drivers/scsi/scsi_lib.c
@@ -595,6 +595,11 @@ static int scsi_alloc_sgtable(struct scsi_data_buffer *sdb, int nents, bool mq)
BUG_ON(!nents);
+ /* Provide extra entries in case of split. */
+ nents += 8;
+ if (nents > SCSI_MAX_SG_SEGMENTS)
+ nents = SCSI_MAX_SG_SEGMENTS;
+
if (mq) {
if (nents <= SCSI_MAX_SG_SEGMENTS) {
sdb->table.nents = nents;
The attached file shows the crash in first boot. The second boot was successful and various output
was generated by your check code.
Let me know if you want me to try with HEAD.
Regards,
Dave Anglin
--
John David Anglin dave.anglin@bell.net
[-- Attachment #2: boot.log.txt --]
[-- Type: text/plain, Size: 217671 bytes --]
sd 6:0:2:0: [sdc] Attached SCSI disk
------------[ cut here ]------------
------------[ cut here ]------------
kernel BUG at include/linux/scatterlist.h:92!
CPU: 1 PID: 1026 Comm: systemd-udevd Not tainted 4.2.0-rc2+ #24
task: 000000007f76ac48 ti: 000000007e734000 task.ti: 000000007e734000
YZrvWESTHLNXBCVMcbcbcbcbOGFRQPDI
PSW: 00001000000001001111010100001110 Not tainted
r00-03 000000ff0804f50e 000000007e735130 00000000403623f0 000000007e735130
r04-07 0000000040750090 000000000001b000 0000000000001000 00000000000001b0
r08-11 0000000000000000 0000000000000000 000000007f036100 000000007c486f80
r12-15 0000000000000001 0000000000000004 000000000000001b 000000007e048088
r16-19 0000000000000000 0000000042d79c00 0000000000001000 0000000000001000
r20-23 0000000000000000 000000000000a000 00000000407d1940 0002d05ffff4be80
r24-27 ffffffff87654000 000000003e400000 000000007c486f80 0000000040750090
r28-31 0000000000000000 000000007e735230 000000007e735260 0000000087654321
sr00-03 0000000000016800 0000000000000000 0000000000000000 0000000000016800
sr04-07 0000000000000000 0000000000000000 0000000000000000 0000000000000000
IASQ: 0000000000000000 0000000000000000 IAOQ: 0000000040362614 0000000040362618
IIR: 03ffe01f ISR: 0000000010340000 IOR: 000000f9cd735260
CPU: 1 CR30: 000000007e734000 CR31: 15fcd4f080459787
ORIG_R28: 0000000000011220
IAOQ[0]: blk_rq_map_sg+0x58c/0x8c0
IAOQ[1]: blk_rq_map_sg+0x590/0x8c0
RP(r2): blk_rq_map_sg+0x368/0x8c0
Backtrace:
[<000000004046f6d0>] scsi_init_sgtable+0x70/0xb8
[<000000004046f784>] scsi_init_io+0x6c/0x220
[<00000000104ab5c0>] sd_setup_read_write_cmnd+0x58/0x968 [sd_mod]
[<00000000104abf14>] sd_init_command+0x44/0x130 [sd_mod]
[<000000004046fa3c>] scsi_setup_cmnd+0x104/0x1b0
[<000000004046fcd8>] scsi_prep_fn+0x100/0x1a0
[<000000004035b9b0>] blk_peek_request+0x1b8/0x298
[<0000000040471248>] scsi_request_fn+0xf8/0xa90
[<0000000040357244>] __blk_run_queue+0x4c/0x70
[<00000000403804e4>] cfq_insert_request+0x2dc/0x580
[<0000000040356404>] __elv_add_request+0x1b4/0x300
CPU: 1 PID: 1026 Comm: systemd-udevd Not tainted 4.2.0-rc2+ #24
Backtrace:
[<000000004015e4a8>] show_stack+0x20/0x38
[<0000000040385f9c>] dump_stack+0x9c/0x110
[<000000004015e67c>] die_if_kernel+0x19c/0x2e0
[<000000004015f558>] handle_interruption+0x9a8/0x9d0
---[ end trace 4edd1ace8cf92f30 ]---
kernel BUG at include/linux/scatterlist.h:92!
CPU: 3 PID: 1021 Comm: systemd-udevd Tainted: G D 4.2.0-rc2+ #24
task: 000000007f7b63c8 ti: 000000007c650000 task.ti: 000000007c650000
YZrvWESTHLNXBCVMcbcbcbcbOGFRQPDI
PSW: 00001000000001001111111100001110 Tainted: G D
r00-03 000000ff0804ff0e 000000007c651130 00000000403623f0 000000007c651130
r04-07 0000000040750090 000000000000c000 0000000000001000 00000000000002a0
r08-11 0000000000000000 0000000000000000 000000007e03f280 000000007e410060
r12-15 0000000000000001 0000000000000003 000000000000002a 000000007e2cb7d0
r16-19 0000000000000000 0000000042df0500 0000000000001000 0000000000001000
r20-23 0000000000000000 0000000000011000 00000000407d1940 0002eb2f3ff45343
r24-27 ffffffff87654000 0000000000001000 000000007e410060 0000000040750090
r28-31 000000007e410048 000000007c651230 000000007c651260 0000000087654321
sr00-03 0000000000013800 0000000000000000 0000000000000000 0000000000013800
sr04-07 0000000000000000 0000000000000000 0000000000000000 0000000000000000
IASQ: 0000000000000000 0000000000000000 IAOQ: 0000000040362614 0000000040362618
IIR: 03ffe01f ISR: 0000000010340000 IOR: 000000f194651260
CPU: 3 CR30: 000000007c650000 CR31: 790e0bfc707c59cf
ORIG_R28: 0000000000011220
IAOQ[0]: blk_rq_map_sg+0x58c/0x8c0
IAOQ[1]: blk_rq_map_sg+0x590/0x8c0
RP(r2): blk_rq_map_sg+0x368/0x8c0
Backtrace:
[<000000004046f6d0>] scsi_init_sgtable+0x70/0xb8
[<000000004046f784>] scsi_init_io+0x6c/0x220
[<00000000104ab5c0>] sd_setup_read_write_cmnd+0x58/0x968 [sd_mod]
[<00000000104abf14>] sd_init_command+0x44/0x130 [sd_mod]
[<000000004046fa3c>] scsi_setup_cmnd+0x104/0x1b0
[<000000004046fcd8>] scsi_prep_fn+0x100/0x1a0
[<000000004035b9b0>] blk_peek_request+0x1b8/0x298
[<0000000040471248>] scsi_request_fn+0xf8/0xa90
[<0000000040357244>] __blk_run_queue+0x4c/0x70
[<00000000403804e4>] cfq_insert_request+0x2dc/0x580
[<0000000040356404>] __elv_add_request+0x1b4/0x300
CPU: 3 PID: 1021 Comm: systemd-udevd Tainted: G D 4.2.0-rc2+ #24
Backtrace:
[<000000004015e4a8>] show_stack+0x20/0x38
[<0000000040385f9c>] dump_stack+0x9c/0x110
[<000000004015e67c>] die_if_kernel+0x19c/0x2e0
[<000000004015f558>] handle_interruption+0x9a8/0x9d0
---[ end trace 4edd1ace8cf92f31 ]---
NMI watchdog: BUG: soft lockup - CPU#2 stuck for 22s! [systemd-udevd:1021]
Modules linked in: ohci_pci ehci_pci ohci_hcd sr_mod mptspi ehci_hcd sd_mod mptn
CPU: 2 PID: 1021 Comm: systemd-udevd Tainted: G D 4.2.0-rc2+ #24
task: 000000007f7b63c8 ti: 000000007c650000 task.ti: 000000007c650000
YZrvWESTHLNXBCVMcbcbcbcbOGFRQPDI
PSW: 00001000000001101111111100001111 Tainted: G D
r00-03 000000ff0806ff0f 000000007c651d60 00000000401fec7c 000000007c651c90
r04-07 0000000040750090 000000007c651d30 00000000407e2280 00000000407e21b8
r08-11 0000000042e8d3c0 0000000042e8d3c8 0000000000000001 0000000040727d70
r12-15 0000000000000000 000000007c651d30 000000000000002a 000000007e2cb7d0
r16-19 000000007c651260 0000000042df0500 0000000000001000 0000000042e83620
r20-23 0000000000000001 000000000800000f 000000000800000f 0000000000000000
r24-27 0000000000000000 0000000000000020 0000000042e8d3c8 0000000040750090
r28-31 0000000000000001 000000007c651db0 000000007c651d60 0000000000000003
sr00-03 0000000000015800 0000000000013800 0000000000000000 0000000000015800
sr04-07 0000000000000000 0000000000000000 0000000000000000 0000000000000000
IASQ: 0000000000000000 0000000000000000 IAOQ: 00000000401feca4 00000000401feca8
IIR: 4a7f0030 ISR: 0000000040750090 IOR: 00000000408b568c
CPU: 2 CR30: 000000007c650000 CR31: ffffffffffffffff
ORIG_R28: 00000000407e2258
IAOQ[0]: smp_call_function_many+0x32c/0x3b8
IAOQ[1]: smp_call_function_many+0x330/0x3b8
RP(r2): smp_call_function_many+0x304/0x3b8
Backtrace:
[<00000000401fedec>] on_each_cpu+0x5c/0xa0
[<000000004015bdb0>] flush_tlb_all+0x108/0x1e8
[<0000000040241700>] tlb_flush_mmu_tlbonly+0x48/0xa8
[<00000000402423e8>] tlb_finish_mmu+0x30/0x98
[<000000004024e87c>] exit_mmap+0x134/0x1b8
[<00000000401834a0>] mmput+0xc0/0x1b0
[<00000000401886a0>] do_exit+0x318/0xbe0
[<000000004015e6d8>] die_if_kernel+0x1f8/0x2e0
[<000000004015f558>] handle_interruption+0x9a8/0x9d0
timer_interrupt(CPU 2): delayed! cycles 801FB1C1 rem 6B3BF next/now 236C62FFC9A
NMI watchdog: BUG: soft lockup - CPU#2 stuck for 22s! [systemd-udevd:1021]
Modules linked in: ohci_pci ehci_pci ohci_hcd sr_mod mptspi ehci_hcd sd_mod mptn
CPU: 2 PID: 1021 Comm: systemd-udevd Tainted: G D L 4.2.0-rc2+ #24
task: 000000007f7b63c8 ti: 000000007c650000 task.ti: 000000007c650000
YZrvWESTHLNXBCVMcbcbcbcbOGFRQPDI
PSW: 00001000000001101111111100001111 Tainted: G D L
r00-03 000000ff0806ff0f 000000007c651d60 00000000401fec7c 000000007c651c90
r04-07 0000000040750090 000000007c651d30 00000000407e2280 00000000407e21b8
r08-11 0000000042e8d3c0 0000000042e8d3c8 0000000000000001 0000000040727d70
r12-15 0000000000000000 000000007c651d30 000000000000002a 000000007e2cb7d0
r16-19 000000007c651260 0000000042df0500 0000000000001000 0000000042e83620
r20-23 0000000000000001 000000000800000f 000000000800000f 0000000000000000
r24-27 0000000000000000 0000000000000020 0000000042e8d3c8 0000000040750090
r28-31 0000000000000001 000000007c651db0 000000007c651d60 0000000000000003
sr00-03 0000000000015800 0000000000013800 0000000000000000 0000000000015800
sr04-07 0000000000000000 0000000000000000 0000000000000000 0000000000000000
IASQ: 0000000000000000 0000000000000000 IAOQ: 00000000401feca4 00000000401feca8
IIR: 4a7f0030 ISR: 0000000040750090 IOR: 00000000408b568c
CPU: 2 CR30: 000000007c650000 CR31: ffffffffffffffff
ORIG_R28: 00000000407e2258
IAOQ[0]: smp_call_function_many+0x32c/0x3b8
IAOQ[1]: smp_call_function_many+0x330/0x3b8
RP(r2): smp_call_function_many+0x304/0x3b8
Backtrace:
[<00000000401fedec>] on_each_cpu+0x5c/0xa0
[<000000004015bdb0>] flush_tlb_all+0x108/0x1e8
[<0000000040241700>] tlb_flush_mmu_tlbonly+0x48/0xa8
[<00000000402423e8>] tlb_finish_mmu+0x30/0x98
[<000000004024e87c>] exit_mmap+0x134/0x1b8
[<00000000401834a0>] mmput+0xc0/0x1b0
[<00000000401886a0>] do_exit+0x318/0xbe0
[<000000004015e6d8>] die_if_kernel+0x1f8/0x2e0
[<000000004015f558>] handle_interruption+0x9a8/0x9d0
timer_interrupt(CPU 2): delayed! cycles 801E0D93 rem 857ED next/now 29F15117C9C
INFO: rcu_sched detected stalls on CPUs/tasks: { 1} (detected by 3, t=6007 jiff)
Task dump for CPU 1:
kworker/1:1 R running task 0 58 2 0x00000004
Workqueue: events_freezable_power_ disk_events_workfn
Backtrace:
[<00000000401a349c>] worker_thread+0x494/0x628
[<00000000401ab56c>] kthread+0x144/0x178
[<000000004014a020>] end_fault_vector+0x20/0x28
[<000000004014a0c0>] _switch_to_ret+0x0/0xf40
....
Boot with following additional patch:
+ /* Provide extra entries in case of split. */
+ nents += 8;
+ if (nents > SCSI_MAX_SG_SEGMENTS)
+ nents = SCSI_MAX_SG_SEGMENTS;
+
Main Menu: Enter command or menu > bo
Interact with IPL (Y, N, or Cancel)?> n
Booting...
Boot IO Dependent Code (IODC) revision 2
HARD Booted.
palo ipl 1.95 root@mkhppa3 Thu Apr 17 20:15:17 UTC 2014
Partition Start(MB) End(MB) Id Type
1 1 62 f0 Palo
2 63 305 83 ext2
3 306 2259 82 swap
4 2260 70007 83 ext2
PALO(F0) partition contains:
0/vmlinux64 3248926(9024320) bytes @ 0x48000
Command line for kernel: 'root=LABEL=ROOT console=ttyS0 HOME=/ rootfstype=ext3 '
Selected kernel: /vmlinuz from partition 2
Selected ramdisk: /initrd.img from partition 2
uncompressing Linux kernel.....................................................2
.
ELF64 executable
Entry 00100000 first 00100000 n 2
Segment 0 load 00100000 size 206912 mediaptr 0x1000
Segment 1 load 00133000 size 8008536 mediaptr 0x34000
Loading ramdisk 10406466 bytes @ 3e201000...
Branching to kernel entry point 0x00100000. If this is the last
message you see, you may need to switch your console. This is
a common symptom -- search the FAQ and mailing list at parisc-linux.org
Linux version 4.2.0-rc2+ (dave@atlas) (gcc version 4.9.3 (GCC) ) #25 SMP Wed Fe6
unwind_init: start = 0x4077cd10, end = 0x407bbe30, entries = 16146
FP[0] enabled: Rev 1 Model 20
The 64-bit Kernel has started...
Default page size is 4KB.
bootconsole [ttyB0] enabled
Initialized PDC Console for debugging.
Determining PDC firmware type: 64 bit PAT.
model 000088b0 00000491 00000000 00000002 56bb5389fb0d1ec0 100000f0 00000008 002
vers 00000302
CPUID vers 20 rev 5 (0x00000285)
capabilities 0x35
model 9000/785/C8000
parisc_cache_init: Only equivalent aliasing supported!
Memory Ranges:
0) Start 0x0000000000000000 End 0x000000003fffffff Size 1024 MB
1) Start 0x0000000100000000 End 0x00000002ffdfffff Size 8190 MB
2) Start 0x0000004040000000 End 0x00000040ffffffff Size 3072 MB
Total Memory: 12286 MB
initrd: 7e201000-7ebeda42
initrd: reserving 3e201000-3ebeda42 (mem_max 2ffe00000)
PERCPU: Embedded 18 pages/cpu @0000000042e61000 s34240 r8192 d31296 u73728
SMP: bootstrap CPU ID is 0
Built 3 zonelists in Zone order, mobility grouping on. Total pages: 3102215
Kernel command line: root=LABEL=ROOT console=ttyS0 HOME=/ rootfstype=ext3 clockz
log_buf_len individual max cpu contribution: 4096 bytes
log_buf_len total cpu_extra contributions: 126976 bytes
log_buf_len min size: 131072 bytes
log_buf_len: 262144 bytes
early log buf free: 127792(97%)
PID hash table entries: 4096 (order: 3, 32768 bytes)
Dentry cache hash table entries: 2097152 (order: 12, 16777216 bytes)
Inode-cache hash table entries: 1048576 (order: 11, 8388608 bytes)
Sorting __ex_table...
Memory: 12338524K/12580864K available (4816K kernel code, 1587K rwdata, 931K ro)
virtual kernel memory layout:
vmalloc : 0x0000000000008000 - 0x000000003f000000 (1007 MB)
memory : 0x0000000040000000 - 0x0000004140000000 (266240 MB)
.init : 0x0000000040100000 - 0x0000000040147000 ( 284 kB)
.data : 0x00000000405fb000 - 0x0000000040870c10 (2519 kB)
.text : 0x0000000040147000 - 0x00000000405fb000 (4816 kB)
Hierarchical RCU implementation.
Build-time adjustment of leaf fanout to 64.
NR_IRQS:128
clocksource: cr16: mask: 0xffffffffffffffff max_cycles: 0x1cd42e4dffb, max_idles
Console: colour dummy device 160x64
------------------------
| Locking API testsuite:
----------------------------------------------------------------------------
| spin |wlock |rlock |mutex | wsem | rsem |
--------------------------------------------------------------------------
A-A deadlock:failed|failed| ok |failed|failed|failed|
A-B-B-A deadlock:failed|failed| ok |failed|failed|failed|
A-B-B-C-C-A deadlock:failed|failed| ok |failed|failed|failed|
A-B-C-A-B-C deadlock:failed|failed| ok |failed|failed|failed|
A-B-B-C-C-D-D-A deadlock:failed|failed| ok |failed|failed|failed|
A-B-C-D-B-D-D-A deadlock:failed|failed| ok |failed|failed|failed|
A-B-C-D-B-C-D-A deadlock:failed|failed| ok |failed|failed|failed|
double unlock:failed|failed|failed| ok |failed|failed|
initialize held:failed|failed|failed|failed|failed|failed|
bad unlock order: ok | ok | ok | ok | ok | ok |
--------------------------------------------------------------------------
recursive read-lock: | ok | |failed|
recursive read-lock #2: | ok | |failed|
mixed read-write-lock: |failed| |failed|
mixed write-read-lock: |failed| |failed|
--------------------------------------------------------------------------
hard-irqs-on + irq-safe-A/12:failed|failed| ok |
soft-irqs-on + irq-safe-A/12:failed|failed| ok |
hard-irqs-on + irq-safe-A/21:failed|failed| ok |
soft-irqs-on + irq-safe-A/21:failed|failed| ok |
sirq-safe-A => hirqs-on/12:failed|failed| ok |
sirq-safe-A => hirqs-on/21:failed|failed| ok |
hard-safe-A + irqs-on/12:failed|failed| ok |
soft-safe-A + irqs-on/12:failed|failed| ok |
hard-safe-A + irqs-on/21:failed|failed| ok |
soft-safe-A + irqs-on/21:failed|failed| ok |
hard-safe-A + unsafe-B #1/123:failed|failed| ok |
soft-safe-A + unsafe-B #1/123:failed|failed| ok |
hard-safe-A + unsafe-B #1/132:failed|failed| ok |
soft-safe-A + unsafe-B #1/132:failed|failed| ok |
hard-safe-A + unsafe-B #1/213:failed|failed| ok |
soft-safe-A + unsafe-B #1/213:failed|failed| ok |
hard-safe-A + unsafe-B #1/231:failed|failed| ok |
soft-safe-A + unsafe-B #1/231:failed|failed| ok |
hard-safe-A + unsafe-B #1/312:failed|failed| ok |
soft-safe-A + unsafe-B #1/312:failed|failed| ok |
hard-safe-A + unsafe-B #1/321:failed|failed| ok |
soft-safe-A + unsafe-B #1/321:failed|failed| ok |
hard-safe-A + unsafe-B #2/123:failed|failed| ok |
soft-safe-A + unsafe-B #2/123:failed|failed| ok |
hard-safe-A + unsafe-B #2/132:failed|failed| ok |
soft-safe-A + unsafe-B #2/132:failed|failed| ok |
hard-safe-A + unsafe-B #2/213:failed|failed| ok |
soft-safe-A + unsafe-B #2/213:failed|failed| ok |
hard-safe-A + unsafe-B #2/231:failed|failed| ok |
soft-safe-A + unsafe-B #2/231:failed|failed| ok |
hard-safe-A + unsafe-B #2/312:failed|failed| ok |
soft-safe-A + unsafe-B #2/312:failed|failed| ok |
hard-safe-A + unsafe-B #2/321:failed|failed| ok |
soft-safe-A + unsafe-B #2/321:failed|failed| ok |
hard-irq lock-inversion/123:failed|failed| ok |
soft-irq lock-inversion/123:failed|failed| ok |
hard-irq lock-inversion/132:failed|failed| ok |
soft-irq lock-inversion/132:failed|failed| ok |
hard-irq lock-inversion/213:failed|failed| ok |
soft-irq lock-inversion/213:failed|failed| ok |
hard-irq lock-inversion/231:failed|failed| ok |
soft-irq lock-inversion/231:failed|failed| ok |
hard-irq lock-inversion/312:failed|failed| ok |
soft-irq lock-inversion/312:failed|failed| ok |
hard-irq lock-inversion/321:failed|failed| ok |
soft-irq lock-inversion/321:failed|failed| ok |
hard-irq read-recursion/123: ok |
soft-irq read-recursion/123: ok |
hard-irq read-recursion/132: ok |
soft-irq read-recursion/132: ok |
hard-irq read-recursion/213: ok |
soft-irq read-recursion/213: ok |
hard-irq read-recursion/231: ok |
soft-irq read-recursion/231: ok |
hard-irq read-recursion/312: ok |
soft-irq read-recursion/312: ok |
hard-irq read-recursion/321: ok |
soft-irq read-recursion/321: ok |
--------------------------------------------------------------------------
| Wound/wait tests |
---------------------
ww api failures: ok | ok | ok |
ww contexts mixing:failed| ok |
finishing ww context: ok | ok | ok | ok |
locking mismatches: ok | ok | ok |
EDEADLK handling: ok | ok | ok | ok | ok | ok | o|
spinlock nest unlocked:failed|
-----------------------------------------------------
|block | try |context|
-----------------------------------------------------
context:failed| ok | ok |
try:failed| ok |failed|
block:failed| ok |failed|
spinlock:failed| ok |failed|
--------------------------------------------------------
153 out of 253 testcases failed, as expected. |
----------------------------------------------------
Calibrating delay loop... 1993.93 BogoMIPS (lpj=9969664)
pid_max: default: 32768 minimum: 301
Mount-cache hash table entries: 32768 (order: 6, 262144 bytes)
Mountpoint-cache hash table entries: 32768 (order: 6, 262144 bytes)
Brought up 1 CPUs
devtmpfs: initialized
clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 191s
atomic64_test: passed
NET: Registered protocol family 16
Searching for devices...
Found devices:
1. Crestone Peak Fast? at 0xfffffffffe780000 [128] { 0, 0x0, 0x88b, 0x00004 }
2. Crestone Peak Fast? at 0xfffffffffe781000 [129] { 0, 0x0, 0x88b, 0x00004 }
3. Crestone Peak Fast? at 0xfffffffffe798000 [152] { 0, 0x0, 0x88b, 0x00004 }
4. Crestone Peak Fast? at 0xfffffffffe799000 [153] { 0, 0x0, 0x88b, 0x00004 }
5. Memory at 0xfffffffffed08000 [8] { 1, 0x0, 0x0b6, 0x00009 }
6. Pluto BC McKinley Port at 0xfffffffffed00000 [0] { 12, 0x0, 0x880, 0x0000c }
7. Mercury PCI Bridge at 0xfffffffffed20000 [0/0] { 13, 0x0, 0x783, 0x0000a }
8. Mercury PCI Bridge at 0xfffffffffed24000 [0/2] { 13, 0x0, 0x783, 0x0000a }
9. Mercury PCI Bridge at 0xfffffffffed26000 [0/3] { 13, 0x0, 0x783, 0x0000a }
10. Quicksilver AGP Bridge at 0xfffffffffed28000 [0/4] { 13, 0x0, 0x784, 0x0000}
11. BMC IPMI Mgmt Ctlr at 0xfffffff0f05b0000 [16] { 15, 0x0, 0x004, 0x000c0 }
12. Crestone Peak Fast? Core RS-232 at 0xfffffff0f05e0000 [17] { 10, 0x0, 0x077}
13. Crestone Peak Fast? Core RS-232 at 0xfffffff0f05e2000 [18] { 10, 0x0, 0x077}
Enabling PDC_PAT chassis codes support v0.05
Releasing cpu 1 now, hpa=fffffffffe781000
FP[1] enabled: Rev 1 Model 20
Releasing cpu 2 now, hpa=fffffffffe798000
FP[2] enabled: Rev 1 Model 20
Releasing cpu 3 now, hpa=fffffffffe799000
FP[3] enabled: Rev 1 Model 20
CPU(s): 4 out of 4 PA8800 (Mako) at 1000.000000 MHz online
Setting cache flush threshold to 32768 kB
Setting TLB flush threshold to 1188 kB
SBA found Pluto 2.3 at 0xfffffffffed00000
Mercury version TR3.2 (0x32) found at 0xfffffffffed20000
LBA: lmmio_space [0xffffffff80000000-0xffffffff9fffffff] - new
LBA 0:0: PCI host bridge to bus 0000:00
pci_bus 0000:00: root bus resource [io 0x0000-0xffff]
pci_bus 0000:00: root bus resource [mem 0xffffffff80000000-0xffffffff9fffffff] )
pci_bus 0000:00: root bus resource [mem 0xffffff0000000000-0xffffff0fffffffff]
pci_bus 0000:00: root bus resource [bus 00-07]
Mercury version TR3.2 (0x32) found at 0xfffffffffed24000
LBA 0:2: PCI host bridge to bus 0000:40
pci_bus 0000:40: root bus resource [io 0x10000-0x1ffff] (bus address [0x0000-0)
pci_bus 0000:40: root bus resource [mem 0xffffffffa0000000-0xffffffffafffffff] )
pci_bus 0000:40: root bus resource [mem 0xffffff2000000000-0xffffff2fffffffff]
pci_bus 0000:40: root bus resource [bus 40-47]
Mercury version TR3.2 (0x32) found at 0xfffffffffed26000
LBA 0:3: PCI host bridge to bus 0000:60
pci_bus 0000:60: root bus resource [io 0x20000-0x2ffff] (bus address [0x0000-0)
pci_bus 0000:60: root bus resource [mem 0xffffffffb0000000-0xffffffffbfffffff] )
pci_bus 0000:60: root bus resource [mem 0xffffff3000000000-0xffffff3fffffffff]
pci_bus 0000:60: root bus resource [bus 60-67]
Quicksilver version TR1.0 (0x10) found at 0xfffffffffed28000
LBA: lmmio_space [0xffffffffc0000000-0xffffffffdfffffff] - new
LBA 0:4: PCI host bridge to bus 0000:80
pci_bus 0000:80: root bus resource [io 0x30000-0x3ffff] (bus address [0x0000-0)
pci_bus 0000:80: root bus resource [mem 0xffffffffc0000000-0xffffffffdfffffff] )
pci_bus 0000:80: root bus resource [mem 0xffffff4000000000-0xffffff4fffffffff]
pci_bus 0000:80: root bus resource [bus 80-87]
powersw: Soft power switch at 0xfffffff0f042e278 enabled.
vgaarb: setting as boot device: PCI:0000:80:00.0
vgaarb: device added: PCI:0000:80:00.0,decodes=io+mem,owns=io+mem,locks=none
vgaarb: loaded
vgaarb: bridge control possible 0000:80:00.0
SCSI subsystem initialized
NET: Registered protocol family 2
TCP established hash table entries: 131072 (order: 8, 1048576 bytes)
TCP bind hash table entries: 65536 (order: 8, 1048576 bytes)
TCP: Hash tables configured (established 131072 bind 65536)
UDP hash table entries: 8192 (order: 6, 262144 bytes)
UDP-Lite hash table entries: 8192 (order: 6, 262144 bytes)
NET: Registered protocol family 1
RPC: Registered named UNIX socket transport module.
RPC: Registered udp transport module.
RPC: Registered tcp transport module.
RPC: Registered tcp NFSv4.1 backchannel transport module.
Trying to unpack rootfs image as initramfs...
Freeing initrd memory: 10160K (000000007e201000 - 000000007ebed000)
Performance monitoring counters enabled for Crestone Peak Fast?
futex hash table entries: 8192 (order: 7, 524288 bytes)
Block layer SCSI generic (bsg) driver version 0.4 loaded (major 253)
io scheduler noop registered
io scheduler deadline registered
io scheduler cfq registered (default)
Serial: 8250/16550 driver, 4 ports, IRQ sharing disabled
console [ttyS0] disabled
17: ttyS0 at MMIO 0xfffffff0f05e0800 (irq = 76, base_baud = 115200) is a 16550A
console [ttyS0] enabled
console [ttyS0] enabled
bootconsole [ttyB0] disabled
bootconsole [ttyB0] disabled
18: ttyS1 at MMIO 0xfffffff0f05e2800 (irq = 77, base_baud = 115200) is a 16550A
Linux agpgart interface v0.103
brd: module loaded
sata_sil24 0000:00:01.0: Applying completion IRQ loss on PCI-X errata fix
scsi host0: sata_sil24
scsi host1: sata_sil24
scsi host2: sata_sil24
scsi host3: sata_sil24
ata1: SATA max UDMA/100 host m128@0xffffffff80088000 port 0xffffffff80080000 ir6
ata2: SATA max UDMA/100 host m128@0xffffffff80088000 port 0xffffffff80082000 ir6
ata3: SATA max UDMA/100 host m128@0xffffffff80088000 port 0xffffffff80084000 ir6
ata4: SATA max UDMA/100 host m128@0xffffffff80088000 port 0xffffffff80086000 ir6
sil680: 133MHz clock.
scsi host4: pata_sil680
scsi host5: pata_sil680
ata5: PATA max UDMA/133 cmd 0x26158 ctl 0x26164 bmdma 0x26140 irq 72
ata6: PATA max UDMA/133 cmd 0x26150 ctl 0x26160 bmdma 0x26148 irq 72
HP SDC: No SDC found.
HP SDC MLC: Registering the System Domain Controller's HIL MLC.
HP SDC MLC: Request for raw HIL ISR hook denied
mousedev: PS/2 mouse device common for all mice
rtc-generic rtc-generic: rtc core: registered rtc-generic as rtc0
hidraw: raw HID events driver (C) Jiri Kosina
rtc-generic rtc-generic: setting system clock to 2016-02-24 23:08:03 UTC (14563)
ata1: SATA link down (SStatus 0 SControl 0)
ata2: SATA link down (SStatus 0 SControl 0)
ata3: SATA link down (SStatus 0 SControl 0)
ata4: SATA link up 3.0 Gbps (SStatus 123 SControl 0)
ata4.00: ATA-9: ST3000DM001-1ER166, CC25, max UDMA/133
ata4.00: 5860533168 sectors, multi 0: LBA48 NCQ (depth 31/32)
ata4.00: configured for UDMA/100
scsi 3:0:0:0: Direct-Access ATA ST3000DM001-1ER1 CC25 PQ: 0 ANSI: 5
ata6.00: ATAPI: HL-DT-STDVD+-RW GSA-H21L, 1.04, max UDMA/44
ata6.00: configured for UDMA/44
scsi 5:0:0:0: CD-ROM HL-DT-ST DVD+-RW GSA-H21L 1.04 PQ: 0 ANSI: 5
Freeing unused kernel memory: 284K (0000000040100000 - 0000000040147000)
Loading, please wait...
starting versionrandom: systemd-udevd urandom read with 119 bits of entropy avae
228
e1000: Intel(R) PRO/1000 Network Driver - version 7.3.21-k8-NAPI
e1000: Copyright (c) 1999-2006 Intel Corporation.
sd 3:0:0:0: [sda] 5860533168 512-byte logical blocks: (3.00 TB/2.72 TiB)
random: nonblocking pool is initialized
sd 3:0:0:0: [sda] 4096-byte physical blocks
Fusion MPT base driver 3.04.20
Copyright (c) 1999-2008 LSI Corporation
sd 3:0:0:0: [sda] Write Protect is off
sr 5:0:0:0: [sr0] scsi3-mmc drive: 48x/48x writer cd/rw xa/form2 cdda tray
cdrom: Uniform CD-ROM driver Revision: 3.20
sd 3:0:0:0: [sda] Write cache: enabled, read cache: enabled, doesn't support DPA
Fusion MPT SPI Host driver 3.04.20
usbcore: registered new interface driver usbfs
usbcore: registered new interface driver hub
usbcore: registered new device driver usb
ehci_hcd: USB 2.0 'Enhanced' Host Controller (EHCI) Driver
mptbase: ioc0: Initiating bringup
ohci_hcd: USB 1.1 'Open' Host Controller (OHCI) Driver
e1000 0000:60:03.0 eth0: (PCI:33MHz:32-bit) 00:11:0a:31:8a:77
e1000 0000:60:03.0 eth0: Intel(R) PRO/1000 Network Connection
ehci-pci: EHCI PCI platform driver
ehci-pci 0000:60:01.2: EHCI Host Controller
ehci-pci 0000:60:01.2: new USB bus registered, assigned bus number 1
ehci-pci 0000:60:01.2: irq 71, io mem 0xffffffffb00a1000
sda: sda1
ehci-pci 0000:60:01.2: USB 2.0 started, EHCI 0.95
usb usb1: New USB device found, idVendor=1d6b, idProduct=0002
usb usb1: New USB device strings: Mfr=3, Product=2, SerialNumber=1
usb usb1: Product: EHCI Host Controller
usb usb1: Manufacturer: Linux 4.2.0-rc2+ ehci_hcd
usb usb1: SerialNumber: 0000:60:01.2
hub 1-0:1.0: USB hub found
hub 1-0:1.0: 5 ports detected
sd 3:0:0:0: [sda] Attached SCSI disk
ohci-pci: OHCI PCI platform driver
ohci-pci 0000:60:01.0: OHCI PCI host controller
ohci-pci 0000:60:01.0: new USB bus registered, assigned bus number 2
ohci-pci 0000:60:01.0: irq 69, io mem 0xffffffffb00a3000
usb usb2: New USB device found, idVendor=1d6b, idProduct=0001
usb usb2: New USB device strings: Mfr=3, Product=2, SerialNumber=1
usb usb2: Product: OHCI PCI host controller
usb usb2: Manufacturer: Linux 4.2.0-rc2+ ohci_hcd
usb usb2: SerialNumber: 0000:60:01.0
hub 2-0:1.0: USB hub found
hub 2-0:1.0: 3 ports detected
ohci-pci 0000:60:01.1: OHCI PCI host controller
ohci-pci 0000:60:01.1: new USB bus registered, assigned bus number 3
ohci-pci 0000:60:01.1: irq 70, io mem 0xffffffffb00a2000
ioc0: LSI53C1030 B2: Capabilities={Initiator,Target}
usb usb3: New USB device found, idVendor=1d6b, idProduct=0001
usb usb3: New USB device strings: Mfr=3, Product=2, SerialNumber=1
usb usb3: Product: OHCI PCI host controller
usb usb3: Manufacturer: Linux 4.2.0-rc2+ ohci_hcd
usb usb3: SerialNumber: 0000:60:01.1
hub 3-0:1.0: USB hub found
hub 3-0:1.0: 2 ports detected
scsi host6: ioc0: LSI53C1030 B2, FwRev=01032341h, Ports=1, MaxQ=255, IRQ=67
scsi 6:0:0:0: Direct-Access HP 73.4G ST373207LW HPC1 PQ: 0 ANSI: 3
scsi target6:0:0: Beginning Domain Validation
scsi target6:0:0: Ending Domain Validation
scsi target6:0:0: FAST-160 WIDE SCSI 320.0 MB/s DT IU QAS RTI WRFLOW PCOMP (6.2)
sd 6:0:0:0: [sdb] 143374738 512-byte logical blocks: (73.4 GB/68.3 GiB)
scsi 6:0:2:0: Direct-Access HP 73.4G ST373207LW HPC1 PQ: 0 ANSI: 3
scsi target6:0:2: Beginning Domain Validation
scsi target6:0:2: Ending Domain Validation
scsi target6:0:2: FAST-160 WIDE SCSI 320.0 MB/s DT IU QAS RTI WRFLOW PCOMP (6.2)
sd 6:0:2:0: [sdc] 143374738 512-byte logical blocks: (73.4 GB/68.3 GiB)
sd 6:0:2:0: [sdc] Write Protect is off
sd 6:0:2:0: [sdc] Write cache: enabled, read cache: enabled, supports DPO and FA
sd 6:0:2:0: [sdc] Attached SCSI disk
sd 6:0:0:0: [sdb] Write Protect is off
sd 6:0:0:0: [sdb] Write cache: enabled, read cache: enabled, supports DPO and FA
mptbase: ioc1: Initiating bringup
ioc1: LSI53C1030 B2: Capabilities={Initiator,Target}
scsi host7: ioc1: LSI53C1030 B2, FwRev=01032341h, Ports=1, MaxQ=255, IRQ=68
sdb: sdb1 sdb2 sdb3 sdb4
sd 6:0:0:0: [sdb] Attached SCSI disk
blk_rq_map_sg: merge bug: 30 29, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007c799978(f:24490000, t:1)
0: 0 4096 254607 000000007e743880
1: 0 4096 254608 000000007e743880
2: 0 4096 254609 000000007e743880
3: 0 4096 254610 000000007e743880
4: 0 4096 254611 000000007e743880
5: 0 4096 254612 000000007e743880
6: 0 4096 254613 000000007e743880
7: 0 4096 254614 000000007e743880
8: 0 4096 254615 000000007e743880
9: 0 4096 254616 000000007e743880
10: 0 4096 254617 000000007e743880
11: 0 4096 254618 000000007e743880
12: 0 4096 254619 000000007e743880
13: 0 4096 254620 000000007e743880
14: 0 4096 254621 000000007e743880
15: 0 4096 254622 000000007e743880
16: 0 4096 254623 000000007e743880
17: 0 4096 254624 000000007e743880
18: 0 4096 254625 000000007e743880
19: 0 4096 254626 000000007e743880
20: 0 4096 247681 000000007e743880
21: 0 4096 247680 000000007e743880
22: 0 4096 247775 000000007e743880
23: 0 4096 247774 000000007e743880
24: 0 4096 247361 000000007e743880
25: 0 4096 247360 000000007e743880
26: 0 4096 247583 000000007e743880
27: 0 4096 247582 000000007e743880
28: 0 4096 247581 000000007e743880
29: 0 4096 247580 000000007e743880
30: 0 4096 247579 000000007e743880
31: 0 4096 247578 000000007e743880
32: 0 4096 247577 000000007e743880
33: 0 4096 247576 000000007e743880
34: 0 4096 247575 000000007e743880
35: 0 4096 247574 000000007e743880
36: 0 4096 247573 000000007e743880
37: 0 4096 247572 000000007e743880
38: 0 4096 247571 000000007e743880
39: 0 4096 255664 000000007e743880
40: 0 4096 255666 000000007e743880
41: 0 4096 255665 000000007e743880
42: 0 4096 247503 000000007e743880
43: 0 4096 247502 000000007e743880
44: 0 4096 258438 000000007e743880
45: 0 4096 247501 000000007e743880
46: 0 4096 247498 000000007e743880
47: 0 4096 247497 000000007e743880
timer_interrupt(CPU 2): delayed! cycles 7E6B87C2 rem 89B0BE next/now 1BB756E4E6
blk_rq_map_sg: merge bug: 3 1, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e53c5f0(f:24490000, t:1)
0: 0 4096 245852 000000007e2c4c40
1: 0 4096 245853 000000007e2c4c40
2: 0 4096 245854 000000007e2c4c40
3: 0 4096 245855 000000007e2c4c40
4: 0 4096 245856 000000007e2c4c40
5: 0 4096 245857 000000007e2c4c40
6: 0 4096 245858 000000007e2c4c40
7: 0 4096 245859 000000007e2c4c40
8: 0 4096 245860 000000007e2c4c40
9: 0 4096 245861 000000007e2c4c40
10: 0 4096 245862 000000007e2c4c40
11: 0 4096 245863 000000007e2c4c40
12: 0 4096 245864 000000007e2c4c40
13: 0 4096 245865 000000007e2c4c40
14: 0 4096 245866 000000007e2c4c40
15: 0 4096 245867 000000007e2c4c40
16: 0 4096 245868 000000007e2c4c40
17: 0 4096 245869 000000007e2c4c40
18: 0 4096 245870 000000007e2c4c40
19: 0 4096 245871 000000007e2c4c40
20: 0 4096 245872 000000007e2c4c40
21: 0 4096 245873 000000007e2c4c40
22: 0 4096 245874 000000007e2c4c40
23: 0 4096 245875 000000007e2c4c40
24: 0 4096 245876 000000007e2c4c40
25: 0 4096 245877 000000007e2c4c40
26: 0 4096 245878 000000007e2c4c40
27: 0 4096 245879 000000007e2c4c40
28: 0 4096 245880 000000007e2c4c40
29: 0 4096 245881 000000007e2c4c40
30: 0 4096 245882 000000007e2c4c40
31: 0 4096 245883 000000007e2c4c40
32: 0 4096 245884 000000007e2c4c40
33: 0 4096 245885 000000007e2c4c40
34: 0 4096 245886 000000007e2c4c40
35: 0 4096 245887 000000007e2c4c40
36: 0 4096 245888 000000007e2c4c40
37: 0 4096 245889 000000007e2c4c40
38: 0 4096 245890 000000007e2c4c40
39: 0 4096 245891 000000007e2c4c40
40: 0 4096 245892 000000007e2c4c40
41: 0 4096 245893 000000007e2c4c40
42: 0 4096 245894 000000007e2c4c40
43: 0 4096 245895 000000007e2c4c40
44: 0 4096 245896 000000007e2c4c40
45: 0 4096 245897 000000007e2c4c40
46: 0 4096 245898 000000007e2c4c40
47: 0 4096 245899 000000007e2c4c40
timer_interrupt(CPU 0): delayed! cycles 7E810E1D rem 742A63 next/now 1C41E74A92
blk_rq_map_sg: merge bug: 6 4, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007c6a32c0(f:24490000, t:1)
0: 0 4096 254802 000000007e56b100
1: 0 4096 254803 000000007e56b100
2: 0 4096 258172 000000007e56b100
3: 0 4096 258173 000000007e56b100
4: 0 4096 258174 000000007e56b100
5: 0 4096 258175 000000007e56b100
6: 0 4096 245908 000000007e56b100
7: 0 4096 245909 000000007e56b100
8: 0 4096 245910 000000007e56b100
9: 0 4096 245911 000000007e56b100
10: 0 4096 245912 000000007e56b100
11: 0 4096 245913 000000007e56b100
12: 0 4096 245914 000000007e56b100
13: 0 4096 245915 000000007e56b100
14: 0 4096 245916 000000007e56b100
15: 0 4096 245917 000000007e56b100
16: 0 4096 245918 000000007e56b100
17: 0 4096 245921 000000007e56b100
18: 0 4096 245922 000000007e56b100
19: 0 4096 245923 000000007e56b100
20: 0 4096 245924 000000007e56b100
21: 0 4096 245925 000000007e56b100
22: 0 4096 245926 000000007e56b100
23: 0 4096 245927 000000007e56b100
24: 0 4096 245928 000000007e56b100
25: 0 4096 245929 000000007e56b100
26: 0 4096 245930 000000007e56b100
27: 0 4096 245931 000000007e56b100
28: 0 4096 245932 000000007e56b100
29: 0 4096 245933 000000007e56b100
30: 0 4096 245934 000000007e56b100
31: 0 4096 245935 000000007e56b100
32: 0 4096 245936 000000007e56b100
33: 0 4096 245937 000000007e56b100
34: 0 4096 245938 000000007e56b100
35: 0 4096 245939 000000007e56b100
36: 0 4096 245940 000000007e56b100
37: 0 4096 245941 000000007e56b100
38: 0 4096 245942 000000007e56b100
39: 0 4096 245943 000000007e56b100
40: 0 4096 245944 000000007e56b100
41: 0 4096 245945 000000007e56b100
42: 0 4096 245946 000000007e56b100
43: 0 4096 245947 000000007e56b100
44: 0 4096 245948 000000007e56b100
45: 0 4096 245949 000000007e56b100
46: 0 4096 245950 000000007e56b100
47: 0 4096 245951 000000007e56b100
48: 0 4096 245952 000000007e56b100
49: 0 4096 245953 000000007e56b100
50: 0 4096 245954 000000007e56b100
51: 0 4096 245955 000000007e56b100
52: 0 4096 245956 000000007e56b100
53: 0 4096 245957 000000007e56b100
54: 0 4096 245958 000000007e56b100
55: 0 4096 245959 000000007e56b100
56: 0 4096 245960 000000007e56b100
57: 0 4096 245961 000000007e56b100
58: 0 4096 245962 000000007e56b100
59: 0 4096 245963 000000007e56b100
60: 0 4096 245964 000000007e56b100
61: 0 4096 245965 000000007e56b100
62: 0 4096 245966 000000007e56b100
63: 0 4096 245967 000000007e56b100
timer_interrupt(CPU 0): delayed! cycles A6702489 rem 747777 next/now 1CF7B2991E
blk_rq_map_sg: merge bug: 4 1, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007c6a3010(f:24490000, t:1)
0: 0 4096 245968 000000007e2c4ac0
1: 0 4096 245969 000000007e2c4ac0
2: 0 4096 245970 000000007e2c4ac0
3: 0 4096 245971 000000007e2c4ac0
4: 0 4096 245972 000000007e2c4ac0
5: 0 4096 245973 000000007e2c4ac0
6: 0 4096 245974 000000007e2c4ac0
7: 0 4096 245975 000000007e2c4ac0
8: 0 4096 245976 000000007e2c4ac0
9: 0 4096 245977 000000007e2c4ac0
10: 0 4096 245978 000000007e2c4ac0
11: 0 4096 245979 000000007e2c4ac0
12: 0 4096 245980 000000007e2c4ac0
13: 0 4096 245981 000000007e2c4ac0
14: 0 4096 245982 000000007e2c4ac0
15: 0 4096 245983 000000007e2c4ac0
16: 0 4096 245984 000000007e2c4ac0
17: 0 4096 245985 000000007e2c4ac0
18: 0 4096 245986 000000007e2c4ac0
19: 0 4096 245987 000000007e2c4ac0
20: 0 4096 245988 000000007e2c4ac0
21: 0 4096 245989 000000007e2c4ac0
22: 0 4096 245990 000000007e2c4ac0
23: 0 4096 245991 000000007e2c4ac0
24: 0 4096 245992 000000007e2c4ac0
25: 0 4096 245993 000000007e2c4ac0
26: 0 4096 245994 000000007e2c4ac0
27: 0 4096 245995 000000007e2c4ac0
28: 0 4096 245996 000000007e2c4ac0
29: 0 4096 245997 000000007e2c4ac0
30: 0 4096 245998 000000007e2c4ac0
31: 0 4096 245999 000000007e2c4ac0
32: 0 4096 246000 000000007e2c4ac0
33: 0 4096 246001 000000007e2c4ac0
34: 0 4096 246002 000000007e2c4ac0
35: 0 4096 246003 000000007e2c4ac0
36: 0 4096 246004 000000007e2c4ac0
37: 0 4096 246005 000000007e2c4ac0
38: 0 4096 246006 000000007e2c4ac0
39: 0 4096 246007 000000007e2c4ac0
40: 0 4096 246008 000000007e2c4ac0
41: 0 4096 246009 000000007e2c4ac0
42: 0 4096 246010 000000007e2c4ac0
43: 0 4096 246011 000000007e2c4ac0
44: 0 4096 246012 000000007e2c4ac0
45: 0 4096 246013 000000007e2c4ac0
46: 0 4096 246014 000000007e2c4ac0
47: 0 4096 246015 000000007e2c4ac0
48: 0 4096 246016 000000007e2c4ac0
49: 0 4096 246017 000000007e2c4ac0
50: 0 4096 246018 000000007e2c4ac0
51: 0 4096 246019 000000007e2c4ac0
52: 0 4096 246020 000000007e2c4ac0
53: 0 4096 246021 000000007e2c4ac0
54: 0 4096 246022 000000007e2c4ac0
55: 0 4096 246023 000000007e2c4ac0
56: 0 4096 246024 000000007e2c4ac0
57: 0 4096 246025 000000007e2c4ac0
58: 0 4096 246026 000000007e2c4ac0
59: 0 4096 246027 000000007e2c4ac0
60: 0 4096 246028 000000007e2c4ac0
61: 0 4096 246029 000000007e2c4ac0
62: 0 4096 246030 000000007e2c4ac0
63: 0 4096 246031 000000007e2c4ac0
timer_interrupt(CPU 0): delayed! cycles A61A0938 rem 31FC48 next/now 1DA525AC9D
blk_rq_map_sg: merge bug: 4 1, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007c6a32c0(f:24490000, t:1)
0: 0 4096 246032 000000007e56b100
1: 0 4096 246033 000000007e56b100
2: 0 4096 246034 000000007e56b100
3: 0 4096 246035 000000007e56b100
4: 0 4096 246036 000000007e56b100
5: 0 4096 246037 000000007e56b100
6: 0 4096 246038 000000007e56b100
7: 0 4096 246039 000000007e56b100
8: 0 4096 246040 000000007e56b100
9: 0 4096 246041 000000007e56b100
10: 0 4096 246042 000000007e56b100
11: 0 4096 246043 000000007e56b100
12: 0 4096 246044 000000007e56b100
13: 0 4096 246045 000000007e56b100
14: 0 4096 246046 000000007e56b100
15: 0 4096 246047 000000007e56b100
16: 0 4096 246048 000000007e56b100
17: 0 4096 246049 000000007e56b100
18: 0 4096 246050 000000007e56b100
19: 0 4096 246051 000000007e56b100
20: 0 4096 246052 000000007e56b100
21: 0 4096 246053 000000007e56b100
22: 0 4096 246054 000000007e56b100
23: 0 4096 246055 000000007e56b100
24: 0 4096 246056 000000007e56b100
25: 0 4096 246057 000000007e56b100
26: 0 4096 246058 000000007e56b100
27: 0 4096 246059 000000007e56b100
28: 0 4096 246060 000000007e56b100
29: 0 4096 246061 000000007e56b100
30: 0 4096 246062 000000007e56b100
31: 0 4096 246063 000000007e56b100
32: 0 4096 246064 000000007e56b100
33: 0 4096 246065 000000007e56b100
34: 0 4096 246066 000000007e56b100
35: 0 4096 246067 000000007e56b100
36: 0 4096 246068 000000007e56b100
37: 0 4096 246069 000000007e56b100
38: 0 4096 246070 000000007e56b100
39: 0 4096 246071 000000007e56b100
40: 0 4096 246072 000000007e56b100
41: 0 4096 246073 000000007e56b100
42: 0 4096 246074 000000007e56b100
43: 0 4096 246075 000000007e56b100
44: 0 4096 246076 000000007e56b100
45: 0 4096 246077 000000007e56b100
46: 0 4096 246078 000000007e56b100
47: 0 4096 246079 000000007e56b100
48: 0 4096 246080 000000007e56b100
49: 0 4096 246081 000000007e56b100
50: 0 4096 246082 000000007e56b100
51: 0 4096 246083 000000007e56b100
52: 0 4096 246084 000000007e56b100
53: 0 4096 246085 000000007e56b100
54: 0 4096 246086 000000007e56b100
55: 0 4096 246087 000000007e56b100
56: 0 4096 246088 000000007e56b100
57: 0 4096 246089 000000007e56b100
58: 0 4096 246090 000000007e56b100
59: 0 4096 246091 000000007e56b100
60: 0 4096 246092 000000007e56b100
61: 0 4096 246093 000000007e56b100
62: 0 4096 246094 000000007e56b100
63: 0 4096 246095 000000007e56b100
timer_interrupt(CPU 0): delayed! cycles A64FC1D0 rem 94DA30 next/now 1E52002995
Begin: Loading essential drivers ... done.
Begin: Running /scripts/init-premount ... done.
Begin: Mounting root file system ... Begin: Running /scripts/local-top ... done.
Begin: Running /scripts/local-premount ... done.
Begin: Will now check root file system ... fsck from util-linux 2.27.1
[/sbin/fsck.ext3 (1) -- /dev/sdb4] fsck.ext3 -a -C0 /dev/sdb4
ROOT: clean, 131346/4341760 files, 4012036/17343502 blocks
donekjournald starting. Commit interval 5 seconds
.
EXT3-fs (sdb4): mounted filesystem with writeback data mode
done.
Begin: Running /scripts/local-bottom ... done.
Begin: Running /scripts/init-bottom ... done.
INIT: version 2.88 booting
[info] Using makefile-style concurrent boot in runlevel S.
blk_rq_map_sg: merge bug: 3 2, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007c7cedc0(f:24490000, t:1)
0: 0 4096 19198 000000007e6e7d00
1: 0 4096 19199 000000007e6e7d00
2: 0 4096 19200 000000007e6e7d00
3: 0 4096 19201 000000007e6e7d00
4: 0 4096 19202 000000007e6e7d00
5: 0 4096 19203 000000007e6e7d00
6: 0 4096 19213 000000007e6e7d00
7: 0 4096 19214 000000007e6e7d00
8: 0 4096 19215 000000007e6e7d00
9: 0 4096 19216 000000007e6e7d00
10: 0 4096 19217 000000007e6e7d00
11: 0 4096 19218 000000007e6e7d00
12: 0 4096 19219 000000007e6e7d00
13: 0 4096 19220 000000007e6e7d00
14: 0 4096 19221 000000007e6e7d00
15: 0 4096 19222 000000007e6e7d00
16: 0 4096 19223 000000007e6e7d00
17: 0 4096 19224 000000007e6e7d00
18: 0 4096 19225 000000007e6e7d00
19: 0 4096 19226 000000007e6e7d00
20: 0 4096 19227 000000007e6e7d00
21: 0 4096 19228 000000007e6e7d00
22: 0 4096 19229 000000007e6e7d00
timer_interrupt(CPU 0): delayed! cycles 3EEEC3B2 rem 3F8D4E next/now 1F7D374897
blk_rq_map_sg: merge bug: 2 1, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007c6a32c0(f:24490000, t:1)
0: 0 4096 243716 000000007e700c40
1: 0 4096 243717 000000007e700c40
2: 0 4096 243718 000000007e700c40
3: 0 4096 243719 000000007e700c40
4: 0 4096 243720 000000007e700c40
5: 0 4096 243721 000000007e700c40
6: 0 4096 243722 000000007e700c40
7: 0 4096 243723 000000007e700c40
8: 0 4096 243724 000000007e700c40
9: 0 4096 243725 000000007e700c40
10: 0 4096 243726 000000007e700c40
11: 0 4096 243727 000000007e700c40
12: 0 4096 243728 000000007e700c40
13: 0 4096 243729 000000007e700c40
14: 0 4096 243730 000000007e700c40
15: 0 4096 243731 000000007e700c40
16: 0 4096 243732 000000007e700c40
blk_rq_map_sg: merge bug: 3 2, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007c6a3010(f:24490000, t:1)
0: 0 4096 243842 000000007e700c40
1: 0 4096 243843 000000007e700c40
2: 0 4096 243844 000000007e700c40
3: 0 4096 243845 000000007e700c40
4: 0 4096 243846 000000007e700c40
5: 0 4096 243847 000000007e700c40
6: 0 4096 243848 000000007e700c40
7: 0 4096 243849 000000007e700c40
8: 0 4096 243850 000000007e700c40
9: 0 4096 243851 000000007e700c40
10: 0 4096 243852 000000007e700c40
11: 0 4096 243853 000000007e700c40
12: 0 4096 243854 000000007e700c40
13: 0 4096 243855 000000007e700c40
14: 0 4096 243856 000000007e700c40
15: 0 4096 243857 000000007e700c40
16: 0 4096 243858 000000007e700c40
17: 0 4096 243859 000000007e700c40
18: 0 4096 243860 000000007e700c40
19: 0 4096 243861 000000007e700c40
20: 0 4096 243862 000000007e700c40
21: 0 4096 243863 000000007e700c40
22: 0 4096 243864 000000007e700c40
23: 0 4096 243865 000000007e700c40
24: 0 4096 243869 000000007e700c40
25: 0 4096 243870 000000007e700c40
26: 0 4096 243871 000000007e700c40
27: 0 4096 243872 000000007e700c40
28: 0 4096 243873 000000007e700c40
29: 0 4096 243874 000000007e700c40
30: 0 4096 243875 000000007e700c40
31: 0 4096 243876 000000007e700c40
timer_interrupt(CPU 0): delayed! cycles 56E0ED66 rem 24E79A next/now 20457CD09B
blk_rq_map_sg: merge bug: 3 2, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007c7cedc0(f:24490000, t:1)
0: 0 4096 243877 000000007e6e7880
1: 0 4096 243878 000000007e6e7880
2: 0 4096 243879 000000007e6e7880
3: 0 4096 243880 000000007e6e7880
4: 0 4096 243881 000000007e6e7880
5: 0 4096 243882 000000007e6e7880
6: 0 4096 243883 000000007e6e7880
7: 0 4096 243884 000000007e6e7880
8: 0 4096 243885 000000007e6e7880
9: 0 4096 243886 000000007e6e7880
10: 0 4096 243887 000000007e6e7880
11: 0 4096 243888 000000007e6e7880
12: 0 4096 243900 000000007e6e7880
13: 0 4096 243901 000000007e6e7880
14: 0 4096 243902 000000007e6e7880
15: 0 4096 243903 000000007e6e7880
16: 0 4096 243904 000000007e6e7880
17: 0 4096 243905 000000007e6e7880
18: 0 4096 243906 000000007e6e7880
19: 0 4096 243907 000000007e6e7880
20: 0 4096 243908 000000007e6e7880
21: 0 4096 243909 000000007e6e7880
22: 0 4096 243910 000000007e6e7880
23: 0 4096 243911 000000007e6e7880
24: 0 4096 243912 000000007e6e7880
25: 0 4096 243913 000000007e6e7880
26: 0 4096 243914 000000007e6e7880
27: 0 4096 243915 000000007e6e7880
28: 0 4096 243916 000000007e6e7880
29: 0 4096 243917 000000007e6e7880
30: 0 4096 243918 000000007e6e7880
31: 0 4096 243919 000000007e6e7880
timer_interrupt(CPU 0): delayed! cycles 56D282B4 rem 33524C next/now 20A2788699
blk_rq_map_sg: merge bug: 5 4, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e2d1228(f:24490000, t:1)
0: 0 4096 244139 000000007e2c4c40
1: 0 4096 244138 000000007e2c4c40
2: 0 4096 244137 000000007e2c4c40
3: 0 4096 244146 000000007e2c4c40
4: 0 4096 244147 000000007e2c4c40
5: 0 4096 244148 000000007e2c4c40
6: 0 4096 244149 000000007e2c4c40
7: 0 4096 244150 000000007e2c4c40
8: 0 4096 244151 000000007e2c4c40
9: 0 4096 244152 000000007e2c4c40
10: 0 4096 244153 000000007e2c4c40
11: 0 4096 244154 000000007e2c4c40
12: 0 4096 244155 000000007e2c4c40
13: 0 4096 244156 000000007e2c4c40
14: 0 4096 244157 000000007e2c4c40
15: 0 4096 244158 000000007e2c4c40
16: 0 4096 244159 000000007e2c4c40
17: 0 4096 244160 000000007e2c4c40
18: 0 4096 244161 000000007e2c4c40
19: 0 4096 244162 000000007e2c4c40
20: 0 4096 244163 000000007e2c4c40
21: 0 4096 244164 000000007e2c4c40
22: 0 4096 244165 000000007e2c4c40
23: 0 4096 244166 000000007e2c4c40
24: 0 4096 244167 000000007e2c4c40
25: 0 4096 244168 000000007e2c4c40
26: 0 4096 244169 000000007e2c4c40
27: 0 4096 244170 000000007e2c4c40
28: 0 4096 244171 000000007e2c4c40
29: 0 4096 244172 000000007e2c4c40
30: 0 4096 244173 000000007e2c4c40
31: 0 4096 244174 000000007e2c4c40
timer_interrupt(CPU 0): delayed! cycles 56F53EB0 rem 109650 next/now 212599DC95
[....] Starting the hotplug events dispatcher: systemd-udevdstarting version 228
. ok
[....] Synthesizing the initial hotplug events...blk_rq_map_sg: merge bug: 13 10
check_bvec: dump bvec for 000000007c7cec68(f:24490000, t:1)
0: 0 4096 244052 000000007e56b7c0
1: 0 4096 244051 000000007e56b7c0
2: 0 4096 244050 000000007e56b7c0
3: 0 4096 244049 000000007e56b7c0
4: 0 4096 244048 000000007e56b7c0
5: 0 4096 244047 000000007e56b7c0
6: 0 4096 244046 000000007e56b7c0
7: 0 4096 244045 000000007e56b7c0
8: 0 4096 244044 000000007e56b7c0
9: 0 4096 244043 000000007e56b7c0
10: 0 4096 244042 000000007e56b7c0
11: 0 4096 243268 000000007e56b7c0
12: 0 4096 243269 000000007e56b7c0
13: 0 4096 243270 000000007e56b7c0
14: 0 4096 243271 000000007e56b7c0
15: 0 4096 243272 000000007e56b7c0
16: 0 4096 243273 000000007e56b7c0
17: 0 4096 243274 000000007e56b7c0
18: 0 4096 243275 000000007e56b7c0
19: 0 4096 243276 000000007e56b7c0
20: 0 4096 243277 000000007e56b7c0
21: 0 4096 243278 000000007e56b7c0
22: 0 4096 243279 000000007e56b7c0
23: 0 4096 243280 000000007e56b7c0
24: 0 4096 243281 000000007e56b7c0
25: 0 4096 243282 000000007e56b7c0
26: 0 4096 243283 000000007e56b7c0
27: 0 4096 243284 000000007e56b7c0
28: 0 4096 243285 000000007e56b7c0
29: 0 4096 243286 000000007e56b7c0
30: 0 4096 243287 000000007e56b7c0
31: 0 4096 243288 000000007e56b7c0
timer_interrupt(CPU 3): delayed! cycles 568D1987 rem 78BB79 next/now 21A8E520F7
blk_rq_map_sg: merge bug: 9 8, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e6e6300(f:24490000, t:1)
0: 0 4096 256236 000000007e743400
1: 0 4096 243995 000000007e743400
2: 0 4096 244030 000000007e743400
3: 0 4096 244015 000000007e743400
4: 0 4096 19012 000000007e743400
5: 0 4096 244119 000000007e743400
6: 0 4096 18736 000000007e743400
7: 0 4096 244657 000000007e743400
8: 0 4096 244658 000000007e743400
9: 0 4096 244659 000000007e743400
10: 0 4096 244660 000000007e743400
11: 0 4096 244661 000000007e743400
12: 0 4096 244662 000000007e743400
13: 0 4096 244663 000000007e743400
14: 0 4096 244664 000000007e743400
15: 0 4096 244665 000000007e743400
16: 0 4096 244666 000000007e743400
17: 0 4096 244667 000000007e743400
18: 0 4096 244668 000000007e743400
19: 0 4096 244669 000000007e743400
20: 0 4096 244670 000000007e743400
21: 0 4096 244671 000000007e743400
22: 0 4096 244672 000000007e743400
23: 0 4096 244673 000000007e743400
24: 0 4096 244674 000000007e743400
25: 0 4096 244675 000000007e743400
26: 0 4096 244676 000000007e743400
27: 0 4096 244677 000000007e743400
timer_interrupt(CPU 1): delayed! cycles 4C8678A5 rem 5D5DDB next/now 2200EBF99A
timer_interrupt(CPU 0): delayed! cycles 4C80535F rem 638321 next/now 2200F23494
timer_interrupt(CPU 3): delayed! cycles 4C5668F4 rem 8D6D8C next/now 22011C22F4
blk_rq_map_sg: merge bug: 3 2, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007c7cec68(f:24490000, t:1)
0: 0 4096 244632 000000007e36f100
1: 0 4096 244633 000000007e36f100
2: 0 4096 244634 000000007e36f100
3: 0 4096 244635 000000007e36f100
4: 0 4096 244636 000000007e36f100
5: 0 4096 244637 000000007e36f100
6: 0 4096 244638 000000007e36f100
7: 0 4096 244639 000000007e36f100
8: 0 4096 244640 000000007e36f100
9: 0 4096 244641 000000007e36f100
10: 0 4096 244642 000000007e36f100
11: 0 4096 244643 000000007e36f100
12: 0 4096 244644 000000007e36f100
13: 0 4096 244645 000000007e36f100
14: 0 4096 244646 000000007e36f100
15: 0 4096 244647 000000007e36f100
16: 0 4096 244648 000000007e36f100
17: 0 4096 244649 000000007e36f100
18: 0 4096 244650 000000007e36f100
19: 0 4096 244651 000000007e36f100
20: 0 4096 244652 000000007e36f100
21: 0 4096 244653 000000007e36f100
22: 0 4096 244654 000000007e36f100
23: 0 4096 244655 000000007e36f100
24: 0 4096 244656 000000007e36f100
25: 0 4096 244688 000000007e36f100
26: 0 4096 244689 000000007e36f100
27: 0 4096 244690 000000007e36f100
28: 0 4096 244691 000000007e36f100
29: 0 4096 244692 000000007e36f100
30: 0 4096 244693 000000007e36f100
31: 0 4096 244694 000000007e36f100
blk_rq_map_sg: merge bug: 2 1, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007c7cec68(f:24490000, t:1)
0: 0 4096 244695 000000007e36f100
1: 0 4096 244696 000000007e36f100
2: 0 4096 244697 000000007e36f100
3: 0 4096 244698 000000007e36f100
4: 0 4096 244699 000000007e36f100
5: 0 4096 244700 000000007e36f100
6: 0 4096 244701 000000007e36f100
7: 0 4096 244702 000000007e36f100
8: 0 4096 244703 000000007e36f100
9: 0 4096 244704 000000007e36f100
10: 0 4096 244705 000000007e36f100
11: 0 4096 244706 000000007e36f100
12: 0 4096 244707 000000007e36f100
13: 0 4096 244708 000000007e36f100
14: 0 4096 244709 000000007e36f100
15: 0 4096 244710 000000007e36f100
16: 0 4096 244711 000000007e36f100
timer_interrupt(CPU 1): delayed! cycles 99A6A770 rem 210590 next/now 229AB3A695
blk_rq_map_sg: merge bug: 17 16, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007c7cec68(f:24490000, t:1)
0: 0 4096 241762 000000007e700940
1: 0 4096 241761 000000007e700940
2: 0 4096 241760 000000007e700940
3: 0 4096 241759 000000007e700940
4: 0 4096 241758 000000007e700940
5: 0 4096 241757 000000007e700940
6: 0 4096 241756 000000007e700940
7: 0 4096 241755 000000007e700940
8: 0 4096 241754 000000007e700940
9: 0 4096 241753 000000007e700940
10: 0 4096 241752 000000007e700940
11: 0 4096 241751 000000007e700940
12: 0 4096 241750 000000007e700940
13: 0 4096 241749 000000007e700940
14: 0 4096 241748 000000007e700940
15: 0 4096 241763 000000007e700940
16: 0 4096 241764 000000007e700940
17: 0 4096 241765 000000007e700940
18: 0 4096 241766 000000007e700940
19: 0 4096 241767 000000007e700940
20: 0 4096 241768 000000007e700940
21: 0 4096 241769 000000007e700940
22: 0 4096 241770 000000007e700940
23: 0 4096 241771 000000007e700940
24: 0 4096 241772 000000007e700940
25: 0 4096 241773 000000007e700940
26: 0 4096 241774 000000007e700940
27: 0 4096 241775 000000007e700940
28: 0 4096 241776 000000007e700940
29: 0 4096 241777 000000007e700940
30: 0 4096 241778 000000007e700940
31: 0 4096 241779 000000007e700940
timer_interrupt(CPU 3): delayed! cycles 56DDB169 rem 282397 next/now 22F9A94979
blk_rq_map_sg: merge bug: 8 7, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007c6a3010(f:24490000, t:1)
0: 0 4096 241855 000000007e2c4c40
1: 0 4096 241854 000000007e2c4c40
2: 0 4096 241853 000000007e2c4c40
3: 0 4096 241852 000000007e2c4c40
4: 0 4096 241851 000000007e2c4c40
5: 0 4096 241850 000000007e2c4c40
6: 0 4096 241856 000000007e2c4c40
7: 0 4096 241857 000000007e2c4c40
8: 0 4096 241858 000000007e2c4c40
9: 0 4096 241859 000000007e2c4c40
10: 0 4096 241860 000000007e2c4c40
11: 0 4096 241861 000000007e2c4c40
12: 0 4096 241862 000000007e2c4c40
13: 0 4096 241863 000000007e2c4c40
14: 0 4096 241864 000000007e2c4c40
15: 0 4096 241865 000000007e2c4c40
16: 0 4096 241866 000000007e2c4c40
17: 0 4096 241867 000000007e2c4c40
18: 0 4096 241868 000000007e2c4c40
19: 0 4096 241869 000000007e2c4c40
20: 0 4096 241870 000000007e2c4c40
21: 0 4096 241871 000000007e2c4c40
22: 0 4096 241872 000000007e2c4c40
23: 0 4096 241873 000000007e2c4c40
24: 0 4096 241874 000000007e2c4c40
timer_interrupt(CPU 0): delayed! cycles 45571370 rem 65B510 next/now 2345CA9B15
blk_rq_map_sg: merge bug: 16 15, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007c7cec68(f:24490000, t:1)
0: 0 4096 242010 000000007e700940
1: 0 4096 242009 000000007e700940
2: 0 4096 242008 000000007e700940
3: 0 4096 242007 000000007e700940
4: 0 4096 242006 000000007e700940
5: 0 4096 242005 000000007e700940
6: 0 4096 242004 000000007e700940
7: 0 4096 242003 000000007e700940
8: 0 4096 242002 000000007e700940
9: 0 4096 242001 000000007e700940
10: 0 4096 242000 000000007e700940
11: 0 4096 241999 000000007e700940
12: 0 4096 241998 000000007e700940
13: 0 4096 241997 000000007e700940
14: 0 4096 242073 000000007e700940
15: 0 4096 242074 000000007e700940
16: 0 4096 242075 000000007e700940
17: 0 4096 242076 000000007e700940
18: 0 4096 242077 000000007e700940
19: 0 4096 242078 000000007e700940
20: 0 4096 242079 000000007e700940
21: 0 4096 242080 000000007e700940
22: 0 4096 242081 000000007e700940
23: 0 4096 242082 000000007e700940
24: 0 4096 242083 000000007e700940
25: 0 4096 242084 000000007e700940
26: 0 4096 242085 000000007e700940
27: 0 4096 242086 000000007e700940
28: 0 4096 242087 000000007e700940
29: 0 4096 242088 000000007e700940
30: 0 4096 242089 000000007e700940
31: 0 4096 242090 000000007e700940
timer_interrupt(CPU 3): delayed! cycles 57183241 rem 86393F next/now 23A388D5F1
blk_rq_map_sg: merge bug: 2 1, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007c6a3010(f:24490000, t:1)
0: 0 4096 242044 000000007e2c4c40
1: 0 4096 242045 000000007e2c4c40
2: 0 4096 242046 000000007e2c4c40
3: 0 4096 242047 000000007e2c4c40
4: 0 4096 242048 000000007e2c4c40
5: 0 4096 242049 000000007e2c4c40
6: 0 4096 242050 000000007e2c4c40
7: 0 4096 242051 000000007e2c4c40
8: 0 4096 242052 000000007e2c4c40
9: 0 4096 242053 000000007e2c4c40
10: 0 4096 242054 000000007e2c4c40
11: 0 4096 242055 000000007e2c4c40
12: 0 4096 242056 000000007e2c4c40
13: 0 4096 242057 000000007e2c4c40
14: 0 4096 242058 000000007e2c4c40
15: 0 4096 242059 000000007e2c4c40
16: 0 4096 242060 000000007e2c4c40
17: 0 4096 242061 000000007e2c4c40
[ ok lk_rq_map_sg: merge bug: 3 2, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007c7cec68(f:24490000, t:1)
9m 0: 0 4096 242091 000000007e700ac0
1: 0 4096 242092 000000007e700ac0
2: 0 4096 242093 000000007e700ac0
3: 0 4096 242197 000000007e700ac0
4: 0 4096 242198 000000007e700ac0
5: 0 4096 242199 000000007e700ac0
6: 0 4096 242200 000000007e700ac0
7: 0 4096 242201 000000007e700ac0
8: 0 4096 242202 000000007e700ac0
9: 0 4096 242203 000000007e700ac0
10: 0 4096 242204 000000007e700ac0
11: 0 4096 242205 000000007e700ac0
12: 0 4096 242206 000000007e700ac0
13: 0 4096 242207 000000007e700ac0
14: 0 4096 242208 000000007e700ac0
15: 0 4096 242209 000000007e700ac0
16: 0 4096 242210 000000007e700ac0
17: 0 4096 242211 000000007e700ac0
18: 0 4096 242212 000000007e700ac0
19: 0 4096 242213 000000007e700ac0
done.
blk_rq_map_sg: merge bug: 2 1, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e2d1228(f:24490000, t:1)
0: 0 4096 242545 000000007e2c4700
1: 0 4096 242546 000000007e2c4700
2: 0 4096 242547 000000007e2c4700
3: 0 4096 242548 000000007e2c4700
4: 0 4096 242549 000000007e2c4700
5: 0 4096 242550 000000007e2c4700
6: 0 4096 242551 000000007e2c4700
7: 0 4096 242552 000000007e2c4700
8: 0 4096 242553 000000007e2c4700
9: 0 4096 242554 000000007e2c4700
10: 0 4096 242555 000000007e2c4700
11: 0 4096 242556 000000007e2c4700
12: 0 4096 242557 000000007e2c4700
13: 0 4096 242558 000000007e2c4700
14: 0 4096 242559 000000007e2c4700
15: 0 4096 242560 000000007e2c4700
16: 0 4096 242561 000000007e2c4700
blk_rq_map_sg: merge bug: 3 2, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007c7cec68(f:24490000, t:1)
0: 0 4096 242481 000000007e700ac0
1: 0 4096 242482 000000007e700ac0
2: 0 4096 242483 000000007e700ac0
3: 0 4096 242484 000000007e700ac0
4: 0 4096 242485 000000007e700ac0
5: 0 4096 242486 000000007e700ac0
6: 0 4096 242487 000000007e700ac0
7: 0 4096 242488 000000007e700ac0
8: 0 4096 242489 000000007e700ac0
9: 0 4096 242490 000000007e700ac0
10: 0 4096 242491 000000007e700ac0
11: 0 4096 242492 000000007e700ac0
12: 0 4096 242493 000000007e700ac0
13: 0 4096 242494 000000007e700ac0
14: 0 4096 242495 000000007e700ac0
15: 0 4096 242496 000000007e700ac0
16: 0 4096 242497 000000007e700ac0
17: 0 4096 242498 000000007e700ac0
18: 0 4096 242499 000000007e700ac0
19: 0 4096 242500 000000007e700ac0
20: 0 4096 242501 000000007e700ac0
21: 0 4096 242502 000000007e700ac0
22: 0 4096 242503 000000007e700ac0
23: 0 4096 242507 000000007e700ac0
24: 0 4096 242508 000000007e700ac0
25: 0 4096 242509 000000007e700ac0
26: 0 4096 242510 000000007e700ac0
27: 0 4096 242511 000000007e700ac0
28: 0 4096 242512 000000007e700ac0
29: 0 4096 242513 000000007e700ac0
30: 0 4096 242514 000000007e700ac0
31: 0 4096 242515 000000007e700ac0
timer_interrupt(CPU 1): delayed! cycles 56B7580F rem 4E7CF1 next/now 24A902C214
blk_rq_map_sg: merge bug: 3 2, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007c7cec68(f:24490000, t:1)
0: 0 4096 242571 000000007e700ac0
1: 0 4096 242572 000000007e700ac0
2: 0 4096 242573 000000007e700ac0
3: 0 4096 242574 000000007e700ac0
4: 0 4096 242575 000000007e700ac0
5: 0 4096 242576 000000007e700ac0
6: 0 4096 242577 000000007e700ac0
7: 0 4096 241079 000000007e700ac0
8: 0 4096 241080 000000007e700ac0
9: 0 4096 241081 000000007e700ac0
10: 0 4096 241082 000000007e700ac0
11: 0 4096 241083 000000007e700ac0
12: 0 4096 241084 000000007e700ac0
13: 0 4096 241085 000000007e700ac0
14: 0 4096 241086 000000007e700ac0
15: 0 4096 241087 000000007e700ac0
16: 0 4096 241088 000000007e700ac0
17: 0 4096 241089 000000007e700ac0
18: 0 4096 241090 000000007e700ac0
19: 0 4096 241091 000000007e700ac0
20: 0 4096 241092 000000007e700ac0
21: 0 4096 241093 000000007e700ac0
22: 0 4096 241094 000000007e700ac0
23: 0 4096 241095 000000007e700ac0
24: 0 4096 241096 000000007e700ac0
25: 0 4096 241097 000000007e700ac0
26: 0 4096 241098 000000007e700ac0
27: 0 4096 241099 000000007e700ac0
28: 0 4096 241100 000000007e700ac0
29: 0 4096 241101 000000007e700ac0
30: 0 4096 241102 000000007e700ac0
31: 0 4096 241103 000000007e700ac0
timer_interrupt(CPU 3): delayed! cycles 56EFF7C1 rem 15DD3F next/now 25062EA171
[....] Waiting for /dev to be fully populated...sd 3:0:0:0: Attached scsi gener0
sr 5:0:0:0: Attached scsi generic sg1 type 5
sd 6:0:0:0: Attached scsi generic sg2 type 0
blk_rq_map_sg: merge bug: 2 1, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e53c1e8(f:24490000, t:1)
0: 0 4096 241280 000000007e56bac0
1: 0 4096 241281 000000007e56bac0
2: 0 4096 241282 000000007e56bac0
3: 0 4096 241283 000000007e56bac0
4: 0 4096 241284 000000007e56bac0
5: 0 4096 241285 000000007e56bac0
6: 0 4096 241286 000000007e56bac0
7: 0 4096 241287 000000007e56bac0
8: 0 4096 241288 000000007e56bac0
9: 0 4096 241289 000000007e56bac0
10: 0 4096 241290 000000007e56bac0
11: 0 4096 241291 000000007e56bac0
12: 0 4096 241292 000000007e56bac0
13: 0 4096 241293 000000007e56bac0
14: 0 4096 241294 000000007e56bac0
15: 0 4096 241295 000000007e56bac0
16: 0 4096 241296 000000007e56bac0
17: 0 4096 241297 000000007e56bac0
18: 0 4096 241298 000000007e56bac0
19: 0 4096 241299 000000007e56bac0
20: 0 4096 241300 000000007e56bac0
21: 0 4096 241301 000000007e56bac0
22: 0 4096 241302 000000007e56bac0
23: 0 4096 241303 000000007e56bac0
24: 0 4096 241304 000000007e56bac0
25: 0 4096 241305 000000007e56bac0
26: 0 4096 241306 000000007e56bac0
27: 0 4096 241307 000000007e56bac0
28: 0 4096 241308 000000007e56bac0
29: 0 4096 241309 000000007e56bac0
30: 0 4096 241310 000000007e56bac0
31: 0 4096 241311 000000007e56bac0
sd 6:0:2:0: Attached scsi generic sg3 type 0
e1000: eth0 NIC Link is Up 100 Mbps Full Duplex, Flow Control: RX/TX
blk_rq_map_sg: merge bug: 6 5, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e290e40(f:24490000, t:1)
0: 0 4096 257264 000000007e231580
1: 0 4096 257265 000000007e231580
2: 0 4096 257266 000000007e231580
3: 0 4096 257267 000000007e231580
4: 0 4096 246916 000000007e231580
5: 0 4096 246917 000000007e231580
6: 0 4096 246918 000000007e231580
7: 0 4096 246919 000000007e231580
8: 0 4096 257252 000000007e231580
9: 0 4096 257253 000000007e231580
10: 0 4096 257254 000000007e231580
11: 0 4096 257255 000000007e231580
12: 0 4096 248704 000000007e231580
13: 0 4096 248705 000000007e231580
14: 0 4096 248706 000000007e231580
15: 0 4096 248707 000000007e231580
16: 0 4096 248708 000000007e231580
17: 0 4096 248709 000000007e231580
18: 0 4096 248710 000000007e231580
19: 0 4096 248711 000000007e231580
20: 0 4096 248712 000000007e231580
21: 0 4096 248713 000000007e231580
22: 0 4096 248714 000000007e231580
23: 0 4096 248715 000000007e231580
24: 0 4096 248716 000000007e231580
25: 0 4096 248717 000000007e231580
26: 0 4096 248718 000000007e231580
27: 0 4096 248719 000000007e231580
28: 0 4096 248720 000000007e231580
29: 0 4096 248721 000000007e231580
30: 0 4096 248722 000000007e231580
31: 0 4096 248723 000000007e231580
32: 0 4096 248724 000000007e231580
33: 0 4096 248725 000000007e231580
34: 0 4096 248726 000000007e231580
35: 0 4096 248727 000000007e231580
36: 0 4096 248728 000000007e231580
37: 0 4096 248729 000000007e231580
38: 0 4096 248730 000000007e231580
39: 0 4096 248731 000000007e231580
40: 0 4096 248732 000000007e231580
41: 0 4096 248733 000000007e231580
42: 0 4096 248734 000000007e231580
43: 0 4096 248735 000000007e231580
44: 0 4096 254592 000000007e231580
45: 0 4096 254593 000000007e231580
46: 0 4096 254594 000000007e231580
47: 0 4096 254595 000000007e231580
timer_interrupt(CPU 1): delayed! cycles 7EB7A101 rem 3D977F next/now 2616632296
blk_rq_map_sg: merge bug: 4 3, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e290a38(f:24490000, t:1)
0: 0 4096 250268 000000007e231340
1: 0 4096 250269 000000007e231340
2: 0 4096 250270 000000007e231340
3: 0 4096 250271 000000007e231340
4: 0 4096 250272 000000007e231340
5: 0 4096 250273 000000007e231340
6: 0 4096 250274 000000007e231340
7: 0 4096 250275 000000007e231340
8: 0 4096 250276 000000007e231340
9: 0 4096 250277 000000007e231340
10: 0 4096 250278 000000007e231340
11: 0 4096 250279 000000007e231340
12: 0 4096 250280 000000007e231340
13: 0 4096 250281 000000007e231340
14: 0 4096 250282 000000007e231340
15: 0 4096 250283 000000007e231340
16: 0 4096 250284 000000007e231340
17: 0 4096 250285 000000007e231340
18: 0 4096 250286 000000007e231340
19: 0 4096 250287 000000007e231340
20: 0 4096 250290 000000007e231340
21: 0 4096 250291 000000007e231340
22: 0 4096 250292 000000007e231340
23: 0 4096 250293 000000007e231340
24: 0 4096 250294 000000007e231340
25: 0 4096 250295 000000007e231340
26: 0 4096 250296 000000007e231340
27: 0 4096 250297 000000007e231340
28: 0 4096 250298 000000007e231340
29: 0 4096 250299 000000007e231340
30: 0 4096 250300 000000007e231340
31: 0 4096 250301 000000007e231340
32: 0 4096 250302 000000007e231340
33: 0 4096 250303 000000007e231340
34: 0 4096 253184 000000007e231340
35: 0 4096 253185 000000007e231340
36: 0 4096 253186 000000007e231340
37: 0 4096 253187 000000007e231340
38: 0 4096 253188 000000007e231340
39: 0 4096 253189 000000007e231340
40: 0 4096 253190 000000007e231340
41: 0 4096 253191 000000007e231340
42: 0 4096 253192 000000007e231340
43: 0 4096 253193 000000007e231340
44: 0 4096 253194 000000007e231340
45: 0 4096 253195 000000007e231340
46: 0 4096 253196 000000007e231340
47: 0 4096 253197 000000007e231340
timer_interrupt(CPU 1): delayed! cycles 7E469613 rem 160BED next/now 269D17FF98
blk_rq_map_sg: merge bug: 5 2, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e6e6050(f:24490000, t:1)
0: 0 4096 248714 000000007e743280
1: 0 4096 248715 000000007e743280
2: 0 4096 248716 000000007e743280
3: 0 4096 248717 000000007e743280
4: 0 4096 248718 000000007e743280
5: 0 4096 248719 000000007e743280
6: 0 4096 248720 000000007e743280
7: 0 4096 248721 000000007e743280
8: 0 4096 248722 000000007e743280
9: 0 4096 248723 000000007e743280
10: 0 4096 248724 000000007e743280
11: 0 4096 248725 000000007e743280
12: 0 4096 248726 000000007e743280
13: 0 4096 248727 000000007e743280
14: 0 4096 248728 000000007e743280
15: 0 4096 248729 000000007e743280
16: 0 4096 248730 000000007e743280
17: 0 4096 248731 000000007e743280
18: 0 4096 248732 000000007e743280
19: 0 4096 248733 000000007e743280
20: 0 4096 248734 000000007e743280
21: 0 4096 248735 000000007e743280
22: 0 4096 245952 000000007e743280
23: 0 4096 245953 000000007e743280
24: 0 4096 245954 000000007e743280
25: 0 4096 245955 000000007e743280
26: 0 4096 245956 000000007e743280
27: 0 4096 245957 000000007e743280
28: 0 4096 245958 000000007e743280
29: 0 4096 245959 000000007e743280
30: 0 4096 245960 000000007e743280
31: 0 4096 245961 000000007e743280
32: 0 4096 245962 000000007e743280
33: 0 4096 245963 000000007e743280
34: 0 4096 245964 000000007e743280
35: 0 4096 245965 000000007e743280
36: 0 4096 245966 000000007e743280
37: 0 4096 245967 000000007e743280
38: 0 4096 245968 000000007e743280
39: 0 4096 245969 000000007e743280
40: 0 4096 245970 000000007e743280
41: 0 4096 245971 000000007e743280
42: 0 4096 245972 000000007e743280
43: 0 4096 245973 000000007e743280
44: 0 4096 245974 000000007e743280
45: 0 4096 245975 000000007e743280
46: 0 4096 245976 000000007e743280
47: 0 4096 245977 000000007e743280
48: 0 4096 245978 000000007e743280
49: 0 4096 245979 000000007e743280
50: 0 4096 245980 000000007e743280
51: 0 4096 245981 000000007e743280
52: 0 4096 245982 000000007e743280
53: 0 4096 245983 000000007e743280
54: 0 4096 245984 000000007e743280
55: 0 4096 245985 000000007e743280
56: 0 4096 245986 000000007e743280
57: 0 4096 245987 000000007e743280
58: 0 4096 245988 000000007e743280
59: 0 4096 245989 000000007e743280
60: 0 4096 245990 000000007e743280
61: 0 4096 245991 000000007e743280
62: 0 4096 245992 000000007e743280
63: 0 4096 245993 000000007e743280
timer_interrupt(CPU 3): delayed! cycles A6A14EFD rem 434D03 next/now 27573F94FD
blk_rq_map_sg: merge bug: 4 2, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e6e6458(f:24490000, t:1)
0: 0 4096 246013 000000007e231280
1: 0 4096 246014 000000007e231280
2: 0 4096 246015 000000007e231280
3: 0 4096 246848 000000007e231280
4: 0 4096 246849 000000007e231280
5: 0 4096 246850 000000007e231280
6: 0 4096 246851 000000007e231280
7: 0 4096 246852 000000007e231280
8: 0 4096 246853 000000007e231280
9: 0 4096 246854 000000007e231280
10: 0 4096 246855 000000007e231280
11: 0 4096 246856 000000007e231280
12: 0 4096 246857 000000007e231280
13: 0 4096 246858 000000007e231280
14: 0 4096 246859 000000007e231280
15: 0 4096 246860 000000007e231280
16: 0 4096 246861 000000007e231280
17: 0 4096 246862 000000007e231280
18: 0 4096 246863 000000007e231280
19: 0 4096 246864 000000007e231280
20: 0 4096 246865 000000007e231280
21: 0 4096 246866 000000007e231280
22: 0 4096 246867 000000007e231280
23: 0 4096 246868 000000007e231280
24: 0 4096 246869 000000007e231280
25: 0 4096 246870 000000007e231280
26: 0 4096 246871 000000007e231280
27: 0 4096 246872 000000007e231280
28: 0 4096 246873 000000007e231280
29: 0 4096 246874 000000007e231280
30: 0 4096 246875 000000007e231280
31: 0 4096 246876 000000007e231280
32: 0 4096 246877 000000007e231280
33: 0 4096 246878 000000007e231280
34: 0 4096 246879 000000007e231280
35: 0 4096 246880 000000007e231280
36: 0 4096 246881 000000007e231280
37: 0 4096 246882 000000007e231280
38: 0 4096 246883 000000007e231280
39: 0 4096 246884 000000007e231280
40: 0 4096 246885 000000007e231280
41: 0 4096 246886 000000007e231280
42: 0 4096 246887 000000007e231280
43: 0 4096 246888 000000007e231280
44: 0 4096 246889 000000007e231280
45: 0 4096 246890 000000007e231280
46: 0 4096 246891 000000007e231280
47: 0 4096 246892 000000007e231280
timer_interrupt(CPU 1): delayed! cycles 7E958E64 rem 5FAA1C next/now 27DEF57599
blk_rq_map_sg: merge bug: 22 21, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e53c1e8(f:24490000, t:1)
0: 0 4096 248749 000000007e231dc0
1: 0 4096 255178 000000007e231dc0
2: 0 4096 255860 000000007e231dc0
3: 0 4096 246099 000000007e231dc0
4: 0 4096 258298 000000007e231dc0
5: 0 4096 254586 000000007e231dc0
6: 0 4096 254485 000000007e231dc0
7: 0 4096 253278 000000007e231dc0
8: 0 4096 258256 000000007e231dc0
9: 0 4096 254158 000000007e231dc0
10: 0 4096 258378 000000007e231dc0
11: 0 4096 246010 000000007e231dc0
12: 0 4096 246011 000000007e231dc0
13: 0 4096 246009 000000007e231dc0
14: 0 4096 246008 000000007e231dc0
15: 0 4096 246007 000000007e231dc0
16: 0 4096 246006 000000007e231dc0
17: 0 4096 246005 000000007e231dc0
18: 0 4096 246004 000000007e231dc0
19: 0 4096 246003 000000007e231dc0
20: 0 4096 253438 000000007e231dc0
21: 0 4096 253439 000000007e231dc0
22: 0 4096 250112 000000007e231dc0
23: 0 4096 250113 000000007e231dc0
24: 0 4096 250114 000000007e231dc0
25: 0 4096 250115 000000007e231dc0
26: 0 4096 250116 000000007e231dc0
27: 0 4096 250117 000000007e231dc0
28: 0 4096 250118 000000007e231dc0
29: 0 4096 250119 000000007e231dc0
30: 0 4096 250120 000000007e231dc0
31: 0 4096 250121 000000007e231dc0
32: 0 4096 250122 000000007e231dc0
33: 0 4096 250123 000000007e231dc0
34: 0 4096 250124 000000007e231dc0
35: 0 4096 250125 000000007e231dc0
36: 0 4096 250126 000000007e231dc0
37: 0 4096 250127 000000007e231dc0
38: 0 4096 250128 000000007e231dc0
39: 0 4096 250129 000000007e231dc0
40: 0 4096 250130 000000007e231dc0
41: 0 4096 250131 000000007e231dc0
42: 0 4096 250132 000000007e231dc0
43: 0 4096 250133 000000007e231dc0
44: 0 4096 250134 000000007e231dc0
45: 0 4096 250135 000000007e231dc0
46: 0 4096 250136 000000007e231dc0
47: 0 4096 250137 000000007e231dc0
timer_interrupt(CPU 0): delayed! cycles 7EAD517D rem 47E703 next/now 286517F712
blk_rq_map_sg: merge bug: 14 12, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e6e6458(f:24490000, t:1)
0: 0 4096 246893 000000007e231280
1: 0 4096 246894 000000007e231280
2: 0 4096 246895 000000007e231280
3: 0 4096 246896 000000007e231280
4: 0 4096 246897 000000007e231280
5: 0 4096 246898 000000007e231280
6: 0 4096 246899 000000007e231280
7: 0 4096 246900 000000007e231280
8: 0 4096 246901 000000007e231280
9: 0 4096 255478 000000007e231280
10: 0 4096 254757 000000007e231280
11: 0 4096 247536 000000007e231280
12: 0 4096 253991 000000007e231280
13: 0 4096 250365 000000007e231280
14: 0 4096 254751 000000007e231280
15: 0 4096 248750 000000007e231280
16: 0 4096 250242 000000007e231280
17: 0 4096 253347 000000007e231280
18: 0 4096 246908 000000007e231280
19: 0 4096 246909 000000007e231280
20: 0 4096 246910 000000007e231280
21: 0 4096 246911 000000007e231280
22: 0 4096 253348 000000007e231280
23: 0 4096 253349 000000007e231280
24: 0 4096 253350 000000007e231280
25: 0 4096 253351 000000007e231280
26: 0 4096 253352 000000007e231280
27: 0 4096 253353 000000007e231280
28: 0 4096 253354 000000007e231280
29: 0 4096 253355 000000007e231280
30: 0 4096 253356 000000007e231280
31: 0 4096 253357 000000007e231280
32: 0 4096 253358 000000007e231280
33: 0 4096 253359 000000007e231280
34: 0 4096 253360 000000007e231280
35: 0 4096 253361 000000007e231280
36: 0 4096 253362 000000007e231280
37: 0 4096 253363 000000007e231280
38: 0 4096 253364 000000007e231280
39: 0 4096 253365 000000007e231280
40: 0 4096 253366 000000007e231280
41: 0 4096 253367 000000007e231280
42: 0 4096 253368 000000007e231280
43: 0 4096 253369 000000007e231280
44: 0 4096 253370 000000007e231280
45: 0 4096 253371 000000007e231280
46: 0 4096 253372 000000007e231280
47: 0 4096 253373 000000007e231280
48: 0 4096 253374 000000007e231280
49: 0 4096 253375 000000007e231280
50: 0 4096 253376 000000007e231280
51: 0 4096 253377 000000007e231280
52: 0 4096 253378 000000007e231280
53: 0 4096 253379 000000007e231280
54: 0 4096 253380 000000007e231280
55: 0 4096 253381 000000007e231280
56: 0 4096 253382 000000007e231280
57: 0 4096 253383 000000007e231280
58: 0 4096 253384 000000007e231280
59: 0 4096 253385 000000007e231280
60: 0 4096 253386 000000007e231280
61: 0 4096 253387 000000007e231280
62: 0 4096 253388 000000007e231280
63: 0 4096 253389 000000007e231280
timer_interrupt(CPU 3): delayed! cycles A63614F2 rem 15F08E next/now 2916487FF2
blk_rq_map_sg: merge bug: 8 6, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e53cb50(f:24490000, t:1)
0: 0 4096 253319 000000007e231a00
1: 0 4096 253320 000000007e231a00
2: 0 4096 253321 000000007e231a00
3: 0 4096 253322 000000007e231a00
4: 0 4096 253323 000000007e231a00
5: 0 4096 250139 000000007e231a00
6: 0 4096 250140 000000007e231a00
7: 0 4096 250141 000000007e231a00
8: 0 4096 246904 000000007e231a00
9: 0 4096 246905 000000007e231a00
10: 0 4096 246906 000000007e231a00
11: 0 4096 246907 000000007e231a00
12: 0 4096 250144 000000007e231a00
13: 0 4096 250145 000000007e231a00
14: 0 4096 250146 000000007e231a00
15: 0 4096 250147 000000007e231a00
16: 0 4096 250252 000000007e231a00
17: 0 4096 250253 000000007e231a00
18: 0 4096 250254 000000007e231a00
19: 0 4096 250255 000000007e231a00
20: 0 4096 250176 000000007e231a00
21: 0 4096 250177 000000007e231a00
22: 0 4096 250178 000000007e231a00
23: 0 4096 250179 000000007e231a00
24: 0 4096 250180 000000007e231a00
25: 0 4096 250181 000000007e231a00
26: 0 4096 250182 000000007e231a00
27: 0 4096 250183 000000007e231a00
28: 0 4096 250184 000000007e231a00
29: 0 4096 250185 000000007e231a00
30: 0 4096 250186 000000007e231a00
31: 0 4096 250187 000000007e231a00
32: 0 4096 250188 000000007e231a00
33: 0 4096 250189 000000007e231a00
34: 0 4096 250190 000000007e231a00
35: 0 4096 250191 000000007e231a00
36: 0 4096 250192 000000007e231a00
37: 0 4096 250193 000000007e231a00
38: 0 4096 250194 000000007e231a00
39: 0 4096 250195 000000007e231a00
40: 0 4096 250196 000000007e231a00
41: 0 4096 250197 000000007e231a00
42: 0 4096 250198 000000007e231a00
43: 0 4096 250199 000000007e231a00
44: 0 4096 250200 000000007e231a00
45: 0 4096 250201 000000007e231a00
46: 0 4096 250202 000000007e231a00
47: 0 4096 250203 000000007e231a00
48: 0 4096 250204 000000007e231a00
49: 0 4096 250205 000000007e231a00
50: 0 4096 250206 000000007e231a00
51: 0 4096 250207 000000007e231a00
52: 0 4096 250208 000000007e231a00
53: 0 4096 250209 000000007e231a00
54: 0 4096 250210 000000007e231a00
55: 0 4096 250211 000000007e231a00
56: 0 4096 250212 000000007e231a00
57: 0 4096 250213 000000007e231a00
58: 0 4096 250214 000000007e231a00
59: 0 4096 250215 000000007e231a00
60: 0 4096 250216 000000007e231a00
61: 0 4096 250217 000000007e231a00
62: 0 4096 250218 000000007e231a00
63: 0 4096 250219 000000007e231a00
timer_interrupt(CPU 0): delayed! cycles A6183B68 rem 33CA18 next/now 29C5F3FF1D
blk_rq_map_sg: merge bug: 5 4, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e53c498(f:24490000, t:1)
0: 0 4096 253235 000000007e6e7b80
1: 0 4096 253236 000000007e6e7b80
2: 0 4096 253237 000000007e6e7b80
3: 0 4096 253238 000000007e6e7b80
4: 0 4096 253239 000000007e6e7b80
5: 0 4096 253240 000000007e6e7b80
6: 0 4096 253241 000000007e6e7b80
7: 0 4096 253242 000000007e6e7b80
8: 0 4096 253243 000000007e6e7b80
9: 0 4096 253244 000000007e6e7b80
10: 0 4096 253245 000000007e6e7b80
11: 0 4096 253246 000000007e6e7b80
12: 0 4096 253247 000000007e6e7b80
13: 0 4096 248640 000000007e6e7b80
14: 0 4096 248641 000000007e6e7b80
15: 0 4096 248642 000000007e6e7b80
16: 0 4096 248643 000000007e6e7b80
17: 0 4096 248644 000000007e6e7b80
18: 0 4096 248645 000000007e6e7b80
19: 0 4096 248646 000000007e6e7b80
20: 0 4096 248647 000000007e6e7b80
21: 0 4096 248648 000000007e6e7b80
22: 0 4096 248649 000000007e6e7b80
23: 0 4096 248650 000000007e6e7b80
24: 0 4096 248651 000000007e6e7b80
25: 0 4096 248652 000000007e6e7b80
26: 0 4096 248653 000000007e6e7b80
27: 0 4096 248654 000000007e6e7b80
28: 0 4096 248655 000000007e6e7b80
29: 0 4096 246784 000000007e6e7b80
30: 0 4096 246785 000000007e6e7b80
31: 0 4096 246786 000000007e6e7b80
32: 0 4096 246787 000000007e6e7b80
33: 0 4096 246788 000000007e6e7b80
34: 0 4096 246789 000000007e6e7b80
35: 0 4096 246790 000000007e6e7b80
36: 0 4096 246791 000000007e6e7b80
37: 0 4096 246792 000000007e6e7b80
38: 0 4096 246793 000000007e6e7b80
39: 0 4096 246794 000000007e6e7b80
40: 0 4096 246795 000000007e6e7b80
41: 0 4096 246796 000000007e6e7b80
42: 0 4096 246797 000000007e6e7b80
43: 0 4096 246798 000000007e6e7b80
44: 0 4096 246799 000000007e6e7b80
45: 0 4096 246800 000000007e6e7b80
46: 0 4096 246801 000000007e6e7b80
47: 0 4096 246802 000000007e6e7b80
48: 0 4096 246803 000000007e6e7b80
49: 0 4096 246804 000000007e6e7b80
50: 0 4096 246805 000000007e6e7b80
51: 0 4096 246806 000000007e6e7b80
52: 0 4096 246807 000000007e6e7b80
53: 0 4096 246808 000000007e6e7b80
54: 0 4096 246809 000000007e6e7b80
55: 0 4096 246810 000000007e6e7b80
56: 0 4096 246811 000000007e6e7b80
57: 0 4096 246812 000000007e6e7b80
58: 0 4096 246813 000000007e6e7b80
59: 0 4096 246814 000000007e6e7b80
60: 0 4096 246815 000000007e6e7b80
61: 0 4096 248672 000000007e6e7b80
62: 0 4096 248673 000000007e6e7b80
63: 0 4096 248674 000000007e6e7b80
timer_interrupt(CPU 3): delayed! cycles A6274EF5 rem 24B68B next/now 2A77BD1E75
done.
NET: Registered protocol family 10
[....] Activating swap...done.
EXT3-fs (sdb4): using internal journal
[....] Activating lvm and md swap...done.
[....] Checking file systems...fsck from util-linux 2.27.1
BOOT: clean, 72/62496 files, 209445/249004 blocks
blk_rq_map_sg: merge bug: 6 3, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e6e6458(f:24490000, t:1)
HOME: clean, 682 0: 0 4096 253438 000000007febd880
246/91578368 fil 1: 0 4096 253439 000000007febd880
es, 12758144/366 2: 0 4096 253216 000000007febd880
283264 blocks
3: 0 4096 253217 000000007febd880
4: 0 4096 253218 000000007febd880
5: 0 4096 253219 000000007febd880
6: 0 4096 253220 000000007febd880
7: 0 4096 253221 000000007febd880
8: 0 4096 246149 000000007febd880
9: 0 4096 246150 000000007febd880
10: 0 4096 246151 000000007febd880
11: 0 4096 246152 000000007febd880
12: 0 4096 246153 000000007febd880
13: 0 4096 246154 000000007febd880
14: 0 4096 246155 000000007febd880
15: 0 4096 246156 000000007febd880
16: 0 4096 246157 000000007febd880
17: 0 4096 246158 000000007febd880
18: 0 4096 246159 000000007febd880
19: 0 4096 246160 000000007febd880
20: 0 4096 246161 000000007febd880
21: 0 4096 246162 000000007febd880
22: 0 4096 246163 000000007febd880
23: 0 4096 246164 000000007febd880
24: 0 4096 246165 000000007febd880
25: 0 4096 246166 000000007febd880
26: 0 4096 246167 000000007febd880
27: 0 4096 246168 000000007febd880
28: 0 4096 246169 000000007febd880
29: 0 4096 246170 000000007febd880
30: 0 4096 246171 000000007febd880
31: 0 4096 246172 000000007febd880
32: 0 4096 246173 000000007febd880
33: 0 4096 246174 000000007febd880
34: 0 4096 246175 000000007febd880
35: 0 4096 246176 000000007febd880
36: 0 4096 246177 000000007febd880
37: 0 4096 246178 000000007febd880
38: 0 4096 246179 000000007febd880
39: 0 4096 246180 000000007febd880
40: 0 4096 246181 000000007febd880
41: 0 4096 246182 000000007febd880
42: 0 4096 246183 000000007febd880
43: 0 4096 246184 000000007febd880
44: 0 4096 246185 000000007febd880
45: 0 4096 246186 000000007febd880
46: 0 4096 246187 000000007febd880
47: 0 4096 246188 000000007febd880
48: 0 4096 246189 000000007febd880
49: 0 4096 246190 000000007febd880
50: 0 4096 246191 000000007febd880
51: 0 4096 246192 000000007febd880
52: 0 4096 246193 000000007febd880
53: 0 4096 246194 000000007febd880
54: 0 4096 246195 000000007febd880
55: 0 4096 246196 000000007febd880
56: 0 4096 246197 000000007febd880
57: 0 4096 246198 000000007febd880
58: 0 4096 246199 000000007febd880
59: 0 4096 246200 000000007febd880
60: 0 4096 246201 000000007febd880
61: 0 4096 246202 000000007febd880
62: 0 4096 246203 000000007febd880
63: 0 4096 246204 000000007febd880
timer_interrupt(CPU 1): delayed! cycles AAC27238 rem 4E4748 next/now 2C4E6D641D
blk_rq_map_sg: merge bug: 8 5, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e77ac28(f:24490000, t:1)
0: 0 4096 246226 000000007febd4c0
1: 0 4096 246227 000000007febd4c0
2: 0 4096 246228 000000007febd4c0
3: 0 4096 246229 000000007febd4c0
4: 0 4096 246230 000000007febd4c0
5: 0 4096 246231 000000007febd4c0
6: 0 4096 246232 000000007febd4c0
7: 0 4096 246233 000000007febd4c0
8: 0 4096 246234 000000007febd4c0
9: 0 4096 246235 000000007febd4c0
10: 0 4096 246236 000000007febd4c0
11: 0 4096 246237 000000007febd4c0
12: 0 4096 246238 000000007febd4c0
13: 0 4096 246239 000000007febd4c0
14: 0 4096 246240 000000007febd4c0
15: 0 4096 246241 000000007febd4c0
16: 0 4096 246242 000000007febd4c0
17: 0 4096 246243 000000007febd4c0
18: 0 4096 255348 000000007febd4c0
19: 0 4096 255349 000000007febd4c0
20: 0 4096 255350 000000007febd4c0
21: 0 4096 255351 000000007febd4c0
22: 0 4096 248684 000000007febd4c0
23: 0 4096 248685 000000007febd4c0
24: 0 4096 248686 000000007febd4c0
25: 0 4096 248687 000000007febd4c0
26: 0 4096 248668 000000007febd4c0
27: 0 4096 248669 000000007febd4c0
28: 0 4096 248670 000000007febd4c0
29: 0 4096 248671 000000007febd4c0
30: 0 4096 248440 000000007febd4c0
31: 0 4096 248441 000000007febd4c0
32: 0 4096 248442 000000007febd4c0
33: 0 4096 248443 000000007febd4c0
34: 0 4096 248444 000000007febd4c0
35: 0 4096 248445 000000007febd4c0
36: 0 4096 248446 000000007febd4c0
37: 0 4096 248447 000000007febd4c0
38: 0 4096 248448 000000007febd4c0
39: 0 4096 248449 000000007febd4c0
40: 0 4096 248450 000000007febd4c0
41: 0 4096 248451 000000007febd4c0
42: 0 4096 248452 000000007febd4c0
43: 0 4096 248453 000000007febd4c0
44: 0 4096 248454 000000007febd4c0
45: 0 4096 248455 000000007febd4c0
46: 0 4096 248456 000000007febd4c0
47: 0 4096 248457 000000007febd4c0
48: 0 4096 248458 000000007febd4c0
49: 0 4096 248459 000000007febd4c0
50: 0 4096 248460 000000007febd4c0
51: 0 4096 248461 000000007febd4c0
52: 0 4096 248462 000000007febd4c0
53: 0 4096 248463 000000007febd4c0
54: 0 4096 248464 000000007febd4c0
55: 0 4096 248465 000000007febd4c0
56: 0 4096 248466 000000007febd4c0
57: 0 4096 248467 000000007febd4c0
58: 0 4096 248468 000000007febd4c0
59: 0 4096 248469 000000007febd4c0
60: 0 4096 248470 000000007febd4c0
61: 0 4096 248471 000000007febd4c0
62: 0 4096 248472 000000007febd4c0
63: 0 4096 248473 000000007febd4c0
timer_interrupt(CPU 1): delayed! cycles A62864FC rem 23A084 next/now 2CFD11A491
done.
[....] Cleaning up temporary files... /tmp. ok
EXT4-fs (sda1): mounted filesystem with ordered data mode. Opts: (null)
[....] Mounting local filesystems...done.
[....] Activating swapfile swap...done.
[....] Cleaning up temporary files.... ok
[....] Setting kernel variables ...done.
[....] Configuring network interfaces...ifup: interface eth0 already configured
done.
[....] Cleaning up temporary files.... ok
[....] Setting up X socket directories... /tmp/.X11-unix /tmp/.ICE-unix. ok
INIT: Entering runlevel: 2
[info] Using makefile-style concurrent boot in runlevel 2.
[....] Starting enhanced syslogd: rsyslogd. ok
Starting ctdbd service: blk_rq_map_sg: merge bug: 2 1, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e2900d0(f:24490000, t:1)
0: 0 4096 240513 000000007c4b0d00
1: 0 4096 240514 000000007c4b0d00
2: 0 4096 240515 000000007c4b0d00
3: 0 4096 240516 000000007c4b0d00
4: 0 4096 240517 000000007c4b0d00
5: 0 4096 240518 000000007c4b0d00
6: 0 4096 240519 000000007c4b0d00
7: 0 4096 240520 000000007c4b0d00
8: 0 4096 240521 000000007c4b0d00
9: 0 4096 240522 000000007c4b0d00
10: 0 4096 240523 000000007c4b0d00
11: 0 4096 240524 000000007c4b0d00
12: 0 4096 240525 000000007c4b0d00
13: 0 4096 240526 000000007c4b0d00
14: 0 4096 240527 000000007c4b0d00
15: 0 4096 240528 000000007c4b0d00
16: 0 4096 240529 000000007c4b0d00
blk_rq_map_sg: merge bug: 6 5, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007edc9c68(f:24490000, t:1)
0: 0 4096 240495 000000007ca4b7c0
1: 0 4096 240389 000000007ca4b7c0
2: 0 4096 239814 000000007ca4b7c0
3: 0 4096 242111 000000007ca4b7c0
4: 0 4096 240575 000000007ca4b7c0
5: 0 4096 240576 000000007ca4b7c0
6: 0 4096 240577 000000007ca4b7c0
7: 0 4096 240578 000000007ca4b7c0
8: 0 4096 240579 000000007ca4b7c0
9: 0 4096 240580 000000007ca4b7c0
10: 0 4096 240581 000000007ca4b7c0
11: 0 4096 240582 000000007ca4b7c0
12: 0 4096 240583 000000007ca4b7c0
13: 0 4096 240584 000000007ca4b7c0
14: 0 4096 240585 000000007ca4b7c0
15: 0 4096 240586 000000007ca4b7c0
16: 0 4096 240587 000000007ca4b7c0
17: 0 4096 240588 000000007ca4b7c0
18: 0 4096 240589 000000007ca4b7c0
19: 0 4096 240590 000000007ca4b7c0
20: 0 4096 240591 000000007ca4b7c0
21: 0 4096 240592 000000007ca4b7c0
22: 0 4096 240593 000000007ca4b7c0
23: 0 4096 240594 000000007ca4b7c0
24: 0 4096 240595 000000007ca4b7c0
25: 0 4096 240596 000000007ca4b7c0
26: 0 4096 240597 000000007ca4b7c0
27: 0 4096 240598 000000007ca4b7c0
28: 0 4096 240599 000000007ca4b7c0
timer_interrupt(CPU 3): delayed! cycles 4F17FFAF rem 2E30D1 next/now 324FD1B8FF
timer_interrupt(CPU 2): delayed! cycles 4EF1777C rem 54B904 next/now 324FF85F60
[....] Starting deferred execution scheduler: atdblk_rq_map_sg: merge bug: 7 6,0
check_bvec: dump bvec for 000000007ee66a38(f:24490000, t:1)
0: 0 4096 239173 000000007ee657c0
1: 0 4096 239172 000000007ee657c0
2: 0 4096 239171 000000007ee657c0
3: 0 4096 239170 000000007ee657c0
4: 0 4096 239169 000000007ee657c0
5: 0 4096 239205 000000007ee657c0
6: 0 4096 239206 000000007ee657c0
7: 0 4096 239207 000000007ee657c0
8: 0 4096 239208 000000007ee657c0
9: 0 4096 239209 000000007ee657c0
10: 0 4096 239210 000000007ee657c0
11: 0 4096 239211 000000007ee657c0
12: 0 4096 239212 000000007ee657c0
13: 0 4096 239213 000000007ee657c0
14: 0 4096 239214 000000007ee657c0
15: 0 4096 239215 000000007ee657c0
16: 0 4096 239216 000000007ee657c0
17: 0 4096 239217 000000007ee657c0
18: 0 4096 239218 000000007ee657c0
19: 0 4096 239219 000000007ee657c0
20: 0 4096 239220 000000007ee657c0
21: 0 4096 239221 000000007ee657c0
22: 0 4096 239222 000000007ee657c0
23: 0 4096 239223 000000007ee657c0
24: 0 4096 239224 000000007ee657c0
25: 0 4096 239225 000000007ee657c0
26: 0 4096 239226 000000007ee657c0
27: 0 4096 239227 000000007ee657c0
28: 0 4096 239228 000000007ee657c0
29: 0 4096 239229 000000007ee657c0
30: 0 4096 239230 000000007ee657c0
31: 0 4096 239231 000000007ee657c0
timer_interrupt(CPU 0): delayed! cycles 56C36908 rem 426BF8 next/now 32F260491D
blk_rq_map_sg: merge bug: 2 1, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007ee66b90(f:24490000, t:1)
0: 0 4096 239232 000000007ee65880
1: 0 4096 239233 000000007ee65880
2: 0 4096 239234 000000007ee65880
3: 0 4096 239235 000000007ee65880
4: 0 4096 239236 000000007ee65880
5: 0 4096 239237 000000007ee65880
6: 0 4096 239238 000000007ee65880
7: 0 4096 239239 000000007ee65880
8: 0 4096 239240 000000007ee65880
9: 0 4096 239241 000000007ee65880
10: 0 4096 239242 000000007ee65880
11: 0 4096 239243 000000007ee65880
12: 0 4096 239244 000000007ee65880
13: 0 4096 239245 000000007ee65880
14: 0 4096 239246 000000007ee65880
15: 0 4096 239247 000000007ee65880
16: 0 4096 239248 000000007ee65880
17: 0 4096 239249 000000007ee65880
18: 0 4096 239250 000000007ee65880
19: 0 4096 239251 000000007ee65880
20: 0 4096 239252 000000007ee65880
21: 0 4096 239253 000000007ee65880
22: 0 4096 239254 000000007ee65880
blk_rq_map_sg: merge bug: 2 1, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007ee66ce8(f:24490000, t:1)
0: 0 4096 239255 000000007ee65940
1: 0 4096 239256 000000007ee65940
2: 0 4096 239257 000000007ee65940
3: 0 4096 239258 000000007ee65940
4: 0 4096 239259 000000007ee65940
5: 0 4096 239260 000000007ee65940
6: 0 4096 239261 000000007ee65940
7: 0 4096 239262 000000007ee65940
8: 0 4096 239263 000000007ee65940
9: 0 4096 239264 000000007ee65940
10: 0 4096 239265 000000007ee65940
11: 0 4096 239266 000000007ee65940
12: 0 4096 239267 000000007ee65940
13: 0 4096 239268 000000007ee65940
14: 0 4096 239269 000000007ee65940
15: 0 4096 239270 000000007ee65940
16: 0 4096 239271 000000007ee65940
17: 0 4096 239272 000000007ee65940
18: 0 4096 239273 000000007ee65940
19: 0 4096 239274 000000007ee65940
20: 0 4096 239275 000000007ee65940
21: 0 4096 239276 000000007ee65940
22: 0 4096 239277 000000007ee65940
23: 0 4096 239278 000000007ee65940
24: 0 4096 239279 000000007ee65940
25: 0 4096 239280 000000007ee65940
26: 0 4096 239281 000000007ee65940
27: 0 4096 239282 000000007ee65940
28: 0 4096 239283 000000007ee65940
29: 0 4096 239284 000000007ee65940
30: 0 4096 239285 000000007ee65940
31: 0 4096 239286 000000007ee65940
blk_rq_map_sg: merge bug: 5 4, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e6e6300(f:24490000, t:1)
0: 0 4096 240629 000000007ca4b940
1: 0 4096 238698 000000007ca4b940
2: 0 4096 240630 000000007ca4b940
3: 0 4096 239360 000000007ca4b940
4: 0 4096 239361 000000007ca4b940
5: 0 4096 239362 000000007ca4b940
6: 0 4096 239363 000000007ca4b940
7: 0 4096 239364 000000007ca4b940
8: 0 4096 239365 000000007ca4b940
9: 0 4096 239366 000000007ca4b940
10: 0 4096 239367 000000007ca4b940
11: 0 4096 239368 000000007ca4b940
12: 0 4096 239369 000000007ca4b940
13: 0 4096 239370 000000007ca4b940
14: 0 4096 239371 000000007ca4b940
15: 0 4096 239372 000000007ca4b940
16: 0 4096 239373 000000007ca4b940
17: 0 4096 239374 000000007ca4b940
18: 0 4096 239375 000000007ca4b940
19: 0 4096 239376 000000007ca4b940
timer_interrupt(CPU 0): delayed! cycles D6447081 rem 4F337F next/now 33C8F3ED16
sched: RT throttling activated
blk_rq_map_sg: merge bug: 2 1, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e6e6458(f:24490000, t:1)
0: 0 4096 239377 000000007febd700
1: 0 4096 239378 000000007febd700
2: 0 4096 239379 000000007febd700
3: 0 4096 239380 000000007febd700
4: 0 4096 239381 000000007febd700
5: 0 4096 239382 000000007febd700
6: 0 4096 239383 000000007febd700
7: 0 4096 239384 000000007febd700
8: 0 4096 239385 000000007febd700
9: 0 4096 239386 000000007febd700
10: 0 4096 239387 000000007febd700
11: 0 4096 239388 000000007febd700
12: 0 4096 239389 000000007febd700
13: 0 4096 239390 000000007febd700
14: 0 4096 239391 000000007febd700
15: 0 4096 239392 000000007febd700
16: 0 4096 239393 000000007febd700
17: 0 4096 239394 000000007febd700
18: 0 4096 239395 000000007febd700
19: 0 4096 239396 000000007febd700
20: 0 4096 239397 000000007febd700
21: 0 4096 239398 000000007febd700
22: 0 4096 239399 000000007febd700
23: 0 4096 239400 000000007febd700
24: 0 4096 239401 000000007febd700
25: 0 4096 239402 000000007febd700
26: 0 4096 239403 000000007febd700
27: 0 4096 239404 000000007febd700
timer_interrupt(CPU 2): delayed! cycles 4E731B03 rem 3A7EFD next/now 341DE7FCE7
blk_rq_map_sg: merge bug: 5 4, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007ee66a38(f:24490000, t:1)
0: 0 4096 239452 000000007ee657c0
1: 0 4096 239451 000000007ee657c0
2: 0 4096 239450 000000007ee657c0
3: 0 4096 239484 000000007ee657c0
4: 0 4096 239485 000000007ee657c0
5: 0 4096 239486 000000007ee657c0
6: 0 4096 239487 000000007ee657c0
7: 0 4096 239488 000000007ee657c0
8: 0 4096 239489 000000007ee657c0
9: 0 4096 239490 000000007ee657c0
10: 0 4096 239491 000000007ee657c0
11: 0 4096 239492 000000007ee657c0
12: 0 4096 239493 000000007ee657c0
13: 0 4096 239494 000000007ee657c0
14: 0 4096 239495 000000007ee657c0
15: 0 4096 239496 000000007ee657c0
16: 0 4096 239497 000000007ee657c0
17: 0 4096 239498 000000007ee657c0
18: 0 4096 239499 000000007ee657c0
19: 0 4096 239500 000000007ee657c0
20: 0 4096 239501 000000007ee657c0
21: 0 4096 239502 000000007ee657c0
22: 0 4096 239503 000000007ee657c0
23: 0 4096 239504 000000007ee657c0
24: 0 4096 239505 000000007ee657c0
25: 0 4096 239506 000000007ee657c0
26: 0 4096 239507 000000007ee657c0
27: 0 4096 239508 000000007ee657c0
28: 0 4096 239509 000000007ee657c0
29: 0 4096 239510 000000007ee657c0
30: 0 4096 239511 000000007ee657c0
31: 0 4096 239512 000000007ee657c0
timer_interrupt(CPU 3): delayed! cycles 56A8A3BE rem 5D3142 next/now 347F81C07E
timer_interrupt(CPU 0): delayed! cycles 56D29C25 rem 3338DB next/now 347F57D21A
timer_interrupt(CPU 1): delayed! cycles 564067E7 rem 2CD699 next/now 347F51971C
. ok
blk_rq_map_sg: merge bug: 2 1, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e2904d8(f:24490000, t:1)
0: 0 4096 237862 000000007ca4be80
1: 0 4096 237863 000000007ca4be80
2: 0 4096 237864 000000007ca4be80
3: 0 4096 237865 000000007ca4be80
4: 0 4096 237866 000000007ca4be80
5: 0 4096 237867 000000007ca4be80
6: 0 4096 237868 000000007ca4be80
7: 0 4096 237869 000000007ca4be80
8: 0 4096 237870 000000007ca4be80
9: 0 4096 237871 000000007ca4be80
10: 0 4096 237872 000000007ca4be80
11: 0 4096 237873 000000007ca4be80
12: 0 4096 237874 000000007ca4be80
13: 0 4096 237875 000000007ca4be80
14: 0 4096 237876 000000007ca4be80
15: 0 4096 237877 000000007ca4be80
16: 0 4096 237878 000000007ca4be80
17: 0 4096 237879 000000007ca4be80
18: 0 4096 237880 000000007ca4be80
19: 0 4096 237881 000000007ca4be80
20: 0 4096 237882 000000007ca4be80
21: 0 4096 237883 000000007ca4be80
22: 0 4096 237884 000000007ca4be80
23: 0 4096 237885 000000007ca4be80
24: 0 4096 237886 000000007ca4be80
25: 0 4096 237887 000000007ca4be80
26: 0 4096 237888 000000007ca4be80
27: 0 4096 237889 000000007ca4be80
28: 0 4096 237890 000000007ca4be80
29: 0 4096 237891 000000007ca4be80
30: 0 4096 237892 000000007ca4be80
31: 0 4096 237893 000000007ca4be80
timer_interrupt(CPU 2): delayed! cycles 567B750F rem 8A5FF1 next/now 350CEBBB63
blk_rq_map_sg: merge bug: 2 1, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007dcb1050(f:24490000, t:1)
0: 0 4096 237986 000000007e2c41c0
1: 0 4096 237987 000000007e2c41c0
2: 0 4096 237988 000000007e2c41c0
3: 0 4096 237989 000000007e2c41c0
4: 0 4096 237990 000000007e2c41c0
5: 0 4096 237991 000000007e2c41c0
6: 0 4096 237992 000000007e2c41c0
7: 0 4096 237993 000000007e2c41c0
8: 0 4096 237994 000000007e2c41c0
9: 0 4096 237995 000000007e2c41c0
10: 0 4096 237996 000000007e2c41c0
11: 0 4096 237997 000000007e2c41c0
12: 0 4096 237998 000000007e2c41c0
13: 0 4096 237999 000000007e2c41c0
14: 0 4096 238000 000000007e2c41c0
15: 0 4096 238001 000000007e2c41c0
16: 0 4096 238002 000000007e2c41c0
17: 0 4096 238003 000000007e2c41c0
18: 0 4096 238004 000000007e2c41c0
19: 0 4096 238005 000000007e2c41c0
20: 0 4096 238006 000000007e2c41c0
21: 0 4096 238007 000000007e2c41c0
22: 0 4096 238008 000000007e2c41c0
timer_interrupt(CPU 2): delayed! cycles 4032D163 rem 2CAC9D next/now 355E9445E7
blk_rq_map_sg: merge bug: 4 3, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007c6a3168(f:24490000, t:1)
0: 0 4096 238045 000000007febdd00
1: 0 4096 238046 000000007febdd00
2: 0 4096 238047 000000007febdd00
3: 0 4096 238048 000000007febdd00
4: 0 4096 238049 000000007febdd00
5: 0 4096 238050 000000007febdd00
6: 0 4096 238051 000000007febdd00
7: 0 4096 238052 000000007febdd00
8: 0 4096 238053 000000007febdd00
9: 0 4096 238054 000000007febdd00
10: 0 4096 238055 000000007febdd00
11: 0 4096 238056 000000007febdd00
12: 0 4096 238057 000000007febdd00
13: 0 4096 238058 000000007febdd00
14: 0 4096 238059 000000007febdd00
15: 0 4096 238060 000000007febdd00
16: 0 4096 238061 000000007febdd00
17: 0 4096 238062 000000007febdd00
18: 0 4096 238063 000000007febdd00
19: 0 4096 238065 000000007febdd00
20: 0 4096 238074 000000007febdd00
21: 0 4096 238075 000000007febdd00
22: 0 4096 238076 000000007febdd00
23: 0 4096 238077 000000007febdd00
24: 0 4096 238078 000000007febdd00
timer_interrupt(CPU 1): delayed! cycles 45200E5B rem 423A5 next/now 35B5DBE1950
[....] Starting MTA:blk_rq_map_sg: merge bug: 3 2, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e53c5f0(f:24490000, t:1)
0: 0 4096 238015 000000007e231dc0
1: 0 4096 238136 000000007e231dc0
2: 0 4096 238137 000000007e231dc0
3: 0 4096 238138 000000007e231dc0
4: 0 4096 238139 000000007e231dc0
5: 0 4096 238140 000000007e231dc0
6: 0 4096 238141 000000007e231dc0
7: 0 4096 238142 000000007e231dc0
8: 0 4096 238143 000000007e231dc0
9: 0 4096 238144 000000007e231dc0
10: 0 4096 238145 000000007e231dc0
11: 0 4096 238146 000000007e231dc0
12: 0 4096 238147 000000007e231dc0
13: 0 4096 238148 000000007e231dc0
14: 0 4096 238149 000000007e231dc0
15: 0 4096 238150 000000007e231dc0
16: 0 4096 238151 000000007e231dc0
17: 0 4096 238152 000000007e231dc0
18: 0 4096 238153 000000007e231dc0
19: 0 4096 238154 000000007e231dc0
20: 0 4096 238155 000000007e231dc0
21: 0 4096 238156 000000007e231dc0
22: 0 4096 238157 000000007e231dc0
23: 0 4096 238158 000000007e231dc0
24: 0 4096 238159 000000007e231dc0
25: 0 4096 238160 000000007e231dc0
26: 0 4096 238161 000000007e231dc0
27: 0 4096 238162 000000007e231dc0
28: 0 4096 238163 000000007e231dc0
29: 0 4096 238164 000000007e231dc0
30: 0 4096 238165 000000007e231dc0
31: 0 4096 238166 000000007e231dc0
timer_interrupt(CPU 1): delayed! cycles 56A22B4B rem 63A9B5 next/now 361B2FD290
blk_rq_map_sg: merge bug: 16 15, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e53c5f0(f:24490000, t:1)
0: 0 4096 238228 000000007e231dc0
1: 0 4096 238227 000000007e231dc0
2: 0 4096 238226 000000007e231dc0
3: 0 4096 238225 000000007e231dc0
4: 0 4096 238224 000000007e231dc0
5: 0 4096 238223 000000007e231dc0
6: 0 4096 238222 000000007e231dc0
7: 0 4096 238221 000000007e231dc0
8: 0 4096 238220 000000007e231dc0
9: 0 4096 238219 000000007e231dc0
10: 0 4096 238218 000000007e231dc0
11: 0 4096 238217 000000007e231dc0
12: 0 4096 238216 000000007e231dc0
13: 0 4096 238215 000000007e231dc0
14: 0 4096 238229 000000007e231dc0
15: 0 4096 238230 000000007e231dc0
16: 0 4096 238231 000000007e231dc0
17: 0 4096 238232 000000007e231dc0
18: 0 4096 238233 000000007e231dc0
19: 0 4096 238234 000000007e231dc0
20: 0 4096 238235 000000007e231dc0
21: 0 4096 238236 000000007e231dc0
22: 0 4096 238237 000000007e231dc0
23: 0 4096 238238 000000007e231dc0
24: 0 4096 238239 000000007e231dc0
25: 0 4096 238240 000000007e231dc0
26: 0 4096 238241 000000007e231dc0
27: 0 4096 238242 000000007e231dc0
28: 0 4096 238243 000000007e231dc0
29: 0 4096 238244 000000007e231dc0
30: 0 4096 238245 000000007e231dc0
31: 0 4096 238246 000000007e231dc0
timer_interrupt(CPU 1): delayed! cycles 56AEC72B rem 570DD5 next/now 36795CB590
blk_rq_map_sg: merge bug: 2 1, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e53cca8(f:24490000, t:1)
0: 0 4096 236910 000000007e231940
1: 0 4096 236911 000000007e231940
2: 0 4096 236912 000000007e231940
3: 0 4096 236913 000000007e231940
4: 0 4096 236914 000000007e231940
5: 0 4096 236915 000000007e231940
6: 0 4096 236916 000000007e231940
7: 0 4096 236917 000000007e231940
8: 0 4096 236918 000000007e231940
9: 0 4096 236919 000000007e231940
10: 0 4096 236920 000000007e231940
11: 0 4096 236921 000000007e231940
12: 0 4096 236922 000000007e231940
13: 0 4096 236923 000000007e231940
14: 0 4096 236924 000000007e231940
15: 0 4096 236925 000000007e231940
16: 0 4096 236926 000000007e231940
17: 0 4096 236927 000000007e231940
18: 0 4096 236928 000000007e231940
19: 0 4096 236929 000000007e231940
20: 0 4096 236930 000000007e231940
21: 0 4096 236931 000000007e231940
22: 0 4096 236932 000000007e231940
23: 0 4096 236933 000000007e231940
24: 0 4096 236934 000000007e231940
25: 0 4096 236935 000000007e231940
26: 0 4096 236936 000000007e231940
27: 0 4096 236937 000000007e231940
28: 0 4096 236938 000000007e231940
29: 0 4096 236939 000000007e231940
30: 0 4096 236940 000000007e231940
31: 0 4096 236941 000000007e231940
timer_interrupt(CPU 0): delayed! cycles 56704D66 rem 95879A next/now 37C98E829B
blk_rq_map_sg: merge bug: 2 1, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e6e6050(f:24490000, t:1)
0: 0 4096 237005 000000007c094640
1: 0 4096 237006 000000007c094640
2: 0 4096 237007 000000007c094640
3: 0 4096 237008 000000007c094640
4: 0 4096 237009 000000007c094640
5: 0 4096 237010 000000007c094640
6: 0 4096 237011 000000007c094640
7: 0 4096 237012 000000007c094640
8: 0 4096 237013 000000007c094640
9: 0 4096 237014 000000007c094640
10: 0 4096 237015 000000007c094640
11: 0 4096 237016 000000007c094640
12: 0 4096 237017 000000007c094640
13: 0 4096 237018 000000007c094640
14: 0 4096 237019 000000007c094640
15: 0 4096 237020 000000007c094640
16: 0 4096 237021 000000007c094640
17: 0 4096 237022 000000007c094640
blk_rq_map_sg: merge bug: 2 1, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e2908e0(f:24490000, t:1)
0: 0 4096 237122 000000007c094280
1: 0 4096 237123 000000007c094280
2: 0 4096 237124 000000007c094280
3: 0 4096 237125 000000007c094280
4: 0 4096 237126 000000007c094280
5: 0 4096 237127 000000007c094280
6: 0 4096 237128 000000007c094280
7: 0 4096 237129 000000007c094280
8: 0 4096 237130 000000007c094280
9: 0 4096 237131 000000007c094280
10: 0 4096 237132 000000007c094280
11: 0 4096 237133 000000007c094280
12: 0 4096 237134 000000007c094280
13: 0 4096 237135 000000007c094280
14: 0 4096 237136 000000007c094280
15: 0 4096 237137 000000007c094280
16: 0 4096 237138 000000007c094280
17: 0 4096 237139 000000007c094280
18: 0 4096 237140 000000007c094280
19: 0 4096 237141 000000007c094280
blk_rq_map_sg: merge bug: 2 1, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e6e61a8(f:24490000, t:1)
0: 0 4096 237166 000000007febd640
1: 0 4096 237167 000000007febd640
2: 0 4096 237168 000000007febd640
3: 0 4096 237169 000000007febd640
4: 0 4096 237170 000000007febd640
5: 0 4096 237171 000000007febd640
6: 0 4096 237172 000000007febd640
7: 0 4096 237173 000000007febd640
8: 0 4096 237174 000000007febd640
9: 0 4096 237175 000000007febd640
10: 0 4096 237176 000000007febd640
11: 0 4096 237177 000000007febd640
12: 0 4096 237178 000000007febd640
13: 0 4096 237179 000000007febd640
14: 0 4096 237180 000000007febd640
15: 0 4096 237181 000000007febd640
16: 0 4096 237182 000000007febd640
17: 0 4096 237183 000000007febd640
18: 0 4096 237184 000000007febd640
19: 0 4096 237185 000000007febd640
blk_rq_map_sg: merge bug: 2 1, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e290b90(f:24490000, t:1)
0: 0 4096 237223 000000007c094580
1: 0 4096 237224 000000007c094580
2: 0 4096 237225 000000007c094580
3: 0 4096 237226 000000007c094580
4: 0 4096 237227 000000007c094580
5: 0 4096 237228 000000007c094580
6: 0 4096 237229 000000007c094580
7: 0 4096 237230 000000007c094580
8: 0 4096 237231 000000007c094580
9: 0 4096 237232 000000007c094580
10: 0 4096 237233 000000007c094580
11: 0 4096 237234 000000007c094580
12: 0 4096 237235 000000007c094580
13: 0 4096 237236 000000007c094580
14: 0 4096 237237 000000007c094580
15: 0 4096 237238 000000007c094580
16: 0 4096 237239 000000007c094580
17: 0 4096 237240 000000007c094580
18: 0 4096 237241 000000007c094580
19: 0 4096 237242 000000007c094580
20: 0 4096 237243 000000007c094580
21: 0 4096 237244 000000007c094580
22: 0 4096 237245 000000007c094580
timer_interrupt(CPU 0): delayed! cycles 4028F032 rem 368DCE next/now 38BD56F517
blk_rq_map_sg: merge bug: 3 2, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e290b90(f:24490000, t:1)
0: 0 4096 237246 000000007c094580
1: 0 4096 237247 000000007c094580
2: 0 4096 237248 000000007c094580
3: 0 4096 237249 000000007c094580
4: 0 4096 237250 000000007c094580
5: 0 4096 237251 000000007c094580
6: 0 4096 237252 000000007c094580
7: 0 4096 237253 000000007c094580
8: 0 4096 237254 000000007c094580
9: 0 4096 237255 000000007c094580
10: 0 4096 237256 000000007c094580
11: 0 4096 237257 000000007c094580
12: 0 4096 237258 000000007c094580
13: 0 4096 237259 000000007c094580
14: 0 4096 237260 000000007c094580
15: 0 4096 237261 000000007c094580
16: 0 4096 237262 000000007c094580
17: 0 4096 237263 000000007c094580
18: 0 4096 237264 000000007c094580
19: 0 4096 237265 000000007c094580
20: 0 4096 237266 000000007c094580
21: 0 4096 237267 000000007c094580
22: 0 4096 237268 000000007c094580
23: 0 4096 237269 000000007c094580
24: 0 4096 237270 000000007c094580
25: 0 4096 237271 000000007c094580
26: 0 4096 237272 000000007c094580
27: 0 4096 237273 000000007c094580
28: 0 4096 237274 000000007c094580
29: 0 4096 237276 000000007c094580
30: 0 4096 237277 000000007c094580
31: 0 4096 237278 000000007c094580
timer_interrupt(CPU 0): delayed! cycles 569C5AE0 rem 697A20 next/now 391D4D9B95
blk_rq_map_sg: merge bug: 2 1, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e6e61a8(f:24490000, t:1)
0: 0 4096 237311 000000007febd640
1: 0 4096 237312 000000007febd640
2: 0 4096 237313 000000007febd640
3: 0 4096 237314 000000007febd640
4: 0 4096 237315 000000007febd640
5: 0 4096 237316 000000007febd640
6: 0 4096 237317 000000007febd640
7: 0 4096 237318 000000007febd640
8: 0 4096 237319 000000007febd640
9: 0 4096 237320 000000007febd640
10: 0 4096 237321 000000007febd640
11: 0 4096 237322 000000007febd640
12: 0 4096 237323 000000007febd640
13: 0 4096 237324 000000007febd640
14: 0 4096 237325 000000007febd640
15: 0 4096 237326 000000007febd640
16: 0 4096 237327 000000007febd640
17: 0 4096 237328 000000007febd640
18: 0 4096 237329 000000007febd640
19: 0 4096 237330 000000007febd640
20: 0 4096 237331 000000007febd640
21: 0 4096 237332 000000007febd640
22: 0 4096 237333 000000007febd640
23: 0 4096 237334 000000007febd640
24: 0 4096 237335 000000007febd640
25: 0 4096 237336 000000007febd640
26: 0 4096 237337 000000007febd640
27: 0 4096 237338 000000007febd640
28: 0 4096 237339 000000007febd640
29: 0 4096 237340 000000007febd640
30: 0 4096 237341 000000007febd640
31: 0 4096 237342 000000007febd640
timer_interrupt(CPU 0): delayed! cycles 56C3D525 rem 41FFDB next/now 397C13151A
exim4. ok
[....] Starting periodic command scheduler: cron. ok
[....] Starting system message bus: dbus. ok
[....] Starting NTP server: ntpd. ok
[....] Starting OpenBSD Secure Shell server: sshd. ok
Debian GNU/Linux stretch/sid atlas ttyS0
atlas login:
^ permalink raw reply related [flat|nested] 14+ messages in thread
* Re: [BUG] "block: make generic_make_request handle arbitrarily sized bios" breaks boot on parisc-linux
2016-02-24 23:28 ` John David Anglin
@ 2016-02-25 3:38 ` Ming Lei
2016-02-25 10:10 ` Aw: " Helge Deller
2016-03-09 12:55 ` James Bottomley
0 siblings, 2 replies; 14+ messages in thread
From: Ming Lei @ 2016-02-25 3:38 UTC (permalink / raw)
To: John David Anglin
Cc: Helge Deller, linux-block, Linux SCSI List, James Bottomley,
linux-parisc List, Kent Overstreet
On Thu, Feb 25, 2016 at 7:28 AM, John David Anglin <dave.anglin@bell.net> wrote:
> On 2016-02-24, at 4:36 PM, Helge Deller wrote:
>
>> Maybe Dave has more luck, otherwise I'll continue to try to get some info.
>
> I tried your patch on the commit in linux-block which first failed to boot. As with Helge, the
> system crashed and no useful data was output on console. I then applied following patch
> to give some extra segments and tired again:
>
> diff --git a/drivers/scsi/scsi_lib.c b/drivers/scsi/scsi_lib.c
> index b1a2631..b421f03 100644
> --- a/drivers/scsi/scsi_lib.c
> +++ b/drivers/scsi/scsi_lib.c
> @@ -595,6 +595,11 @@ static int scsi_alloc_sgtable(struct scsi_data_buffer *sdb, int nents, bool mq)
>
> BUG_ON(!nents);
>
> + /* Provide extra entries in case of split. */
> + nents += 8;
> + if (nents > SCSI_MAX_SG_SEGMENTS)
> + nents = SCSI_MAX_SG_SEGMENTS;
> +
Yeah, this is needed for sake of safety.
> if (mq) {
> if (nents <= SCSI_MAX_SG_SEGMENTS) {
> sdb->table.nents = nents;
>
> The attached file shows the crash in first boot. The second boot was successful and various output
> was generated by your check code.
>From the following log(just select one simple, and looks all are similar) in
2nd boot, the bi_phys_segments is figured out as one by block core
, which is wrong because the max segment size is 64k according to
your investigation in the below link, but the whole req/bio is 192k(4k*48).
http://www.spinics.net/lists/linux-parisc/msg06749.html
Looks weird, it shouldn't have happened because blk_bio_segment_split()
does respect the max segment size limit.
BTW, what is the scsi driver for the device?
blk_rq_map_sg: merge bug: 3 1, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e53c5f0(f:24490000, t:1)
0: 0 4096 245852 000000007e2c4c40
1: 0 4096 245853 000000007e2c4c40
2: 0 4096 245854 000000007e2c4c40
3: 0 4096 245855 000000007e2c4c40
4: 0 4096 245856 000000007e2c4c40
5: 0 4096 245857 000000007e2c4c40
6: 0 4096 245858 000000007e2c4c40
7: 0 4096 245859 000000007e2c4c40
8: 0 4096 245860 000000007e2c4c40
9: 0 4096 245861 000000007e2c4c40
10: 0 4096 245862 000000007e2c4c40
11: 0 4096 245863 000000007e2c4c40
12: 0 4096 245864 000000007e2c4c40
13: 0 4096 245865 000000007e2c4c40
14: 0 4096 245866 000000007e2c4c40
15: 0 4096 245867 000000007e2c4c40
16: 0 4096 245868 000000007e2c4c40
17: 0 4096 245869 000000007e2c4c40
18: 0 4096 245870 000000007e2c4c40
19: 0 4096 245871 000000007e2c4c40
20: 0 4096 245872 000000007e2c4c40
21: 0 4096 245873 000000007e2c4c40
22: 0 4096 245874 000000007e2c4c40
23: 0 4096 245875 000000007e2c4c40
24: 0 4096 245876 000000007e2c4c40
25: 0 4096 245877 000000007e2c4c40
26: 0 4096 245878 000000007e2c4c40
27: 0 4096 245879 000000007e2c4c40
28: 0 4096 245880 000000007e2c4c40
29: 0 4096 245881 000000007e2c4c40
30: 0 4096 245882 000000007e2c4c40
31: 0 4096 245883 000000007e2c4c40
32: 0 4096 245884 000000007e2c4c40
33: 0 4096 245885 000000007e2c4c40
34: 0 4096 245886 000000007e2c4c40
35: 0 4096 245887 000000007e2c4c40
36: 0 4096 245888 000000007e2c4c40
37: 0 4096 245889 000000007e2c4c40
38: 0 4096 245890 000000007e2c4c40
39: 0 4096 245891 000000007e2c4c40
40: 0 4096 245892 000000007e2c4c40
41: 0 4096 245893 000000007e2c4c40
42: 0 4096 245894 000000007e2c4c40
43: 0 4096 245895 000000007e2c4c40
44: 0 4096 245896 000000007e2c4c40
45: 0 4096 245897 000000007e2c4c40
46: 0 4096 245898 000000007e2c4c40
47: 0 4096 245899 000000007e2c4c40
Thanks,
Ming Lei
^ permalink raw reply [flat|nested] 14+ messages in thread
* Aw: Re: [BUG] "block: make generic_make_request handle arbitrarily sized bios" breaks boot on parisc-linux
2016-02-25 3:38 ` Ming Lei
@ 2016-02-25 10:10 ` Helge Deller
2016-03-09 12:55 ` James Bottomley
1 sibling, 0 replies; 14+ messages in thread
From: Helge Deller @ 2016-02-25 10:10 UTC (permalink / raw)
To: Ming Lei
Cc: John David Anglin, linux-block, Linux SCSI List, James Bottomley,
linux-parisc List, Kent Overstreet
> On Thu, Feb 25, 2016 at 7:28 AM, John David Anglin <dave.anglin@bell.net> wrote:
> > On 2016-02-24, at 4:36 PM, Helge Deller wrote:
> >
> >> Maybe Dave has more luck, otherwise I'll continue to try to get some info.
> >
> > I tried your patch on the commit in linux-block which first failed to boot. As with Helge, the
> > system crashed and no useful data was output on console. I then applied following patch
> > to give some extra segments and tired again:
> >
> > diff --git a/drivers/scsi/scsi_lib.c b/drivers/scsi/scsi_lib.c
> > index b1a2631..b421f03 100644
> > --- a/drivers/scsi/scsi_lib.c
> > +++ b/drivers/scsi/scsi_lib.c
> > @@ -595,6 +595,11 @@ static int scsi_alloc_sgtable(struct scsi_data_buffer *sdb, int nents, bool mq)
> >
> > BUG_ON(!nents);
> >
> > + /* Provide extra entries in case of split. */
> > + nents += 8;
> > + if (nents > SCSI_MAX_SG_SEGMENTS)
> > + nents = SCSI_MAX_SG_SEGMENTS;
> > +
>
> Yeah, this is needed for sake of safety.
>
> > if (mq) {
> > if (nents <= SCSI_MAX_SG_SEGMENTS) {
> > sdb->table.nents = nents;
> >
> > The attached file shows the crash in first boot. The second boot was successful and various output
> > was generated by your check code.
>
> From the following log(just select one simple, and looks all are similar) in
> 2nd boot, the bi_phys_segments is figured out as one by block core
> , which is wrong because the max segment size is 64k according to
> your investigation in the below link, but the whole req/bio is 192k(4k*48).
>
> http://www.spinics.net/lists/linux-parisc/msg06749.html
>
> Looks weird, it shouldn't have happened because blk_bio_segment_split()
> does respect the max segment size limit.
>
> BTW, what is the scsi driver for the device?
It happens with various drivers.
sym53c8xx (on my machine) and mptspi (Fusion MPT, on Daves machine).
Then we have PATA/SATA controllers too: sil680, sata_sil24, pata_ns87415.
The problem can be reproduced by using sym53c8xx or mptsi and blacklisting all others.
Helge
^ permalink raw reply [flat|nested] 14+ messages in thread
* Re: [BUG] "block: make generic_make_request handle arbitrarily sized bios" breaks boot on parisc-linux
2016-02-25 3:38 ` Ming Lei
2016-02-25 10:10 ` Aw: " Helge Deller
@ 2016-03-09 12:55 ` James Bottomley
2016-03-09 14:43 ` Ming Lei
1 sibling, 1 reply; 14+ messages in thread
From: James Bottomley @ 2016-03-09 12:55 UTC (permalink / raw)
To: Ming Lei, John David Anglin
Cc: Helge Deller, linux-block, Linux SCSI List, linux-parisc List,
Kent Overstreet
On Thu, 2016-02-25 at 11:38 +0800, Ming Lei wrote:
> On Thu, Feb 25, 2016 at 7:28 AM, John David Anglin <
> dave.anglin@bell.net> wrote:
> > On 2016-02-24, at 4:36 PM, Helge Deller wrote:
> >
> > > Maybe Dave has more luck, otherwise I'll continue to try to get
> > > some info.
> >
> > I tried your patch on the commit in linux-block which first failed
> > to boot. As with Helge, the
> > system crashed and no useful data was output on console. I then
> > applied following patch
> > to give some extra segments and tired again:
> >
> > diff --git a/drivers/scsi/scsi_lib.c b/drivers/scsi/scsi_lib.c
> > index b1a2631..b421f03 100644
> > --- a/drivers/scsi/scsi_lib.c
> > +++ b/drivers/scsi/scsi_lib.c
> > @@ -595,6 +595,11 @@ static int scsi_alloc_sgtable(struct
> > scsi_data_buffer *sdb, int nents, bool mq)
> >
> > BUG_ON(!nents);
> >
> > + /* Provide extra entries in case of split. */
> > + nents += 8;
> > + if (nents > SCSI_MAX_SG_SEGMENTS)
> > + nents = SCSI_MAX_SG_SEGMENTS;
> > +
>
> Yeah, this is needed for sake of safety.
>
> > if (mq) {
> > if (nents <= SCSI_MAX_SG_SEGMENTS) {
> > sdb->table.nents = nents;
> >
> > The attached file shows the crash in first boot. The second boot
> > was successful and various output
> > was generated by your check code.
>
> From the following log(just select one simple, and looks all are
> similar) in
> 2nd boot, the bi_phys_segments is figured out as one by block core
> , which is wrong because the max segment size is 64k according to
> your investigation in the below link, but the whole req/bio is
> 192k(4k*48).
>
> http://www.spinics.net/lists/linux-parisc/msg06749.html
>
> Looks weird, it shouldn't have happened because
> blk_bio_segment_split()
> does respect the max segment size limit.
>
> BTW, what is the scsi driver for the device?
>
> blk_rq_map_sg: merge bug: 3 1, extra_len 0, dma_drain 0
> check_bvec: dump bvec for 000000007e53c5f0(f:24490000, t:1)
> 0: 0 4096 245852 000000007e2c4c40
> 1: 0 4096 245853 000000007e2c4c40
> 2: 0 4096 245854 000000007e2c4c40
> 3: 0 4096 245855 000000007e2c4c40
> 4: 0 4096 245856 000000007e2c4c40
> 5: 0 4096 245857 000000007e2c4c40
> 6: 0 4096 245858 000000007e2c4c40
> 7: 0 4096 245859 000000007e2c4c40
> 8: 0 4096 245860 000000007e2c4c40
> 9: 0 4096 245861 000000007e2c4c40
> 10: 0 4096 245862 000000007e2c4c40
> 11: 0 4096 245863 000000007e2c4c40
> 12: 0 4096 245864 000000007e2c4c40
> 13: 0 4096 245865 000000007e2c4c40
> 14: 0 4096 245866 000000007e2c4c40
> 15: 0 4096 245867 000000007e2c4c40
> 16: 0 4096 245868 000000007e2c4c40
> 17: 0 4096 245869 000000007e2c4c40
> 18: 0 4096 245870 000000007e2c4c40
> 19: 0 4096 245871 000000007e2c4c40
> 20: 0 4096 245872 000000007e2c4c40
> 21: 0 4096 245873 000000007e2c4c40
> 22: 0 4096 245874 000000007e2c4c40
> 23: 0 4096 245875 000000007e2c4c40
> 24: 0 4096 245876 000000007e2c4c40
> 25: 0 4096 245877 000000007e2c4c40
> 26: 0 4096 245878 000000007e2c4c40
> 27: 0 4096 245879 000000007e2c4c40
> 28: 0 4096 245880 000000007e2c4c40
> 29: 0 4096 245881 000000007e2c4c40
> 30: 0 4096 245882 000000007e2c4c40
> 31: 0 4096 245883 000000007e2c4c40
> 32: 0 4096 245884 000000007e2c4c40
> 33: 0 4096 245885 000000007e2c4c40
> 34: 0 4096 245886 000000007e2c4c40
> 35: 0 4096 245887 000000007e2c4c40
> 36: 0 4096 245888 000000007e2c4c40
> 37: 0 4096 245889 000000007e2c4c40
> 38: 0 4096 245890 000000007e2c4c40
> 39: 0 4096 245891 000000007e2c4c40
> 40: 0 4096 245892 000000007e2c4c40
> 41: 0 4096 245893 000000007e2c4c40
> 42: 0 4096 245894 000000007e2c4c40
> 43: 0 4096 245895 000000007e2c4c40
> 44: 0 4096 245896 000000007e2c4c40
> 45: 0 4096 245897 000000007e2c4c40
> 46: 0 4096 245898 000000007e2c4c40
> 47: 0 4096 245899 000000007e2c4c40
We've provided all the information you asked for, what's the next step
on this, or do we have to unwind the bio splitting code with reverts
until it starts working?
Thanks,
James
^ permalink raw reply [flat|nested] 14+ messages in thread
* Re: [BUG] "block: make generic_make_request handle arbitrarily sized bios" breaks boot on parisc-linux
2016-03-09 12:55 ` James Bottomley
@ 2016-03-09 14:43 ` Ming Lei
2016-03-09 15:15 ` John David Anglin
0 siblings, 1 reply; 14+ messages in thread
From: Ming Lei @ 2016-03-09 14:43 UTC (permalink / raw)
To: James Bottomley
Cc: John David Anglin, Helge Deller, linux-block, Linux SCSI List,
linux-parisc List, Kent Overstreet
On Wed, Mar 9, 2016 at 8:55 PM, James Bottomley
<James.Bottomley@hansenpartnership.com> wrote:
> On Thu, 2016-02-25 at 11:38 +0800, Ming Lei wrote:
>> On Thu, Feb 25, 2016 at 7:28 AM, John David Anglin <
>> dave.anglin@bell.net> wrote:
>> > On 2016-02-24, at 4:36 PM, Helge Deller wrote:
>> >
>> > > Maybe Dave has more luck, otherwise I'll continue to try to get
>> > > some info.
>> >
>> > I tried your patch on the commit in linux-block which first failed
>> > to boot. As with Helge, the
>> > system crashed and no useful data was output on console. I then
>> > applied following patch
>> > to give some extra segments and tired again:
>> >
>> > diff --git a/drivers/scsi/scsi_lib.c b/drivers/scsi/scsi_lib.c
>> > index b1a2631..b421f03 100644
>> > --- a/drivers/scsi/scsi_lib.c
>> > +++ b/drivers/scsi/scsi_lib.c
>> > @@ -595,6 +595,11 @@ static int scsi_alloc_sgtable(struct
>> > scsi_data_buffer *sdb, int nents, bool mq)
>> >
>> > BUG_ON(!nents);
>> >
>> > + /* Provide extra entries in case of split. */
>> > + nents += 8;
>> > + if (nents > SCSI_MAX_SG_SEGMENTS)
>> > + nents = SCSI_MAX_SG_SEGMENTS;
>> > +
>>
>> Yeah, this is needed for sake of safety.
>>
>> > if (mq) {
>> > if (nents <= SCSI_MAX_SG_SEGMENTS) {
>> > sdb->table.nents = nents;
>> >
>> > The attached file shows the crash in first boot. The second boot
>> > was successful and various output
>> > was generated by your check code.
>>
>> From the following log(just select one simple, and looks all are
>> similar) in
>> 2nd boot, the bi_phys_segments is figured out as one by block core
>> , which is wrong because the max segment size is 64k according to
>> your investigation in the below link, but the whole req/bio is
>> 192k(4k*48).
>>
>> http://www.spinics.net/lists/linux-parisc/msg06749.html
>>
>> Looks weird, it shouldn't have happened because
>> blk_bio_segment_split()
>> does respect the max segment size limit.
>>
>> BTW, what is the scsi driver for the device?
>>
>> blk_rq_map_sg: merge bug: 3 1, extra_len 0, dma_drain 0
>> check_bvec: dump bvec for 000000007e53c5f0(f:24490000, t:1)
>> 0: 0 4096 245852 000000007e2c4c40
>> 1: 0 4096 245853 000000007e2c4c40
>> 2: 0 4096 245854 000000007e2c4c40
>> 3: 0 4096 245855 000000007e2c4c40
>> 4: 0 4096 245856 000000007e2c4c40
>> 5: 0 4096 245857 000000007e2c4c40
>> 6: 0 4096 245858 000000007e2c4c40
>> 7: 0 4096 245859 000000007e2c4c40
>> 8: 0 4096 245860 000000007e2c4c40
>> 9: 0 4096 245861 000000007e2c4c40
>> 10: 0 4096 245862 000000007e2c4c40
>> 11: 0 4096 245863 000000007e2c4c40
>> 12: 0 4096 245864 000000007e2c4c40
>> 13: 0 4096 245865 000000007e2c4c40
>> 14: 0 4096 245866 000000007e2c4c40
>> 15: 0 4096 245867 000000007e2c4c40
>> 16: 0 4096 245868 000000007e2c4c40
>> 17: 0 4096 245869 000000007e2c4c40
>> 18: 0 4096 245870 000000007e2c4c40
>> 19: 0 4096 245871 000000007e2c4c40
>> 20: 0 4096 245872 000000007e2c4c40
>> 21: 0 4096 245873 000000007e2c4c40
>> 22: 0 4096 245874 000000007e2c4c40
>> 23: 0 4096 245875 000000007e2c4c40
>> 24: 0 4096 245876 000000007e2c4c40
>> 25: 0 4096 245877 000000007e2c4c40
>> 26: 0 4096 245878 000000007e2c4c40
>> 27: 0 4096 245879 000000007e2c4c40
>> 28: 0 4096 245880 000000007e2c4c40
>> 29: 0 4096 245881 000000007e2c4c40
>> 30: 0 4096 245882 000000007e2c4c40
>> 31: 0 4096 245883 000000007e2c4c40
>> 32: 0 4096 245884 000000007e2c4c40
>> 33: 0 4096 245885 000000007e2c4c40
>> 34: 0 4096 245886 000000007e2c4c40
>> 35: 0 4096 245887 000000007e2c4c40
>> 36: 0 4096 245888 000000007e2c4c40
>> 37: 0 4096 245889 000000007e2c4c40
>> 38: 0 4096 245890 000000007e2c4c40
>> 39: 0 4096 245891 000000007e2c4c40
>> 40: 0 4096 245892 000000007e2c4c40
>> 41: 0 4096 245893 000000007e2c4c40
>> 42: 0 4096 245894 000000007e2c4c40
>> 43: 0 4096 245895 000000007e2c4c40
>> 44: 0 4096 245896 000000007e2c4c40
>> 45: 0 4096 245897 000000007e2c4c40
>> 46: 0 4096 245898 000000007e2c4c40
>> 47: 0 4096 245899 000000007e2c4c40
>
>
> We've provided all the information you asked for, what's the next step
> on this, or do we have to unwind the bio splitting code with reverts
> until it starts working?
John, Helge, and I did discuss the problem for a while privately, and looks
it is related with compiler. Last time, I sent one patch which can make the
issue disappear, but the main change is just invovled with the below:
struct bio_vec {
struct page *bv_page;
- unsigned int bv_len;
+ unsigned int bv_seg:8;
+ unsigned int bv_len:24;
unsigned int bv_offset;
};
Maybe John and Helge have some update recently?
The logic in blk_bio_segment_split() is correct, and it does respect the max
segment size limit.
Thanks,
Ming Lei
^ permalink raw reply [flat|nested] 14+ messages in thread
* Re: [BUG] "block: make generic_make_request handle arbitrarily sized bios" breaks boot on parisc-linux
2016-03-09 14:43 ` Ming Lei
@ 2016-03-09 15:15 ` John David Anglin
2016-03-09 15:51 ` Ming Lei
2016-03-09 21:20 ` Helge Deller
0 siblings, 2 replies; 14+ messages in thread
From: John David Anglin @ 2016-03-09 15:15 UTC (permalink / raw)
To: Ming Lei, James Bottomley
Cc: Helge Deller, linux-block, Linux SCSI List, linux-parisc List,
Kent Overstreet
On 2016-03-09 9:43 AM, Ming Lei wrote:
>> We've provided all the information you asked for, what's the next step
>> >on this, or do we have to unwind the bio splitting code with reverts
>> >until it starts working?
> John, Helge, and I did discuss the problem for a while privately, and looks
> it is related with compiler. Last time, I sent one patch which can make the
> issue disappear, but the main change is just invovled with the below:
>
> struct bio_vec {
> struct page *bv_page;
> - unsigned int bv_len;
> + unsigned int bv_seg:8;
> + unsigned int bv_len:24;
> unsigned int bv_offset;
> };
>
> Maybe John and Helge have some update recently?
>
> The logic in blk_bio_segment_split() is correct, and it does respect the max
> segment size limit.
Helge has found that tagging blk_bio_segment_split() with "__attribute__
((optimize("O0")))"
makes the issue disappear. The bug remains if one just adds bv_len to
the struct without the
bit fields. Maybe problem is evident from following output which I sent
to Ming and Helge
last weekend?
blk_rq_map_sg: merge bug: 3 2, extra_len 0, dma_drain 0
check_bvec: dump bvec for 000000007e4efdc0(f:24490000, t:1)
0: 0 4096 246503 000000007e4a4f00(0, 94208, 1)
1: 0 4096 246504 000000007e4a4f00(0, 94208, 1)
2: 0 4096 246505 000000007e4a4f00(0, 94208, 1)
3: 0 4096 246506 000000007e4a4f00(0, 94208, 1)
4: 0 4096 246538 000000007e4a4f00(0, 94208, 2)
5: 0 4096 246539 000000007e4a4f00(0, 94208, 2)
6: 0 4096 246540 000000007e4a4f00(0, 94208, 2)
7: 0 4096 246541 000000007e4a4f00(0, 94208, 2)
8: 0 4096 246542 000000007e4a4f00(0, 94208, 2)
9: 0 4096 246543 000000007e4a4f00(0, 94208, 2)
10: 0 4096 246544 000000007e4a4f00(0, 94208, 2)
11: 0 4096 246545 000000007e4a4f00(0, 94208, 2)
12: 0 4096 246546 000000007e4a4f00(0, 94208, 2)
13: 0 4096 246547 000000007e4a4f00(0, 94208, 2)
14: 0 4096 246548 000000007e4a4f00(0, 94208, 2)
15: 0 4096 246549 000000007e4a4f00(0, 94208, 2)
16: 0 4096 246550 000000007e4a4f00(0, 94208, 2)
17: 0 4096 246551 000000007e4a4f00(0, 94208, 2)
18: 0 4096 246552 000000007e4a4f00(0, 94208, 2)
19: 0 4096 246553 000000007e4a4f00(0, 94208, 2)
20: 0 4096 246554 000000007e4a4f00(0, 94208, 2)
21: 0 4096 246555 000000007e4a4f00(0, 94208, 2)
22: 0 4096 246556 000000007e4a4f00(0, 94208, 2)
Kernel panic - not syncing: bad block merge
It seems segment 1 is too small and segment 2 too big?
The general plan is to disable inlining (maybe move
blk_bio_segment_split() to a separate
function) to try to figure out what is miscompiled.
As you say, this is probably a GCC bug. However, it's likely a
middle-end or optimization
bug in the common GCC code.
Dave
--
John David Anglin dave.anglin@bell.net
^ permalink raw reply [flat|nested] 14+ messages in thread
* Re: [BUG] "block: make generic_make_request handle arbitrarily sized bios" breaks boot on parisc-linux
2016-03-09 15:15 ` John David Anglin
@ 2016-03-09 15:51 ` Ming Lei
2016-03-09 21:20 ` Helge Deller
1 sibling, 0 replies; 14+ messages in thread
From: Ming Lei @ 2016-03-09 15:51 UTC (permalink / raw)
To: John David Anglin
Cc: James Bottomley, Helge Deller, linux-block, Linux SCSI List,
linux-parisc List, Kent Overstreet
On Wed, Mar 9, 2016 at 11:15 PM, John David Anglin <dave.anglin@bell.net> wrote:
> On 2016-03-09 9:43 AM, Ming Lei wrote:
>>>
>>> We've provided all the information you asked for, what's the next step
>>> >on this, or do we have to unwind the bio splitting code with reverts
>>> >until it starts working?
>>
>> John, Helge, and I did discuss the problem for a while privately, and
>> looks
>> it is related with compiler. Last time, I sent one patch which can make
>> the
>> issue disappear, but the main change is just invovled with the below:
>>
>> struct bio_vec {
>> struct page *bv_page;
>> - unsigned int bv_len;
>> + unsigned int bv_seg:8;
>> + unsigned int bv_len:24;
>> unsigned int bv_offset;
>> };
>>
>> Maybe John and Helge have some update recently?
>>
>> The logic in blk_bio_segment_split() is correct, and it does respect the
>> max
>> segment size limit.
>
> Helge has found that tagging blk_bio_segment_split() with "__attribute__
> ((optimize("O0")))"
> makes the issue disappear. The bug remains if one just adds bv_len to the
> struct without the
> bit fields. Maybe problem is evident from following output which I sent to
> Ming and Helge
> last weekend?
>
> blk_rq_map_sg: merge bug: 3 2, extra_len 0, dma_drain 0
> check_bvec: dump bvec for 000000007e4efdc0(f:24490000, t:1)
> 0: 0 4096 246503 000000007e4a4f00(0, 94208, 1)
> 1: 0 4096 246504 000000007e4a4f00(0, 94208, 1)
> 2: 0 4096 246505 000000007e4a4f00(0, 94208, 1)
> 3: 0 4096 246506 000000007e4a4f00(0, 94208, 1)
The above 4 io vectors belong to one same segment since
they are contineous physically from the 3rd column of PFN,
but the vector 4(the below one) isn't contineous with above 3
vectors, so the following one starts the 2nd segment.
> 4: 0 4096 246538 000000007e4a4f00(0, 94208, 2)
> 5: 0 4096 246539 000000007e4a4f00(0, 94208, 2)
> 6: 0 4096 246540 000000007e4a4f00(0, 94208, 2)
> 7: 0 4096 246541 000000007e4a4f00(0, 94208, 2)
> 8: 0 4096 246542 000000007e4a4f00(0, 94208, 2)
> 9: 0 4096 246543 000000007e4a4f00(0, 94208, 2)
> 10: 0 4096 246544 000000007e4a4f00(0, 94208, 2)
> 11: 0 4096 246545 000000007e4a4f00(0, 94208, 2)
> 12: 0 4096 246546 000000007e4a4f00(0, 94208, 2)
> 13: 0 4096 246547 000000007e4a4f00(0, 94208, 2)
> 14: 0 4096 246548 000000007e4a4f00(0, 94208, 2)
> 15: 0 4096 246549 000000007e4a4f00(0, 94208, 2)
> 16: 0 4096 246550 000000007e4a4f00(0, 94208, 2)
> 17: 0 4096 246551 000000007e4a4f00(0, 94208, 2)
> 18: 0 4096 246552 000000007e4a4f00(0, 94208, 2)
> 19: 0 4096 246553 000000007e4a4f00(0, 94208, 2)
The above 16 vectors are contineous physically, but the segment
size becomes 64K now, so blk_bio_segment_split() should have
seen that and started to split the bio.
> 20: 0 4096 246554 000000007e4a4f00(0, 94208, 2)
> 21: 0 4096 246555 000000007e4a4f00(0, 94208, 2)
> 22: 0 4096 246556 000000007e4a4f00(0, 94208, 2)
Unfortunately the bio isn't splitted at all, that means the following
code is run incorrectly:
if (seg_size + bv.bv_len > queue_max_segment_size(q))
goto new_segment;
seg_size should be 64K, and bv.bv_len should be 4K, so
the sum between the two should be bigger than
64K(queue_max_segment_size(q)). Unfortunately, the
code is optimized as run incorrectly.
> Kernel panic - not syncing: bad block merge
>
> It seems segment 1 is too small and segment 2 too big?
segment 1 is correct, and segment 2 becomes too big, but
__blk_segment_map_sg() runs correctly and figured out
this bio has 3 segments, so causes the oops.
>
> The general plan is to disable inlining (maybe move blk_bio_segment_split()
> to a separate
> function) to try to figure out what is miscompiled.
>
> As you say, this is probably a GCC bug. However, it's likely a middle-end
> or optimization
> bug in the common GCC code.
>
> Dave
>
>
> --
> John David Anglin dave.anglin@bell.net
>
--
Ming Lei
^ permalink raw reply [flat|nested] 14+ messages in thread
* Re: [BUG] "block: make generic_make_request handle arbitrarily sized bios" breaks boot on parisc-linux
2016-03-09 15:15 ` John David Anglin
2016-03-09 15:51 ` Ming Lei
@ 2016-03-09 21:20 ` Helge Deller
2016-03-10 0:16 ` James Bottomley
2016-03-10 7:04 ` Rolf Eike Beer
1 sibling, 2 replies; 14+ messages in thread
From: Helge Deller @ 2016-03-09 21:20 UTC (permalink / raw)
To: John David Anglin, Ming Lei, James Bottomley
Cc: linux-block, Linux SCSI List, linux-parisc List, Kent Overstreet
On 09.03.2016 16:15, John David Anglin wrote:
> On 2016-03-09 9:43 AM, Ming Lei wrote:
>>> We've provided all the information you asked for, what's the next step
>>> >on this, or do we have to unwind the bio splitting code with reverts
>>> >until it starts working?
>> John, Helge, and I did discuss the problem for a while privately, and looks
>> it is related with compiler. Last time, I sent one patch which can make the
>> issue disappear, but the main change is just invovled with the below:
>>
>> struct bio_vec {
>> struct page *bv_page;
>> - unsigned int bv_len;
>> + unsigned int bv_seg:8;
>> + unsigned int bv_len:24;
>> unsigned int bv_offset;
>> };
>>
>> Maybe John and Helge have some update recently?
>>
>> The logic in blk_bio_segment_split() is correct, and it does respect the max
>> segment size limit.
> Helge has found that tagging blk_bio_segment_split() with "__attribute__ ((optimize("O0")))"
> makes the issue disappear. The bug remains if one just adds bv_len to the struct without the
> bit fields. Maybe problem is evident from following output which I sent to Ming and Helge
> last weekend?
>
> blk_rq_map_sg: merge bug: 3 2, extra_len 0, dma_drain 0
> check_bvec: dump bvec for 000000007e4efdc0(f:24490000, t:1)
> 0: 0 4096 246503 000000007e4a4f00(0, 94208, 1)
> 1: 0 4096 246504 000000007e4a4f00(0, 94208, 1)
> 2: 0 4096 246505 000000007e4a4f00(0, 94208, 1)
> 3: 0 4096 246506 000000007e4a4f00(0, 94208, 1)
> 4: 0 4096 246538 000000007e4a4f00(0, 94208, 2)
> 5: 0 4096 246539 000000007e4a4f00(0, 94208, 2)
> 6: 0 4096 246540 000000007e4a4f00(0, 94208, 2)
> 7: 0 4096 246541 000000007e4a4f00(0, 94208, 2)
> 8: 0 4096 246542 000000007e4a4f00(0, 94208, 2)
> 9: 0 4096 246543 000000007e4a4f00(0, 94208, 2)
> 10: 0 4096 246544 000000007e4a4f00(0, 94208, 2)
> 11: 0 4096 246545 000000007e4a4f00(0, 94208, 2)
> 12: 0 4096 246546 000000007e4a4f00(0, 94208, 2)
> 13: 0 4096 246547 000000007e4a4f00(0, 94208, 2)
> 14: 0 4096 246548 000000007e4a4f00(0, 94208, 2)
> 15: 0 4096 246549 000000007e4a4f00(0, 94208, 2)
> 16: 0 4096 246550 000000007e4a4f00(0, 94208, 2)
> 17: 0 4096 246551 000000007e4a4f00(0, 94208, 2)
> 18: 0 4096 246552 000000007e4a4f00(0, 94208, 2)
> 19: 0 4096 246553 000000007e4a4f00(0, 94208, 2)
> 20: 0 4096 246554 000000007e4a4f00(0, 94208, 2)
> 21: 0 4096 246555 000000007e4a4f00(0, 94208, 2)
> 22: 0 4096 246556 000000007e4a4f00(0, 94208, 2)
> Kernel panic - not syncing: bad block merge
>
> It seems segment 1 is too small and segment 2 too big?
>
> The general plan is to disable inlining (maybe move blk_bio_segment_split() to a separate
> function) to try to figure out what is miscompiled.
Right.
I just succeeded in reproducing the bug with moving blk_bio_segment_split() into an own file
(and with "extern" instead of "static" in blk-merge.c). When compiled with -O2 it still crashes.
So, next step is to analyze what gcc does wrong when compiling this function.
It should get easier now to find the reason, since we have a smaller reproducer now.
Helge
> As you say, this is probably a GCC bug. However, it's likely a middle-end or optimization
> bug in the common GCC code.
>
> Dave
>
^ permalink raw reply [flat|nested] 14+ messages in thread
* Re: [BUG] "block: make generic_make_request handle arbitrarily sized bios" breaks boot on parisc-linux
2016-03-09 21:20 ` Helge Deller
@ 2016-03-10 0:16 ` James Bottomley
2016-03-10 7:04 ` Rolf Eike Beer
1 sibling, 0 replies; 14+ messages in thread
From: James Bottomley @ 2016-03-10 0:16 UTC (permalink / raw)
To: Helge Deller, John David Anglin, Ming Lei
Cc: linux-block, Linux SCSI List, linux-parisc List, Kent Overstreet
On Wed, 2016-03-09 at 22:20 +0100, Helge Deller wrote:
> On 09.03.2016 16:15, John David Anglin wrote:
> > On 2016-03-09 9:43 AM, Ming Lei wrote:
> > > > We've provided all the information you asked for, what's the
> > > > next step
> > > > > on this, or do we have to unwind the bio splitting code with
> > > > > reverts
> > > > > until it starts working?
> > > John, Helge, and I did discuss the problem for a while privately,
> > > and looks
> > > it is related with compiler. Last time, I sent one patch which
> > > can make the
> > > issue disappear, but the main change is just invovled with the
> > > below:
> > >
> > > struct bio_vec {
> > > struct page *bv_page;
> > > - unsigned int bv_len;
> > > + unsigned int bv_seg:8;
> > > + unsigned int bv_len:24;
> > > unsigned int bv_offset;
> > > };
> > >
> > > Maybe John and Helge have some update recently?
> > >
> > > The logic in blk_bio_segment_split() is correct, and it does
> > > respect the max
> > > segment size limit.
> > Helge has found that tagging blk_bio_segment_split() with
> > "__attribute__ ((optimize("O0")))"
> > makes the issue disappear. The bug remains if one just adds bv_len
> > to the struct without the
> > bit fields. Maybe problem is evident from following output which I
> > sent to Ming and Helge
> > last weekend?
> >
> > blk_rq_map_sg: merge bug: 3 2, extra_len 0, dma_drain 0
> > check_bvec: dump bvec for 000000007e4efdc0(f:24490000, t:1)
> > 0: 0 4096 246503 000000007e4a4f00(0, 94208, 1)
> > 1: 0 4096 246504 000000007e4a4f00(0, 94208, 1)
> > 2: 0 4096 246505 000000007e4a4f00(0, 94208, 1)
> > 3: 0 4096 246506 000000007e4a4f00(0, 94208, 1)
> > 4: 0 4096 246538 000000007e4a4f00(0, 94208, 2)
> > 5: 0 4096 246539 000000007e4a4f00(0, 94208, 2)
> > 6: 0 4096 246540 000000007e4a4f00(0, 94208, 2)
> > 7: 0 4096 246541 000000007e4a4f00(0, 94208, 2)
> > 8: 0 4096 246542 000000007e4a4f00(0, 94208, 2)
> > 9: 0 4096 246543 000000007e4a4f00(0, 94208, 2)
> > 10: 0 4096 246544 000000007e4a4f00(0, 94208, 2)
> > 11: 0 4096 246545 000000007e4a4f00(0, 94208, 2)
> > 12: 0 4096 246546 000000007e4a4f00(0, 94208, 2)
> > 13: 0 4096 246547 000000007e4a4f00(0, 94208, 2)
> > 14: 0 4096 246548 000000007e4a4f00(0, 94208, 2)
> > 15: 0 4096 246549 000000007e4a4f00(0, 94208, 2)
> > 16: 0 4096 246550 000000007e4a4f00(0, 94208, 2)
> > 17: 0 4096 246551 000000007e4a4f00(0, 94208, 2)
> > 18: 0 4096 246552 000000007e4a4f00(0, 94208, 2)
> > 19: 0 4096 246553 000000007e4a4f00(0, 94208, 2)
> > 20: 0 4096 246554 000000007e4a4f00(0, 94208, 2)
> > 21: 0 4096 246555 000000007e4a4f00(0, 94208, 2)
> > 22: 0 4096 246556 000000007e4a4f00(0, 94208, 2)
> > Kernel panic - not syncing: bad block merge
> >
> > It seems segment 1 is too small and segment 2 too big?
> >
> > The general plan is to disable inlining (maybe move
> > blk_bio_segment_split() to a separate
> > function) to try to figure out what is miscompiled.
>
> Right.
> I just succeeded in reproducing the bug with moving
> blk_bio_segment_split() into an own file
> (and with "extern" instead of "static" in blk-merge.c). When compiled
> with -O2 it still crashes.
> So, next step is to analyze what gcc does wrong when compiling this
> function.
> It should get easier now to find the reason, since we have a smaller
> reproducer now.
OK, that would explain why I don't see the problem, since I'm using an
older compiler. So it's our issue and basically no action for block.
James
^ permalink raw reply [flat|nested] 14+ messages in thread
* Re: [BUG] "block: make generic_make_request handle arbitrarily sized bios" breaks boot on parisc-linux
2016-03-09 21:20 ` Helge Deller
2016-03-10 0:16 ` James Bottomley
@ 2016-03-10 7:04 ` Rolf Eike Beer
2016-03-20 18:12 ` Helge Deller
1 sibling, 1 reply; 14+ messages in thread
From: Rolf Eike Beer @ 2016-03-10 7:04 UTC (permalink / raw)
To: Helge Deller
Cc: John David Anglin, Ming Lei, James Bottomley, linux-block,
Linux SCSI List, linux-parisc List, Kent Overstreet
[-- Attachment #1: Type: text/plain, Size: 583 bytes --]
> Right.
> I just succeeded in reproducing the bug with moving blk_bio_segment_split()
> into an own file (and with "extern" instead of "static" in blk-merge.c).
> When compiled with -O2 it still crashes. So, next step is to analyze what
> gcc does wrong when compiling this function. It should get easier now to
> find the reason, since we have a smaller reproducer now.
I have a ton of compilers here on my C8000 and a few even on my C3600 which
drive nightly CMake dashboards. Could you send the testcase so I can pass it
through the list and see what breaks?
Greetings,
Eike
[-- Attachment #2: This is a digitally signed message part. --]
[-- Type: application/pgp-signature, Size: 198 bytes --]
^ permalink raw reply [flat|nested] 14+ messages in thread
* Re: [BUG] "block: make generic_make_request handle arbitrarily sized bios" breaks boot on parisc-linux
2016-03-10 7:04 ` Rolf Eike Beer
@ 2016-03-20 18:12 ` Helge Deller
0 siblings, 0 replies; 14+ messages in thread
From: Helge Deller @ 2016-03-20 18:12 UTC (permalink / raw)
To: Rolf Eike Beer
Cc: John David Anglin, Ming Lei, James Bottomley, linux-block,
Linux SCSI List, linux-parisc List, Kent Overstreet
Hi Eike,
On 10.03.2016 08:04, Rolf Eike Beer wrote:
>> Right.
>> I just succeeded in reproducing the bug with moving blk_bio_segment_split()
>> into an own file (and with "extern" instead of "static" in blk-merge.c).
>> When compiled with -O2 it still crashes. So, next step is to analyze what
>> gcc does wrong when compiling this function. It should get easier now to
>> find the reason, since we have a smaller reproducer now.
>
> I have a ton of compilers here on my C8000 and a few even on my C3600 which
> drive nightly CMake dashboards. Could you send the testcase so I can pass it
> through the list and see what breaks?
Thanks for the offer!
Sadly it's not a stand-alone testcase, just the original source code extracted
which can be manually compiled and then the generated assembly can be compared
to what it should be.
That said, I think this specific testcase is not really usable in your test environment.
By the way, the bug was just fixed. Details are in bugzilla:
https://gcc.gnu.org/bugzilla/show_bug.cgi?id=70188
Thanks,
Helge
^ permalink raw reply [flat|nested] 14+ messages in thread
end of thread, other threads:[~2016-03-20 18:12 UTC | newest]
Thread overview: 14+ messages (download: mbox.gz follow: Atom feed
-- links below jump to the message on this page --
2016-02-24 2:28 [BUG] "block: make generic_make_request handle arbitrarily sized bios" breaks boot on parisc-linux John David Anglin
2016-02-24 7:59 ` Ming Lei
2016-02-24 21:36 ` Helge Deller
2016-02-24 23:28 ` John David Anglin
2016-02-25 3:38 ` Ming Lei
2016-02-25 10:10 ` Aw: " Helge Deller
2016-03-09 12:55 ` James Bottomley
2016-03-09 14:43 ` Ming Lei
2016-03-09 15:15 ` John David Anglin
2016-03-09 15:51 ` Ming Lei
2016-03-09 21:20 ` Helge Deller
2016-03-10 0:16 ` James Bottomley
2016-03-10 7:04 ` Rolf Eike Beer
2016-03-20 18:12 ` Helge Deller
This is a public inbox, see mirroring instructions
for how to clone and mirror all data and code used for this inbox;
as well as URLs for NNTP newsgroup(s).