[Fryer] master FAIL. 8 of 26 tests succeeded.
fryer at oneiros.varnish-software.com
fryer at oneiros.varnish-software.com
Mon Mar 19 00:31:08 CET 2012
Tests Failed: httperf-lru-nostream-gzip httperf-lru-nostream-gzip-deflateoff streaming httperf-lru-default memleak httperf-lru-stream-default httperf-lru-nostream-nogzip cold-gzip httperf-lru-stream-gzip httperf-lru-stream-nogzip cold-nogzip lru-random httperf-lru-nostream-default httperf-rapid-expire streaming-grace cold-default 4gpluss-nogzip purge-fail
Tests OK: 4gpluss-stream httperf-hot 4gpluss basic-fryer 4gpluss-nostream siege-test sky-misc streaming-gzip
2012-03-18 20:32:23 [1,21]: Server tristran checked out varnish-3.0.0-beta2-895-gbbc0bc4 of branch master
2012-03-18 20:33:44 [2,80]: httperf-lru-nostream-gzip(httperf): Starting test
2012-03-18 20:39:30 WARNING [0,345]: httperf-lru-nostream-gzip(httperf): Panic detected. I think!
2012-03-18 20:39:30 WARNING [0, 0]: httperf-lru-nostream-gzip(httperf):
Last panic at: Sun, 18 Mar 2012 20:38:32 GMT
Assert error in FetchBody(), cache/cache_fetch.c line 671:
Condition(uu == obj->len) not true.
thread = (cache-worker)
ident = Linux,2.6.32-39-server,x86_64,-smalloc,-smalloc,-hcritbit,epoll
Backtrace:
0x431a88: pan_ic+d8
0x42547d: FetchBody+78d
0x433272: Pool_Work_Thread+112
0x4404b8: wrk_thread_real+c8
0x7f4fc182a9ca: _end+7f4fc11a7212
0x7f4fc1587cdd: _end+7f4fc0f04525
2012-03-18 20:39:30 [1, 0]: httperf-lru-nostream-gzip(httperf): Varnishstat uptime and measured run-time is too large (measured: 340 stat: 56 diff: 284). Did we crash?
2012-03-18 20:39:30 WARNING [0, 0]: httperf-lru-nostream-gzip(httperf): Out of bounds: n_lru_nuked(0) less than lower boundary 80000
2012-03-18 20:39:30 WARNING [0, 0]: httperf-lru-nostream-gzip(httperf): Out of bounds: client_req(195194) less than lower boundary 1999720
2012-03-18 20:39:30 [1, 0]: httperf-lru-nostream-gzip(httperf): Load: 21:39:30 up 6 days, 9:25, 0 users, load average: 5.46, 6.63, 3.31
2012-03-18 20:39:30 [1, 0]: httperf-lru-nostream-gzip(httperf): Test name: httperf-lru-nostream-gzip
2012-03-18 20:39:30 [1, 0]: httperf-lru-nostream-gzip(httperf): Varnish options:
2012-03-18 20:39:30 [1, 0]: httperf-lru-nostream-gzip(httperf): -t=3600
2012-03-18 20:39:30 [1, 0]: httperf-lru-nostream-gzip(httperf): -w=200,5000
2012-03-18 20:39:30 [1, 0]: httperf-lru-nostream-gzip(httperf): -s=malloc,30M
2012-03-18 20:39:30 [1, 0]: httperf-lru-nostream-gzip(httperf): Varnish parameters:
2012-03-18 20:39:30 [1, 0]: httperf-lru-nostream-gzip(httperf): nuke_limit=250
2012-03-18 20:39:30 [1, 0]: httperf-lru-nostream-gzip(httperf): http_gzip_support=on
2012-03-18 20:39:30 [1, 0]: httperf-lru-nostream-gzip(httperf): Payload size (excludes headers): 10K
2012-03-18 20:39:30 [1, 0]: httperf-lru-nostream-gzip(httperf): Branch: master
2012-03-18 20:39:30 [1, 0]: httperf-lru-nostream-gzip(httperf): Number of clients involved: 24
2012-03-18 20:39:30 [1, 0]: httperf-lru-nostream-gzip(httperf): Type of test: httperf
2012-03-18 20:39:30 [1, 0]: httperf-lru-nostream-gzip(httperf): Test iterations: 1
2012-03-18 20:39:30 [1, 0]: httperf-lru-nostream-gzip(httperf): Runtime: 340 seconds
2012-03-18 20:39:30 [1, 0]: httperf-lru-nostream-gzip(httperf): VCL:
backend foo {
.host = "localhost";
.port = "80";
}
sub vcl_fetch {
set beresp.do_stream = false;
}
2012-03-18 20:39:30 [1, 0]: httperf-lru-nostream-gzip(httperf): Number of total connections: 200000
2012-03-18 20:39:30 [1, 0]: httperf-lru-nostream-gzip(httperf): Note: connections are subject to rounding when divided among clients. Expect slight deviations.
2012-03-18 20:39:30 [1, 0]: httperf-lru-nostream-gzip(httperf): Requests per connection: 10
2012-03-18 20:39:30 [1, 0]: httperf-lru-nostream-gzip(httperf): Extra options to httperf: --wset=1000000,0.1
2012-03-18 20:39:30 [1, 0]: httperf-lru-nostream-gzip(httperf): Httperf command (last client): httperf --hog --timeout 60 --num-calls 10 --num-conns 8333 --port 8080 --burst-length 10 --client 23/24 --server 10.20.100.4 --wset=1000000,0.1
2012-03-18 20:39:38 [2, 7]: httperf-lru-nostream-gzip-deflateoff(httperf): Starting test
2012-03-18 20:45:14 WARNING [0,335]: httperf-lru-nostream-gzip-deflateoff(httperf): Panic detected. I think!
2012-03-18 20:45:14 WARNING [0, 0]: httperf-lru-nostream-gzip-deflateoff(httperf):
Last panic at: Sun, 18 Mar 2012 20:43:20 GMT
Assert error in FetchBody(), cache/cache_fetch.c line 671:
Condition(uu == obj->len) not true.
thread = (cache-worker)
ident = Linux,2.6.32-39-server,x86_64,-smalloc,-smalloc,-hcritbit,epoll
Backtrace:
0x431a88: pan_ic+d8
0x42547d: FetchBody+78d
0x433272: Pool_Work_Thread+112
0x4404b8: wrk_thread_real+c8
0x7f63d59289ca: _end+7f63d52a5212
0x7f63d5685cdd: _end+7f63d5002525
2012-03-18 20:45:14 [1, 0]: httperf-lru-nostream-gzip-deflateoff(httperf): Varnishstat uptime and measured run-time is too large (measured: 327 stat: 112 diff: 215). Did we crash?
2012-03-18 20:45:14 WARNING [0, 0]: httperf-lru-nostream-gzip-deflateoff(httperf): Out of bounds: n_lru_nuked(3609) less than lower boundary 80000
2012-03-18 20:45:14 WARNING [0, 0]: httperf-lru-nostream-gzip-deflateoff(httperf): Out of bounds: client_req(365007) less than lower boundary 1999720
2012-03-18 20:45:14 [1, 0]: httperf-lru-nostream-gzip-deflateoff(httperf): Load: 21:45:14 up 6 days, 9:31, 0 users, load average: 3.47, 7.37, 4.96
2012-03-18 20:45:14 [1, 0]: httperf-lru-nostream-gzip-deflateoff(httperf): Test name: httperf-lru-nostream-gzip-deflateoff
2012-03-18 20:45:14 [1, 0]: httperf-lru-nostream-gzip-deflateoff(httperf): Varnish options:
2012-03-18 20:45:14 [1, 0]: httperf-lru-nostream-gzip-deflateoff(httperf): -t=3600
2012-03-18 20:45:14 [1, 0]: httperf-lru-nostream-gzip-deflateoff(httperf): -w=200,5000
2012-03-18 20:45:14 [1, 0]: httperf-lru-nostream-gzip-deflateoff(httperf): -s=malloc,30M
2012-03-18 20:45:14 [1, 0]: httperf-lru-nostream-gzip-deflateoff(httperf): Varnish parameters:
2012-03-18 20:45:14 [1, 0]: httperf-lru-nostream-gzip-deflateoff(httperf): nuke_limit=250
2012-03-18 20:45:14 [1, 0]: httperf-lru-nostream-gzip-deflateoff(httperf): http_gzip_support=on
2012-03-18 20:45:14 [1, 0]: httperf-lru-nostream-gzip-deflateoff(httperf): Payload size (excludes headers): 10K
2012-03-18 20:45:14 [1, 0]: httperf-lru-nostream-gzip-deflateoff(httperf): Branch: master
2012-03-18 20:45:14 [1, 0]: httperf-lru-nostream-gzip-deflateoff(httperf): Number of clients involved: 24
2012-03-18 20:45:14 [1, 0]: httperf-lru-nostream-gzip-deflateoff(httperf): Type of test: httperf
2012-03-18 20:45:14 [1, 0]: httperf-lru-nostream-gzip-deflateoff(httperf): Test iterations: 1
2012-03-18 20:45:14 [1, 0]: httperf-lru-nostream-gzip-deflateoff(httperf): Runtime: 327 seconds
2012-03-18 20:45:14 [1, 0]: httperf-lru-nostream-gzip-deflateoff(httperf): VCL:
backend foo {
.host = "localhost";
.port = "80";
}
sub vcl_fetch {
set beresp.do_stream = false;
set beresp.do_gzip = true;
}
2012-03-18 20:45:14 [1, 0]: httperf-lru-nostream-gzip-deflateoff(httperf): Number of total connections: 200000
2012-03-18 20:45:14 [1, 0]: httperf-lru-nostream-gzip-deflateoff(httperf): Note: connections are subject to rounding when divided among clients. Expect slight deviations.
2012-03-18 20:45:14 [1, 0]: httperf-lru-nostream-gzip-deflateoff(httperf): Requests per connection: 10
2012-03-18 20:45:14 [1, 0]: httperf-lru-nostream-gzip-deflateoff(httperf): Extra options to httperf: --wset=1000000,0.1
2012-03-18 20:45:14 [1, 0]: httperf-lru-nostream-gzip-deflateoff(httperf): Httperf command (last client): httperf --hog --timeout 60 --num-calls 10 --num-conns 8333 --port 8080 --burst-length 10 --client 23/24 --server 10.20.100.4 --wset=1000000,0.1
2012-03-18 20:45:22 [2, 7]: streaming(httperf): Starting test
2012-03-18 20:48:10 WARNING [0,168]: streaming(httperf): Panic detected. I think!
2012-03-18 20:48:10 WARNING [0, 0]: streaming(httperf):
Last panic at: Sun, 18 Mar 2012 20:47:46 GMT
Assert error in HSH_Lookup(), cache/cache_hash.c line 336:
Condition((oc->busyobj) != NULL) not true.
thread = (cache-worker)
ident = Linux,2.6.32-39-server,x86_64,-smalloc,-smalloc,-hcritbit,epoll
Backtrace:
0x431a88: pan_ic+d8
0x42a42d: HSH_Lookup+89d
0x416ce7: cnt_lookup+1c7
0x41a97d: CNT_Session+4ed
0x43639d: ses_pool_task+fd
0x433272: Pool_Work_Thread+112
0x4404b8: wrk_thread_real+c8
0x7f23f4fdd9ca: _end+7f23f495a212
0x7f23f4d3acdd: _end+7f23f46b7525
sp = 0x7f23ea403320 {
fd = 12, id = 12, xid = 426460238,
client = 10.20.100.9 6738,
step = STP_LOOKUP,
handling = hash,
restarts = 0, esi_level = 0
ws = 0x7f23ea40c150 {
id = "req",
{s,f,r,e} = {0x7f23ea40d728,+128,+59640,+59640},
},
http[req] = {
ws = 0x7f23ea40c150[req]
"GET",
"/8/8/9.html",
"HTTP/1.1",
"User-Agent: httperf/0.9.0",
"Host: 10.20.100.4",
"X-Forwarded-For: 10.20.100.9",
},
worker = 0x7f23eb7efc60 {
ws = 0x7f23eb7efe20 {
id = "wrk",
{s,f,r,e} = {0x7f23eb7ef450,0x7f23eb7ef450,(nil),+2048},
},
},
vcl = {
srcname = {
"input",
"Default",
},
},
},
2012-03-18 20:48:10 [1, 0]: streaming(httperf): Varnishstat uptime and measured run-time is too large (measured: 163 stat: 22 diff: 141). Did we crash?
2012-03-18 20:48:11 WARNING [0, 0]: streaming(httperf): Out of bounds: client_req(276) less than lower boundary 9784
2012-03-18 20:48:11 [1, 0]: streaming(httperf): Load: 21:48:11 up 6 days, 9:34, 0 users, load average: 2.48, 5.21, 4.52
2012-03-18 20:48:11 [1, 0]: streaming(httperf): Test name: streaming
2012-03-18 20:48:11 [1, 0]: streaming(httperf): Varnish options:
2012-03-18 20:48:11 [1, 0]: streaming(httperf): -t=1
2012-03-18 20:48:11 [1, 0]: streaming(httperf): Varnish parameters:
2012-03-18 20:48:11 [1, 0]: streaming(httperf): thread_pool_add_delay=1
2012-03-18 20:48:11 [1, 0]: streaming(httperf): http_gzip_support=off
2012-03-18 20:48:11 [1, 0]: streaming(httperf): default_grace=0
2012-03-18 20:48:11 [1, 0]: streaming(httperf): Payload size (excludes headers): 1M
2012-03-18 20:48:11 [1, 0]: streaming(httperf): Branch: master
2012-03-18 20:48:11 [1, 0]: streaming(httperf): Number of clients involved: 24
2012-03-18 20:48:11 [1, 0]: streaming(httperf): Type of test: httperf
2012-03-18 20:48:11 [1, 0]: streaming(httperf): Test iterations: 1
2012-03-18 20:48:11 [1, 0]: streaming(httperf): Runtime: 163 seconds
2012-03-18 20:48:11 [1, 0]: streaming(httperf): VCL:
backend foo {
.host = "localhost";
.port = "80";
.connect_timeout = 10s;
}
sub vcl_fetch {
set beresp.do_stream = true;
set beresp.grace = 0s;
set beresp.ttl = 15s;
}
sub vcl_deliver {
set resp.http.x-fryer = "some test";
}
2012-03-18 20:48:11 [1, 0]: streaming(httperf): Number of total connections: 10000
2012-03-18 20:48:11 [1, 0]: streaming(httperf): Note: connections are subject to rounding when divided among clients. Expect slight deviations.
2012-03-18 20:48:11 [1, 0]: streaming(httperf): Requests per connection: 1
2012-03-18 20:48:11 [1, 0]: streaming(httperf): Extra options to httperf: --wset=1000,0.1 --rate 3
2012-03-18 20:48:11 [1, 0]: streaming(httperf): Httperf command (last client): httperf --hog --timeout 60 --num-calls 1 --num-conns 416 --port 8080 --burst-length 1 --client 23/24 --server 10.20.100.4 --wset=1000,0.1 --rate 3
2012-03-18 20:48:19 [2, 7]: httperf-lru-default(httperf): Starting test
2012-03-18 20:54:23 WARNING [0,364]: httperf-lru-default(httperf): Panic detected. I think!
2012-03-18 20:54:23 WARNING [0, 0]: httperf-lru-default(httperf):
Last panic at: Sun, 18 Mar 2012 20:53:31 GMT
Assert error in EXP_Insert(), cache/cache_expire.c line 226:
Condition((oc)->magic == 0x4d301302) not true.
thread = (cache-worker)
ident = Linux,2.6.32-39-server,x86_64,-smalloc,-smalloc,-hcritbit,epoll
Backtrace:
0x431a88: pan_ic+d8
0x42419e: EXP_Insert+7e
0x42522b: FetchBody+53b
0x433272: Pool_Work_Thread+112
0x4404b8: wrk_thread_real+c8
0x7ffa30b4f9ca: _end+7ffa304cc212
0x7ffa308accdd: _end+7ffa30229525
2012-03-18 20:54:23 [1, 0]: httperf-lru-default(httperf): Varnishstat uptime and measured run-time is too large (measured: 358 stat: 50 diff: 308). Did we crash?
2012-03-18 20:54:23 WARNING [0, 0]: httperf-lru-default(httperf): Out of bounds: n_lru_nuked(0) less than lower boundary 80000
2012-03-18 20:54:23 WARNING [0, 0]: httperf-lru-default(httperf): Out of bounds: client_req(103528) less than lower boundary 1999720
2012-03-18 20:54:24 [1, 0]: httperf-lru-default(httperf): Load: 21:54:24 up 6 days, 9:40, 0 users, load average: 4.89, 8.44, 6.53
2012-03-18 20:54:24 [1, 0]: httperf-lru-default(httperf): Test name: httperf-lru-default
2012-03-18 20:54:24 [1, 0]: httperf-lru-default(httperf): Varnish options:
2012-03-18 20:54:24 [1, 0]: httperf-lru-default(httperf): -t=3600
2012-03-18 20:54:24 [1, 0]: httperf-lru-default(httperf): -w=200,5000
2012-03-18 20:54:24 [1, 0]: httperf-lru-default(httperf): -s=malloc,30M
2012-03-18 20:54:24 [1, 0]: httperf-lru-default(httperf): Varnish parameters:
2012-03-18 20:54:24 [1, 0]: httperf-lru-default(httperf): nuke_limit=250
2012-03-18 20:54:24 [1, 0]: httperf-lru-default(httperf): Payload size (excludes headers): 10K
2012-03-18 20:54:24 [1, 0]: httperf-lru-default(httperf): Branch: master
2012-03-18 20:54:24 [1, 0]: httperf-lru-default(httperf): Number of clients involved: 24
2012-03-18 20:54:24 [1, 0]: httperf-lru-default(httperf): Type of test: httperf
2012-03-18 20:54:24 [1, 0]: httperf-lru-default(httperf): Test iterations: 1
2012-03-18 20:54:24 [1, 0]: httperf-lru-default(httperf): Runtime: 358 seconds
2012-03-18 20:54:24 [1, 0]: httperf-lru-default(httperf): VCL:
backend foo {
.host = "localhost";
.port = "80";
}
sub vcl_fetch {
set beresp.do_stream = true;
}
2012-03-18 20:54:24 [1, 0]: httperf-lru-default(httperf): Number of total connections: 200000
2012-03-18 20:54:24 [1, 0]: httperf-lru-default(httperf): Note: connections are subject to rounding when divided among clients. Expect slight deviations.
2012-03-18 20:54:24 [1, 0]: httperf-lru-default(httperf): Requests per connection: 10
2012-03-18 20:54:24 [1, 0]: httperf-lru-default(httperf): Extra options to httperf: --wset=1000000,0.1
2012-03-18 20:54:24 [1, 0]: httperf-lru-default(httperf): Httperf command (last client): httperf --hog --timeout 60 --num-calls 10 --num-conns 8333 --port 8080 --burst-length 10 --client 23/24 --server 10.20.100.4 --wset=1000000,0.1
2012-03-18 20:54:31 [2, 7]: memleak(httperf): Starting test
2012-03-18 21:06:37 WARNING [0,725]: memleak(httperf): Out of bounds: client_req(9950310) less than lower boundary 9959800
2012-03-18 21:06:37 [1, 0]: memleak(httperf): Load: 22:06:37 up 6 days, 9:52, 0 users, load average: 21.48, 21.92, 15.62
2012-03-18 21:06:37 [1, 0]: memleak(httperf): Test name: memleak
2012-03-18 21:06:37 [1, 0]: memleak(httperf): Varnish options:
2012-03-18 21:06:37 [1, 0]: memleak(httperf): -t=3600
2012-03-18 21:06:37 [1, 0]: memleak(httperf): Varnish parameters:
2012-03-18 21:06:37 [1, 0]: memleak(httperf): thread_pool_add_delay=1
2012-03-18 21:06:37 [1, 0]: memleak(httperf): http_gzip_support=on
2012-03-18 21:06:37 [1, 0]: memleak(httperf): Payload size (excludes headers): 512
2012-03-18 21:06:37 [1, 0]: memleak(httperf): Branch: master
2012-03-18 21:06:37 [1, 0]: memleak(httperf): Number of clients involved: 24
2012-03-18 21:06:37 [1, 0]: memleak(httperf): Type of test: httperf
2012-03-18 21:06:37 [1, 0]: memleak(httperf): Test iterations: 1
2012-03-18 21:06:37 [1, 0]: memleak(httperf): Runtime: 718 seconds
2012-03-18 21:06:37 [1, 0]: memleak(httperf): VCL:
backend foo {
.host = "localhost";
.port = "80";
}
sub vcl_fetch {
set beresp.do_stream = true;
}
2012-03-18 21:06:37 [1, 0]: memleak(httperf): Number of total connections: 2000
2012-03-18 21:06:37 [1, 0]: memleak(httperf): Note: connections are subject to rounding when divided among clients. Expect slight deviations.
2012-03-18 21:06:37 [1, 0]: memleak(httperf): Requests per connection: 5000
2012-03-18 21:06:37 [1, 0]: memleak(httperf): Extra options to httperf: --wset=100,0.10
2012-03-18 21:06:37 [1, 0]: memleak(httperf): Httperf command (last client): httperf --hog --timeout 60 --num-calls 5000 --num-conns 83 --port 8080 --burst-length 5000 --client 23/24 --server 10.20.100.4 --wset=100,0.10
2012-03-18 21:06:45 [2, 7]: 4gpluss-stream(httperf): Starting test
2012-03-18 21:06:48 WARNING [0, 3]: Varnish failed to start. Fallback attempts starting
2012-03-18 21:06:48 [1, 0]: Removed (hopefully incompatible) parameter to try to start varnish. Key: thread_pool_add_delay=1
2012-03-18 21:06:49 [1, 0]: Removed (hopefully incompatible) parameter to try to start varnish. Key: sess_timeout=60000s
2012-03-18 21:06:50 [1, 1]: Fallback worked. Parameter that seemed to cause problems: sess_timeout
2012-03-18 21:28:05 [2,1275]: httperf-lru-stream-default(httperf): Starting test
2012-03-18 21:34:05 WARNING [0,360]: httperf-lru-stream-default(httperf): Panic detected. I think!
2012-03-18 21:34:05 WARNING [0, 0]: httperf-lru-stream-default(httperf):
Last panic at: Sun, 18 Mar 2012 21:30:39 GMT
Assert error in EXP_Insert(), cache/cache_expire.c line 226:
Condition((oc)->magic == 0x4d301302) not true.
thread = (cache-worker)
ident = Linux,2.6.32-39-server,x86_64,-smalloc,-smalloc,-hcritbit,epoll
Backtrace:
0x431a88: pan_ic+d8
0x42419e: EXP_Insert+7e
0x42522b: FetchBody+53b
0x433272: Pool_Work_Thread+112
0x4404b8: wrk_thread_real+c8
0x7f297d11a9ca: _end+7f297ca97212
0x7f297ce77cdd: _end+7f297c7f4525
2012-03-18 21:34:05 [1, 0]: httperf-lru-stream-default(httperf): Varnishstat uptime and measured run-time is too large (measured: 353 stat: 205 diff: 148). Did we crash?
2012-03-18 21:34:06 WARNING [0, 0]: httperf-lru-stream-default(httperf): Out of bounds: n_lru_nuked(64903) less than lower boundary 80000
2012-03-18 21:34:06 WARNING [0, 0]: httperf-lru-stream-default(httperf): Out of bounds: client_req(966074) less than lower boundary 1999720
2012-03-18 21:34:06 [1, 0]: httperf-lru-stream-default(httperf): Load: 22:34:06 up 6 days, 10:20, 0 users, load average: 4.00, 6.04, 6.14
2012-03-18 21:34:06 [1, 0]: httperf-lru-stream-default(httperf): Test name: httperf-lru-stream-default
2012-03-18 21:34:06 [1, 0]: httperf-lru-stream-default(httperf): Varnish options:
2012-03-18 21:34:06 [1, 0]: httperf-lru-stream-default(httperf): -t=3600
2012-03-18 21:34:06 [1, 0]: httperf-lru-stream-default(httperf): -w=200,5000
2012-03-18 21:34:06 [1, 0]: httperf-lru-stream-default(httperf): -s=malloc,30M
2012-03-18 21:34:06 [1, 0]: httperf-lru-stream-default(httperf): Varnish parameters:
2012-03-18 21:34:06 [1, 0]: httperf-lru-stream-default(httperf): nuke_limit=250
2012-03-18 21:34:06 [1, 0]: httperf-lru-stream-default(httperf): Payload size (excludes headers): 10K
2012-03-18 21:34:06 [1, 0]: httperf-lru-stream-default(httperf): Branch: master
2012-03-18 21:34:06 [1, 0]: httperf-lru-stream-default(httperf): Number of clients involved: 24
2012-03-18 21:34:06 [1, 0]: httperf-lru-stream-default(httperf): Type of test: httperf
2012-03-18 21:34:06 [1, 0]: httperf-lru-stream-default(httperf): Test iterations: 1
2012-03-18 21:34:06 [1, 0]: httperf-lru-stream-default(httperf): Runtime: 353 seconds
2012-03-18 21:34:06 [1, 0]: httperf-lru-stream-default(httperf): VCL:
backend foo {
.host = "localhost";
.port = "80";
}
sub vcl_fetch {
set beresp.do_stream = true;
}
2012-03-18 21:34:06 [1, 0]: httperf-lru-stream-default(httperf): Number of total connections: 200000
2012-03-18 21:34:06 [1, 0]: httperf-lru-stream-default(httperf): Note: connections are subject to rounding when divided among clients. Expect slight deviations.
2012-03-18 21:34:06 [1, 0]: httperf-lru-stream-default(httperf): Requests per connection: 10
2012-03-18 21:34:06 [1, 0]: httperf-lru-stream-default(httperf): Extra options to httperf: --wset=1000000,0.1
2012-03-18 21:34:06 [1, 0]: httperf-lru-stream-default(httperf): Httperf command (last client): httperf --hog --timeout 60 --num-calls 10 --num-conns 8333 --port 8080 --burst-length 10 --client 23/24 --server 10.20.100.4 --wset=1000000,0.1
2012-03-18 21:34:14 [2, 7]: httperf-hot(httperf): Starting test
2012-03-18 21:36:15 [2,121]: httperf-lru-nostream-nogzip(httperf): Starting test
2012-03-18 21:41:39 WARNING [0,323]: httperf-lru-nostream-nogzip(httperf): Panic detected. I think!
2012-03-18 21:41:39 WARNING [0, 0]: httperf-lru-nostream-nogzip(httperf):
Last panic at: Sun, 18 Mar 2012 21:39:41 GMT
Assert error in FetchBody(), cache/cache_fetch.c line 671:
Condition(uu == obj->len) not true.
thread = (cache-worker)
ident = Linux,2.6.32-39-server,x86_64,-smalloc,-smalloc,-hcritbit,epoll
Backtrace:
0x431a88: pan_ic+d8
0x42547d: FetchBody+78d
0x433272: Pool_Work_Thread+112
0x4404b8: wrk_thread_real+c8
0x7f39280ea9ca: _end+7f3927a67212
0x7f3927e47cdd: _end+7f39277c4525
2012-03-18 21:41:39 [1, 0]: httperf-lru-nostream-nogzip(httperf): Varnishstat uptime and measured run-time is too large (measured: 317 stat: 116 diff: 201). Did we crash?
2012-03-18 21:41:39 WARNING [0, 0]: httperf-lru-nostream-nogzip(httperf): Out of bounds: n_lru_nuked(26845) less than lower boundary 80000
2012-03-18 21:41:39 WARNING [0, 0]: httperf-lru-nostream-nogzip(httperf): Out of bounds: client_req(296722) less than lower boundary 1999720
2012-03-18 21:41:39 [1, 0]: httperf-lru-nostream-nogzip(httperf): Load: 22:41:39 up 6 days, 10:27, 0 users, load average: 1.26, 5.18, 6.28
2012-03-18 21:41:39 [1, 0]: httperf-lru-nostream-nogzip(httperf): Test name: httperf-lru-nostream-nogzip
2012-03-18 21:41:39 [1, 0]: httperf-lru-nostream-nogzip(httperf): Varnish options:
2012-03-18 21:41:39 [1, 0]: httperf-lru-nostream-nogzip(httperf): -t=3600
2012-03-18 21:41:39 [1, 0]: httperf-lru-nostream-nogzip(httperf): -w=200,5000
2012-03-18 21:41:39 [1, 0]: httperf-lru-nostream-nogzip(httperf): -s=malloc,30M
2012-03-18 21:41:39 [1, 0]: httperf-lru-nostream-nogzip(httperf): Varnish parameters:
2012-03-18 21:41:39 [1, 0]: httperf-lru-nostream-nogzip(httperf): nuke_limit=250
2012-03-18 21:41:39 [1, 0]: httperf-lru-nostream-nogzip(httperf): http_gzip_support=off
2012-03-18 21:41:39 [1, 0]: httperf-lru-nostream-nogzip(httperf): Payload size (excludes headers): 10K
2012-03-18 21:41:39 [1, 0]: httperf-lru-nostream-nogzip(httperf): Branch: master
2012-03-18 21:41:39 [1, 0]: httperf-lru-nostream-nogzip(httperf): Number of clients involved: 24
2012-03-18 21:41:39 [1, 0]: httperf-lru-nostream-nogzip(httperf): Type of test: httperf
2012-03-18 21:41:39 [1, 0]: httperf-lru-nostream-nogzip(httperf): Test iterations: 1
2012-03-18 21:41:39 [1, 0]: httperf-lru-nostream-nogzip(httperf): Runtime: 317 seconds
2012-03-18 21:41:39 [1, 0]: httperf-lru-nostream-nogzip(httperf): VCL:
backend foo {
.host = "localhost";
.port = "80";
}
sub vcl_fetch {
set beresp.do_stream = false;
}
2012-03-18 21:41:39 [1, 0]: httperf-lru-nostream-nogzip(httperf): Number of total connections: 200000
2012-03-18 21:41:39 [1, 0]: httperf-lru-nostream-nogzip(httperf): Note: connections are subject to rounding when divided among clients. Expect slight deviations.
2012-03-18 21:41:39 [1, 0]: httperf-lru-nostream-nogzip(httperf): Requests per connection: 10
2012-03-18 21:41:39 [1, 0]: httperf-lru-nostream-nogzip(httperf): Extra options to httperf: --wset=1000000,0.1
2012-03-18 21:41:39 [1, 0]: httperf-lru-nostream-nogzip(httperf): Httperf command (last client): httperf --hog --timeout 60 --num-calls 10 --num-conns 8333 --port 8080 --burst-length 10 --client 23/24 --server 10.20.100.4 --wset=1000000,0.1
2012-03-18 21:41:47 [2, 7]: cold-gzip(httperf): Starting test
2012-03-18 21:45:48 WARNING [0,240]: cold-gzip(httperf): Panic detected. I think!
2012-03-18 21:45:48 WARNING [0, 0]: cold-gzip(httperf):
Last panic at: Sun, 18 Mar 2012 21:44:17 GMT
Assert error in EXP_Insert(), cache/cache_expire.c line 226:
Condition((oc)->magic == 0x4d301302) not true.
thread = (cache-worker)
ident = Linux,2.6.32-39-server,x86_64,-smalloc,-smalloc,-hcritbit,epoll
Backtrace:
0x431a88: pan_ic+d8
0x42419e: EXP_Insert+7e
0x42522b: FetchBody+53b
0x433272: Pool_Work_Thread+112
0x4404b8: wrk_thread_real+c8
0x7f9dc69889ca: _end+7f9dc6305212
0x7f9dc66e5cdd: _end+7f9dc6062525
2012-03-18 21:45:48 [1, 0]: cold-gzip(httperf): Varnishstat uptime and measured run-time is too large (measured: 235 stat: 89 diff: 146). Did we crash?
2012-03-18 21:50:19 WARNING [0,271]: cold-gzip(httperf): Panic detected. I think!
2012-03-18 21:50:19 WARNING [0, 0]: cold-gzip(httperf):
Last panic at: Sun, 18 Mar 2012 21:48:25 GMT
Assert error in AssertOCBusy(), cache/cache.h line 1091:
Condition((oc->flags & (1<<1)) != 0) not true.
thread = (cache-worker)
ident = Linux,2.6.32-39-server,x86_64,-smalloc,-smalloc,-hcritbit,epoll
Backtrace:
0x431a88: pan_ic+d8
0x4243ad: EXP_Insert+28d
0x42522b: FetchBody+53b
0x433272: Pool_Work_Thread+112
0x4404b8: wrk_thread_real+c8
0x7f9dc69889ca: _end+7f9dc6305212
0x7f9dc66e5cdd: _end+7f9dc6062525
2012-03-18 21:50:19 [1, 0]: cold-gzip(httperf): Varnishstat uptime and measured run-time is too large (measured: 504 stat: 113 diff: 391). Did we crash?
2012-03-18 21:50:20 WARNING [0, 0]: cold-gzip(httperf): Out of bounds: client_req(265253) less than lower boundary 1599640
2012-03-18 21:50:20 [1, 0]: cold-gzip(httperf): Load: 22:50:20 up 6 days, 10:36, 0 users, load average: 1.36, 2.23, 4.24
2012-03-18 21:50:20 [1, 0]: cold-gzip(httperf): Test name: cold-gzip
2012-03-18 21:50:20 [1, 0]: cold-gzip(httperf): Varnish options:
2012-03-18 21:50:20 [1, 0]: cold-gzip(httperf): -t=3600
2012-03-18 21:50:20 [1, 0]: cold-gzip(httperf): -s=malloc,10G
2012-03-18 21:50:20 [1, 0]: cold-gzip(httperf): Varnish parameters:
2012-03-18 21:50:20 [1, 0]: cold-gzip(httperf): http_gzip_support=on
2012-03-18 21:50:20 [1, 0]: cold-gzip(httperf): Payload size (excludes headers): 256
2012-03-18 21:50:20 [1, 0]: cold-gzip(httperf): Branch: master
2012-03-18 21:50:20 [1, 0]: cold-gzip(httperf): Number of clients involved: 24
2012-03-18 21:50:20 [1, 0]: cold-gzip(httperf): Type of test: httperf
2012-03-18 21:50:20 [1, 0]: cold-gzip(httperf): Test iterations: 2
2012-03-18 21:50:20 [1, 0]: cold-gzip(httperf): Runtime: 504 seconds
2012-03-18 21:50:20 [1, 0]: cold-gzip(httperf): VCL:
backend foo {
.host = "localhost";
.port = "80";
}
sub vcl_fetch {
set beresp.do_stream = true;
}
2012-03-18 21:50:20 [1, 0]: cold-gzip(httperf): Number of total connections: 80000
2012-03-18 21:50:20 [1, 0]: cold-gzip(httperf): Note: connections are subject to rounding when divided among clients. Expect slight deviations.
2012-03-18 21:50:20 [1, 0]: cold-gzip(httperf): Requests per connection: 10
2012-03-18 21:50:20 [1, 0]: cold-gzip(httperf): Extra options to httperf: --wset=4000000,0.50
2012-03-18 21:50:20 [1, 0]: cold-gzip(httperf): Httperf command (last client): httperf --hog --timeout 60 --num-calls 10 --num-conns 3333 --port 8080 --burst-length 10 --client 23/24 --server 10.20.100.4 --wset=4000000,0.50
2012-03-18 21:50:28 [2, 7]: 4gpluss(httperf): Starting test
2012-03-18 21:50:32 WARNING [0, 3]: Varnish failed to start. Fallback attempts starting
2012-03-18 21:50:32 [1, 0]: Removed (hopefully incompatible) parameter to try to start varnish. Key: thread_pool_add_delay=1
2012-03-18 21:50:32 [1, 0]: Removed (hopefully incompatible) parameter to try to start varnish. Key: sess_timeout=60000s
2012-03-18 21:50:33 [1, 1]: Fallback worked. Parameter that seemed to cause problems: sess_timeout
2012-03-18 22:11:02 [2,1229]: httperf-lru-stream-gzip(httperf): Starting test
2012-03-18 22:17:08 WARNING [0,365]: httperf-lru-stream-gzip(httperf): Panic detected. I think!
2012-03-18 22:17:08 WARNING [0, 0]: httperf-lru-stream-gzip(httperf):
Last panic at: Sun, 18 Mar 2012 22:14:47 GMT
Assert error in EXP_Insert(), cache/cache_expire.c line 226:
Condition((oc)->magic == 0x4d301302) not true.
thread = (cache-worker)
ident = Linux,2.6.32-39-server,x86_64,-smalloc,-smalloc,-hcritbit,epoll
Backtrace:
0x431a88: pan_ic+d8
0x42419e: EXP_Insert+7e
0x42522b: FetchBody+53b
0x433272: Pool_Work_Thread+112
0x4404b8: wrk_thread_real+c8
0x7f2fc22c49ca: _end+7f2fc1c41212
0x7f2fc2021cdd: _end+7f2fc199e525
2012-03-18 22:17:08 [1, 0]: httperf-lru-stream-gzip(httperf): Varnishstat uptime and measured run-time is too large (measured: 356 stat: 139 diff: 217). Did we crash?
2012-03-18 22:17:08 WARNING [0, 0]: httperf-lru-stream-gzip(httperf): Out of bounds: n_lru_nuked(24845) less than lower boundary 80000
2012-03-18 22:17:08 WARNING [0, 0]: httperf-lru-stream-gzip(httperf): Out of bounds: client_req(565835) less than lower boundary 1999720
2012-03-18 22:17:08 [1, 0]: httperf-lru-stream-gzip(httperf): Load: 23:17:08 up 6 days, 11:03, 0 users, load average: 4.95, 6.64, 4.50
2012-03-18 22:17:08 [1, 0]: httperf-lru-stream-gzip(httperf): Test name: httperf-lru-stream-gzip
2012-03-18 22:17:08 [1, 0]: httperf-lru-stream-gzip(httperf): Varnish options:
2012-03-18 22:17:08 [1, 0]: httperf-lru-stream-gzip(httperf): -t=3600
2012-03-18 22:17:08 [1, 0]: httperf-lru-stream-gzip(httperf): -w=200,5000
2012-03-18 22:17:08 [1, 0]: httperf-lru-stream-gzip(httperf): -s=malloc,30M
2012-03-18 22:17:08 [1, 0]: httperf-lru-stream-gzip(httperf): Varnish parameters:
2012-03-18 22:17:08 [1, 0]: httperf-lru-stream-gzip(httperf): nuke_limit=250
2012-03-18 22:17:08 [1, 0]: httperf-lru-stream-gzip(httperf): http_gzip_support=on
2012-03-18 22:17:08 [1, 0]: httperf-lru-stream-gzip(httperf): Payload size (excludes headers): 10K
2012-03-18 22:17:08 [1, 0]: httperf-lru-stream-gzip(httperf): Branch: master
2012-03-18 22:17:08 [1, 0]: httperf-lru-stream-gzip(httperf): Number of clients involved: 24
2012-03-18 22:17:08 [1, 0]: httperf-lru-stream-gzip(httperf): Type of test: httperf
2012-03-18 22:17:08 [1, 0]: httperf-lru-stream-gzip(httperf): Test iterations: 1
2012-03-18 22:17:08 [1, 0]: httperf-lru-stream-gzip(httperf): Runtime: 356 seconds
2012-03-18 22:17:08 [1, 0]: httperf-lru-stream-gzip(httperf): VCL:
backend foo {
.host = "localhost";
.port = "80";
}
sub vcl_fetch {
set beresp.do_stream = true;
}
2012-03-18 22:17:08 [1, 0]: httperf-lru-stream-gzip(httperf): Number of total connections: 200000
2012-03-18 22:17:08 [1, 0]: httperf-lru-stream-gzip(httperf): Note: connections are subject to rounding when divided among clients. Expect slight deviations.
2012-03-18 22:17:08 [1, 0]: httperf-lru-stream-gzip(httperf): Requests per connection: 10
2012-03-18 22:17:08 [1, 0]: httperf-lru-stream-gzip(httperf): Extra options to httperf: --wset=1000000,0.1
2012-03-18 22:17:08 [1, 0]: httperf-lru-stream-gzip(httperf): Httperf command (last client): httperf --hog --timeout 60 --num-calls 10 --num-conns 8333 --port 8080 --burst-length 10 --client 23/24 --server 10.20.100.4 --wset=1000000,0.1
2012-03-18 22:17:16 [2, 7]: httperf-lru-stream-nogzip(httperf): Starting test
2012-03-18 22:22:05 WARNING [0,289]: httperf-lru-stream-nogzip(httperf): Panic detected. I think!
2012-03-18 22:22:05 WARNING [0, 0]: httperf-lru-stream-nogzip(httperf):
Last panic at: Sun, 18 Mar 2012 22:21:05 GMT
Assert error in EXP_Insert(), cache/cache_expire.c line 226:
Condition((oc)->magic == 0x4d301302) not true.
thread = (cache-worker)
ident = Linux,2.6.32-39-server,x86_64,-smalloc,-smalloc,-hcritbit,epoll
Backtrace:
0x431a88: pan_ic+d8
0x42419e: EXP_Insert+7e
0x42522b: FetchBody+53b
0x433272: Pool_Work_Thread+112
0x4404b8: wrk_thread_real+c8
0x7f2f143209ca: _end+7f2f13c9d212
0x7f2f1407dcdd: _end+7f2f139fa525
2012-03-18 22:22:05 [1, 0]: httperf-lru-stream-nogzip(httperf): Varnishstat uptime and measured run-time is too large (measured: 283 stat: 59 diff: 224). Did we crash?
2012-03-18 22:22:06 WARNING [0, 0]: httperf-lru-stream-nogzip(httperf): Out of bounds: n_lru_nuked(10161) less than lower boundary 80000
2012-03-18 22:22:06 WARNING [0, 0]: httperf-lru-stream-nogzip(httperf): Out of bounds: client_req(130105) less than lower boundary 1999720
2012-03-18 22:22:06 [1, 0]: httperf-lru-stream-nogzip(httperf): Load: 23:22:06 up 6 days, 11:08, 0 users, load average: 1.51, 4.28, 4.16
2012-03-18 22:22:06 [1, 0]: httperf-lru-stream-nogzip(httperf): Test name: httperf-lru-stream-nogzip
2012-03-18 22:22:06 [1, 0]: httperf-lru-stream-nogzip(httperf): Varnish options:
2012-03-18 22:22:06 [1, 0]: httperf-lru-stream-nogzip(httperf): -t=3600
2012-03-18 22:22:06 [1, 0]: httperf-lru-stream-nogzip(httperf): -w=200,5000
2012-03-18 22:22:06 [1, 0]: httperf-lru-stream-nogzip(httperf): -s=malloc,30M
2012-03-18 22:22:06 [1, 0]: httperf-lru-stream-nogzip(httperf): Varnish parameters:
2012-03-18 22:22:06 [1, 0]: httperf-lru-stream-nogzip(httperf): nuke_limit=250
2012-03-18 22:22:06 [1, 0]: httperf-lru-stream-nogzip(httperf): http_gzip_support=off
2012-03-18 22:22:06 [1, 0]: httperf-lru-stream-nogzip(httperf): Payload size (excludes headers): 10K
2012-03-18 22:22:06 [1, 0]: httperf-lru-stream-nogzip(httperf): Branch: master
2012-03-18 22:22:06 [1, 0]: httperf-lru-stream-nogzip(httperf): Number of clients involved: 24
2012-03-18 22:22:06 [1, 0]: httperf-lru-stream-nogzip(httperf): Type of test: httperf
2012-03-18 22:22:06 [1, 0]: httperf-lru-stream-nogzip(httperf): Test iterations: 1
2012-03-18 22:22:06 [1, 0]: httperf-lru-stream-nogzip(httperf): Runtime: 283 seconds
2012-03-18 22:22:06 [1, 0]: httperf-lru-stream-nogzip(httperf): VCL:
backend foo {
.host = "localhost";
.port = "80";
}
sub vcl_fetch {
set beresp.do_stream = true;
}
2012-03-18 22:22:06 [1, 0]: httperf-lru-stream-nogzip(httperf): Number of total connections: 200000
2012-03-18 22:22:06 [1, 0]: httperf-lru-stream-nogzip(httperf): Note: connections are subject to rounding when divided among clients. Expect slight deviations.
2012-03-18 22:22:06 [1, 0]: httperf-lru-stream-nogzip(httperf): Requests per connection: 10
2012-03-18 22:22:06 [1, 0]: httperf-lru-stream-nogzip(httperf): Extra options to httperf: --wset=1000000,0.1
2012-03-18 22:22:06 [1, 0]: httperf-lru-stream-nogzip(httperf): Httperf command (last client): httperf --hog --timeout 60 --num-calls 10 --num-conns 8333 --port 8080 --burst-length 10 --client 23/24 --server 10.20.100.4 --wset=1000000,0.1
2012-03-18 22:22:14 [2, 7]: basic-fryer(httperf): Starting test
2012-03-18 22:22:30 [2,15]: cold-nogzip(httperf): Starting test
2012-03-18 22:26:39 WARNING [0,249]: cold-nogzip(httperf): Panic detected. I think!
2012-03-18 22:26:39 WARNING [0, 0]: cold-nogzip(httperf):
Last panic at: Sun, 18 Mar 2012 22:25:57 GMT
Assert error in EXP_Insert(), cache/cache_expire.c line 226:
Condition((oc)->magic == 0x4d301302) not true.
thread = (cache-worker)
ident = Linux,2.6.32-39-server,x86_64,-smalloc,-smalloc,-hcritbit,epoll
Backtrace:
0x431a88: pan_ic+d8
0x42419e: EXP_Insert+7e
0x42522b: FetchBody+53b
0x433272: Pool_Work_Thread+112
0x4404b8: wrk_thread_real+c8
0x7f8415dc29ca: _end+7f841573f212
0x7f8415b1fcdd: _end+7f841549c525
2012-03-18 22:26:39 [1, 0]: cold-nogzip(httperf): Varnishstat uptime and measured run-time is too large (measured: 244 stat: 40 diff: 204). Did we crash?
2012-03-18 22:30:29 WARNING [0,230]: cold-nogzip(httperf): Panic detected. I think!
2012-03-18 22:30:29 WARNING [0, 0]: cold-nogzip(httperf):
Last panic at: Sun, 18 Mar 2012 22:29:22 GMT
Assert error in EXP_Insert(), cache/cache_expire.c line 226:
Condition((oc)->magic == 0x4d301302) not true.
thread = (cache-worker)
ident = Linux,2.6.32-39-server,x86_64,-smalloc,-smalloc,-hcritbit,epoll
Backtrace:
0x431a88: pan_ic+d8
0x42419e: EXP_Insert+7e
0x42522b: FetchBody+53b
0x433272: Pool_Work_Thread+112
0x4404b8: wrk_thread_real+c8
0x7f8415dc29ca: _end+7f841573f212
0x7f8415b1fcdd: _end+7f841549c525
2012-03-18 22:30:29 [1, 0]: cold-nogzip(httperf): Varnishstat uptime and measured run-time is too large (measured: 474 stat: 65 diff: 409). Did we crash?
2012-03-18 22:30:30 WARNING [0, 0]: cold-nogzip(httperf): Out of bounds: uptime(65) less than lower boundary 100
2012-03-18 22:30:30 WARNING [0, 0]: cold-nogzip(httperf): Out of bounds: client_req(87790) less than lower boundary 1599640
2012-03-18 22:30:30 [1, 0]: cold-nogzip(httperf): Load: 23:30:30 up 6 days, 11:16, 0 users, load average: 0.72, 1.61, 2.85
2012-03-18 22:30:30 [1, 0]: cold-nogzip(httperf): Test name: cold-nogzip
2012-03-18 22:30:30 [1, 0]: cold-nogzip(httperf): Varnish options:
2012-03-18 22:30:30 [1, 0]: cold-nogzip(httperf): -t=3600
2012-03-18 22:30:30 [1, 0]: cold-nogzip(httperf): -s=malloc,10G
2012-03-18 22:30:30 [1, 0]: cold-nogzip(httperf): Varnish parameters:
2012-03-18 22:30:30 [1, 0]: cold-nogzip(httperf): http_gzip_support=off
2012-03-18 22:30:30 [1, 0]: cold-nogzip(httperf): Payload size (excludes headers): 256
2012-03-18 22:30:30 [1, 0]: cold-nogzip(httperf): Branch: master
2012-03-18 22:30:30 [1, 0]: cold-nogzip(httperf): Number of clients involved: 24
2012-03-18 22:30:30 [1, 0]: cold-nogzip(httperf): Type of test: httperf
2012-03-18 22:30:30 [1, 0]: cold-nogzip(httperf): Test iterations: 2
2012-03-18 22:30:30 [1, 0]: cold-nogzip(httperf): Runtime: 474 seconds
2012-03-18 22:30:30 [1, 0]: cold-nogzip(httperf): VCL:
backend foo {
.host = "localhost";
.port = "80";
}
sub vcl_fetch {
set beresp.do_stream = true;
}
2012-03-18 22:30:30 [1, 0]: cold-nogzip(httperf): Number of total connections: 80000
2012-03-18 22:30:30 [1, 0]: cold-nogzip(httperf): Note: connections are subject to rounding when divided among clients. Expect slight deviations.
2012-03-18 22:30:30 [1, 0]: cold-nogzip(httperf): Requests per connection: 10
2012-03-18 22:30:30 [1, 0]: cold-nogzip(httperf): Extra options to httperf: --wset=4000000,0.50
2012-03-18 22:30:30 [1, 0]: cold-nogzip(httperf): Httperf command (last client): httperf --hog --timeout 60 --num-calls 10 --num-conns 3333 --port 8080 --burst-length 10 --client 23/24 --server 10.20.100.4 --wset=4000000,0.50
2012-03-18 22:30:38 [2, 7]: 4gpluss-nostream(httperf): Starting test
2012-03-18 22:30:42 WARNING [0, 3]: Varnish failed to start. Fallback attempts starting
2012-03-18 22:30:42 [1, 0]: Removed (hopefully incompatible) parameter to try to start varnish. Key: thread_pool_add_delay=1
2012-03-18 22:30:42 [1, 0]: Removed (hopefully incompatible) parameter to try to start varnish. Key: sess_timeout=60000s
2012-03-18 22:30:43 [1, 1]: Fallback worked. Parameter that seemed to cause problems: sess_timeout
2012-03-18 22:51:23 [2,1239]: lru-random(httperf): Starting test
2012-03-18 22:51:57 WARNING [0,33]: lru-random(httperf): Out of bounds: n_lru_nuked(0) less than lower boundary 3000
2012-03-18 22:51:57 WARNING [0, 0]: lru-random(httperf): Out of bounds: cache_hitpass(22437) more than upper boundary 0
2012-03-18 22:51:57 [1, 0]: lru-random(httperf): Load: 23:51:57 up 6 days, 11:38, 0 users, load average: 0.94, 1.29, 1.71
2012-03-18 22:51:57 [1, 0]: lru-random(httperf): Test name: lru-random
2012-03-18 22:51:57 [1, 0]: lru-random(httperf): Varnish options:
2012-03-18 22:51:57 [1, 0]: lru-random(httperf): -t=3600000
2012-03-18 22:51:57 [1, 0]: lru-random(httperf): -s=malloc,1G
2012-03-18 22:51:57 [1, 0]: lru-random(httperf): Varnish parameters:
2012-03-18 22:51:57 [1, 0]: lru-random(httperf): Payload size (excludes headers): 256
2012-03-18 22:51:57 [1, 0]: lru-random(httperf): Branch: master
2012-03-18 22:51:57 [1, 0]: lru-random(httperf): Number of clients involved: 24
2012-03-18 22:51:57 [1, 0]: lru-random(httperf): Type of test: httperf
2012-03-18 22:51:57 [1, 0]: lru-random(httperf): Test iterations: 1
2012-03-18 22:51:57 [1, 0]: lru-random(httperf): Runtime: 27 seconds
2012-03-18 22:51:57 [1, 0]: lru-random(httperf): VCL:
backend foo {
.host = "localhost";
.port = "80";
}
sub vcl_fetch {
set beresp.do_stream = false;
// set beresp.do_gzip = true;
}
2012-03-18 22:51:57 [1, 0]: lru-random(httperf): Number of total connections: 10000
2012-03-18 22:51:57 [1, 0]: lru-random(httperf): Note: connections are subject to rounding when divided among clients. Expect slight deviations.
2012-03-18 22:51:57 [1, 0]: lru-random(httperf): Requests per connection: 3
2012-03-18 22:51:57 [1, 0]: lru-random(httperf): Extra options to httperf: --wset=100000,0.25
2012-03-18 22:51:57 [1, 0]: lru-random(httperf): Httperf command (last client): httperf --hog --timeout 60 --num-calls 3 --num-conns 416 --port 8080 --burst-length 3 --client 23/24 --server 10.20.100.4 --wset=100000,0.25
2012-03-18 22:52:05 [2, 7]: siege-test(siege): Starting test
2012-03-18 22:53:19 [2,74]: sky-misc(httperf): Starting test
2012-03-18 22:59:58 [2,398]: httperf-lru-nostream-default(httperf): Starting test
2012-03-18 23:05:56 WARNING [0,358]: httperf-lru-nostream-default(httperf): Panic detected. I think!
2012-03-18 23:05:56 WARNING [0, 0]: httperf-lru-nostream-default(httperf):
Last panic at: Sun, 18 Mar 2012 23:04:36 GMT
Assert error in HSH_Ref(), cache/cache_hash.c line 616:
Condition(oc->refcnt > 0) not true.
thread = (cache-worker)
ident = Linux,2.6.32-39-server,x86_64,-smalloc,-smalloc,-hcritbit,epoll
Backtrace:
0x431a88: pan_ic+d8
0x428185: HSH_Ref+e5
0x4241bb: EXP_Insert+9b
0x42522b: FetchBody+53b
0x433272: Pool_Work_Thread+112
0x4404b8: wrk_thread_real+c8
0x7fe0bd6f79ca: _end+7fe0bd074212
0x7fe0bd454cdd: _end+7fe0bcdd1525
2012-03-18 23:05:56 [1, 0]: httperf-lru-nostream-default(httperf): Varnishstat uptime and measured run-time is too large (measured: 352 stat: 78 diff: 274). Did we crash?
2012-03-18 23:05:56 WARNING [0, 0]: httperf-lru-nostream-default(httperf): Out of bounds: n_lru_nuked(0) less than lower boundary 80000
2012-03-18 23:05:56 WARNING [0, 0]: httperf-lru-nostream-default(httperf): Out of bounds: client_req(216384) less than lower boundary 1999720
2012-03-18 23:05:57 [1, 0]: httperf-lru-nostream-default(httperf): Load: 00:05:57 up 6 days, 11:52, 0 users, load average: 5.24, 10.95, 9.16
2012-03-18 23:05:57 [1, 0]: httperf-lru-nostream-default(httperf): Test name: httperf-lru-nostream-default
2012-03-18 23:05:57 [1, 0]: httperf-lru-nostream-default(httperf): Varnish options:
2012-03-18 23:05:57 [1, 0]: httperf-lru-nostream-default(httperf): -t=3600
2012-03-18 23:05:57 [1, 0]: httperf-lru-nostream-default(httperf): -w=200,5000
2012-03-18 23:05:57 [1, 0]: httperf-lru-nostream-default(httperf): -s=malloc,30M
2012-03-18 23:05:57 [1, 0]: httperf-lru-nostream-default(httperf): Varnish parameters:
2012-03-18 23:05:57 [1, 0]: httperf-lru-nostream-default(httperf): nuke_limit=250
2012-03-18 23:05:57 [1, 0]: httperf-lru-nostream-default(httperf): Payload size (excludes headers): 10K
2012-03-18 23:05:57 [1, 0]: httperf-lru-nostream-default(httperf): Branch: master
2012-03-18 23:05:57 [1, 0]: httperf-lru-nostream-default(httperf): Number of clients involved: 24
2012-03-18 23:05:57 [1, 0]: httperf-lru-nostream-default(httperf): Type of test: httperf
2012-03-18 23:05:57 [1, 0]: httperf-lru-nostream-default(httperf): Test iterations: 1
2012-03-18 23:05:57 [1, 0]: httperf-lru-nostream-default(httperf): Runtime: 352 seconds
2012-03-18 23:05:57 [1, 0]: httperf-lru-nostream-default(httperf): VCL:
backend foo {
.host = "localhost";
.port = "80";
}
sub vcl_fetch {
set beresp.do_stream = false;
}
2012-03-18 23:05:57 [1, 0]: httperf-lru-nostream-default(httperf): Number of total connections: 200000
2012-03-18 23:05:57 [1, 0]: httperf-lru-nostream-default(httperf): Note: connections are subject to rounding when divided among clients. Expect slight deviations.
2012-03-18 23:05:57 [1, 0]: httperf-lru-nostream-default(httperf): Requests per connection: 10
2012-03-18 23:05:57 [1, 0]: httperf-lru-nostream-default(httperf): Extra options to httperf: --wset=1000000,0.1
2012-03-18 23:05:57 [1, 0]: httperf-lru-nostream-default(httperf): Httperf command (last client): httperf --hog --timeout 60 --num-calls 10 --num-conns 8333 --port 8080 --burst-length 10 --client 23/24 --server 10.20.100.4 --wset=1000000,0.1
2012-03-18 23:06:04 [2, 7]: httperf-rapid-expire(httperf): Starting test
2012-03-18 23:07:49 WARNING [0,104]: httperf-rapid-expire(httperf): Panic detected. I think!
2012-03-18 23:07:49 WARNING [0, 0]: httperf-rapid-expire(httperf):
Last panic at: Sun, 18 Mar 2012 23:07:02 GMT
Assert error in HSH_Lookup(), cache/cache_hash.c line 336:
Condition((oc->busyobj) != NULL) not true.
thread = (cache-worker)
ident = Linux,2.6.32-39-server,x86_64,-smalloc,-smalloc,-hcritbit,epoll
Backtrace:
0x431a88: pan_ic+d8
0x42a42d: HSH_Lookup+89d
0x416ce7: cnt_lookup+1c7
0x41a97d: CNT_Session+4ed
0x43639d: ses_pool_task+fd
0x433272: Pool_Work_Thread+112
0x4404b8: wrk_thread_real+c8
0x7f53d7bb29ca: _end+7f53d752f212
0x7f53d790fcdd: _end+7f53d728c525
sp = 0x7f53c9004920 {
fd = 36, id = 36, xid = 754731255,
client = 10.20.100.8 6175,
step = STP_LOOKUP,
handling = hash,
restarts = 0, esi_level = 0
ws = 0x7f53c8e68150 {
id = "req",
{s,f,r,e} = {0x7f53c8e69728,+120,+59640,+59640},
},
http[req] = {
ws = 0x7f53c8e68150[req]
"GET",
"/3/4.html",
"HTTP/1.1",
"User-Agent: httperf/0.9.0",
"Host: 10.20.100.4",
"X-Forwarded-For: 10.20.100.8",
},
worker = 0x7f53cecf7c60 {
ws = 0x7f53cecf7e20 {
id = "wrk",
{s,f,r,e} = {0x7f53cecf7450,0x7f53cecf7450,(nil),+2048},
},
},
vcl = {
srcname = {
"input",
"Default",
},
},
},
2012-03-18 23:07:49 [1, 0]: httperf-rapid-expire(httperf): Varnishstat uptime and measured run-time is too large (measured: 99 stat: 46 diff: 53). Did we crash?
2012-03-18 23:07:50 WARNING [0, 0]: httperf-rapid-expire(httperf): Out of bounds: client_req(271393) less than lower boundary 999640
2012-03-18 23:07:50 [1, 0]: httperf-rapid-expire(httperf): Load: 00:07:50 up 6 days, 11:53, 0 users, load average: 7.87, 11.17, 9.50
2012-03-18 23:07:50 [1, 0]: httperf-rapid-expire(httperf): Test name: httperf-rapid-expire
2012-03-18 23:07:50 [1, 0]: httperf-rapid-expire(httperf): Varnish options:
2012-03-18 23:07:50 [1, 0]: httperf-rapid-expire(httperf): -t=2
2012-03-18 23:07:50 [1, 0]: httperf-rapid-expire(httperf): Varnish parameters:
2012-03-18 23:07:50 [1, 0]: httperf-rapid-expire(httperf): Payload size (excludes headers): 256
2012-03-18 23:07:50 [1, 0]: httperf-rapid-expire(httperf): Branch: master
2012-03-18 23:07:50 [1, 0]: httperf-rapid-expire(httperf): Number of clients involved: 24
2012-03-18 23:07:50 [1, 0]: httperf-rapid-expire(httperf): Type of test: httperf
2012-03-18 23:07:50 [1, 0]: httperf-rapid-expire(httperf): Test iterations: 1
2012-03-18 23:07:50 [1, 0]: httperf-rapid-expire(httperf): Runtime: 99 seconds
2012-03-18 23:07:50 [1, 0]: httperf-rapid-expire(httperf): VCL:
backend foo {
.host = "localhost";
.port = "80";
}
sub vcl_fetch {
set beresp.do_stream = true;
}
2012-03-18 23:07:50 [1, 0]: httperf-rapid-expire(httperf): Number of total connections: 100000
2012-03-18 23:07:50 [1, 0]: httperf-rapid-expire(httperf): Note: connections are subject to rounding when divided among clients. Expect slight deviations.
2012-03-18 23:07:50 [1, 0]: httperf-rapid-expire(httperf): Requests per connection: 10
2012-03-18 23:07:50 [1, 0]: httperf-rapid-expire(httperf): Extra options to httperf: --wset=100,0.30
2012-03-18 23:07:50 [1, 0]: httperf-rapid-expire(httperf): Httperf command (last client): httperf --hog --timeout 60 --num-calls 10 --num-conns 4166 --port 8080 --burst-length 10 --client 23/24 --server 10.20.100.4 --wset=100,0.30
2012-03-18 23:07:58 [2, 7]: streaming-grace(httperf): Starting test
2012-03-18 23:10:58 WARNING [0,179]: streaming-grace(httperf): Panic detected. I think!
2012-03-18 23:10:58 WARNING [0, 0]: streaming-grace(httperf):
Last panic at: Sun, 18 Mar 2012 23:10:10 GMT
Assert error in HSH_Lookup(), cache/cache_hash.c line 336:
Condition((oc->busyobj) != NULL) not true.
thread = (cache-worker)
ident = Linux,2.6.32-39-server,x86_64,-smalloc,-smalloc,-hcritbit,epoll
Backtrace:
0x431a88: pan_ic+d8
0x42a42d: HSH_Lookup+89d
0x416ce7: cnt_lookup+1c7
0x41a97d: CNT_Session+4ed
0x43639d: ses_pool_task+fd
0x433272: Pool_Work_Thread+112
0x4404b8: wrk_thread_real+c8
0x7f7828b639ca: _end+7f78284e0212
0x7f78288c0cdd: _end+7f782823d525
sp = 0x7f781a707320 {
fd = 12, id = 12, xid = 1932933871,
client = 10.20.100.9 5760,
step = STP_LOOKUP,
handling = hash,
restarts = 0, esi_level = 0
ws = 0x7f781a710150 {
id = "req",
{s,f,r,e} = {0x7f781a711728,+128,+59640,+59640},
},
http[req] = {
ws = 0x7f781a710150[req]
"GET",
"/8/4/7.html",
"HTTP/1.1",
"User-Agent: httperf/0.9.0",
"Host: 10.20.100.4",
"X-Forwarded-For: 10.20.100.9",
},
worker = 0x7f7822c7dc60 {
ws = 0x7f7822c7de20 {
id = "wrk",
{s,f,r,e} = {0x7f7822c7d450,0x7f7822c7d450,(nil),+2048},
},
},
vcl = {
srcname = {
"input",
"Default",
},
},
},
2012-03-18 23:10:58 [1, 0]: streaming-grace(httperf): Varnishstat uptime and measured run-time is too large (measured: 174 stat: 46 diff: 128). Did we crash?
2012-03-18 23:10:58 WARNING [0, 0]: streaming-grace(httperf): Out of bounds: client_req(971) less than lower boundary 9784
2012-03-18 23:10:59 [1, 0]: streaming-grace(httperf): Load: 00:10:59 up 6 days, 11:57, 0 users, load average: 0.48, 5.98, 7.76
2012-03-18 23:10:59 [1, 0]: streaming-grace(httperf): Test name: streaming-grace
2012-03-18 23:10:59 [1, 0]: streaming-grace(httperf): Varnish options:
2012-03-18 23:10:59 [1, 0]: streaming-grace(httperf): -t=1
2012-03-18 23:10:59 [1, 0]: streaming-grace(httperf): Varnish parameters:
2012-03-18 23:10:59 [1, 0]: streaming-grace(httperf): thread_pool_add_delay=1
2012-03-18 23:10:59 [1, 0]: streaming-grace(httperf): http_gzip_support=off
2012-03-18 23:10:59 [1, 0]: streaming-grace(httperf): default_grace=10
2012-03-18 23:10:59 [1, 0]: streaming-grace(httperf): Payload size (excludes headers): 1M
2012-03-18 23:10:59 [1, 0]: streaming-grace(httperf): Branch: master
2012-03-18 23:10:59 [1, 0]: streaming-grace(httperf): Number of clients involved: 24
2012-03-18 23:10:59 [1, 0]: streaming-grace(httperf): Type of test: httperf
2012-03-18 23:10:59 [1, 0]: streaming-grace(httperf): Test iterations: 1
2012-03-18 23:10:59 [1, 0]: streaming-grace(httperf): Runtime: 174 seconds
2012-03-18 23:10:59 [1, 0]: streaming-grace(httperf): VCL:
backend foo {
.host = "localhost";
.port = "80";
.connect_timeout = 10s;
}
sub vcl_recv {
set req.grace = 15s;
}
sub vcl_fetch {
set beresp.do_stream = true;
set beresp.grace = 10s;
set beresp.ttl = 15s;
}
sub vcl_deliver {
set resp.http.x-fryer = "some test";
}
2012-03-18 23:10:59 [1, 0]: streaming-grace(httperf): Number of total connections: 10000
2012-03-18 23:10:59 [1, 0]: streaming-grace(httperf): Note: connections are subject to rounding when divided among clients. Expect slight deviations.
2012-03-18 23:10:59 [1, 0]: streaming-grace(httperf): Requests per connection: 1
2012-03-18 23:10:59 [1, 0]: streaming-grace(httperf): Extra options to httperf: --wset=1000,0.1 --rate 3
2012-03-18 23:10:59 [1, 0]: streaming-grace(httperf): Httperf command (last client): httperf --hog --timeout 60 --num-calls 1 --num-conns 416 --port 8080 --burst-length 1 --client 23/24 --server 10.20.100.4 --wset=1000,0.1 --rate 3
2012-03-18 23:11:07 [2, 7]: cold-default(httperf): Starting test
2012-03-18 23:15:23 WARNING [0,256]: cold-default(httperf): Panic detected. I think!
2012-03-18 23:15:23 WARNING [0, 0]: cold-default(httperf):
Last panic at: Sun, 18 Mar 2012 23:14:27 GMT
Assert error in AssertOCBusy(), cache/cache.h line 1091:
Condition((oc->flags & (1<<1)) != 0) not true.
thread = (cache-worker)
ident = Linux,2.6.32-39-server,x86_64,-smalloc,-smalloc,-hcritbit,epoll
Backtrace:
0x431a88: pan_ic+d8
0x4243ad: EXP_Insert+28d
0x42522b: FetchBody+53b
0x433272: Pool_Work_Thread+112
0x4404b8: wrk_thread_real+c8
0x7f4bb7c0e9ca: _end+7f4bb758b212
0x7f4bb796bcdd: _end+7f4bb72e8525
2012-03-18 23:15:23 [1, 0]: cold-default(httperf): Varnishstat uptime and measured run-time is too large (measured: 251 stat: 54 diff: 197). Did we crash?
2012-03-18 23:19:41 WARNING [0,258]: cold-default(httperf): Panic detected. I think!
2012-03-18 23:19:41 WARNING [0, 0]: cold-default(httperf):
Last panic at: Sun, 18 Mar 2012 23:16:39 GMT
Assert error in AssertOCBusy(), cache/cache.h line 1091:
Condition((oc->flags & (1<<1)) != 0) not true.
thread = (cache-worker)
ident = Linux,2.6.32-39-server,x86_64,-smalloc,-smalloc,-hcritbit,epoll
Backtrace:
0x431a88: pan_ic+d8
0x4243ad: EXP_Insert+28d
0x42522b: FetchBody+53b
0x433272: Pool_Work_Thread+112
0x4404b8: wrk_thread_real+c8
0x7f4bb7c0e9ca: _end+7f4bb758b212
0x7f4bb796bcdd: _end+7f4bb72e8525
2012-03-18 23:19:41 [1, 0]: cold-default(httperf): Varnishstat uptime and measured run-time is too large (measured: 507 stat: 149 diff: 358). Did we crash?
2012-03-18 23:19:42 WARNING [0, 0]: cold-default(httperf): Out of bounds: client_req(229171) less than lower boundary 1599640
2012-03-18 23:19:42 [1, 0]: cold-default(httperf): Load: 00:19:42 up 6 days, 12:05, 0 users, load average: 0.89, 2.01, 4.93
2012-03-18 23:19:42 [1, 0]: cold-default(httperf): Test name: cold-default
2012-03-18 23:19:42 [1, 0]: cold-default(httperf): Varnish options:
2012-03-18 23:19:42 [1, 0]: cold-default(httperf): -t=3600
2012-03-18 23:19:42 [1, 0]: cold-default(httperf): -s=malloc,10G
2012-03-18 23:19:42 [1, 0]: cold-default(httperf): Varnish parameters:
2012-03-18 23:19:42 [1, 0]: cold-default(httperf): Payload size (excludes headers): 256
2012-03-18 23:19:42 [1, 0]: cold-default(httperf): Branch: master
2012-03-18 23:19:42 [1, 0]: cold-default(httperf): Number of clients involved: 24
2012-03-18 23:19:42 [1, 0]: cold-default(httperf): Type of test: httperf
2012-03-18 23:19:42 [1, 0]: cold-default(httperf): Test iterations: 2
2012-03-18 23:19:42 [1, 0]: cold-default(httperf): Runtime: 507 seconds
2012-03-18 23:19:42 [1, 0]: cold-default(httperf): VCL:
backend foo {
.host = "localhost";
.port = "80";
}
sub vcl_fetch {
set beresp.do_stream = true;
}
2012-03-18 23:19:42 [1, 0]: cold-default(httperf): Number of total connections: 80000
2012-03-18 23:19:42 [1, 0]: cold-default(httperf): Note: connections are subject to rounding when divided among clients. Expect slight deviations.
2012-03-18 23:19:42 [1, 0]: cold-default(httperf): Requests per connection: 10
2012-03-18 23:19:42 [1, 0]: cold-default(httperf): Extra options to httperf: --wset=4000000,0.50
2012-03-18 23:19:42 [1, 0]: cold-default(httperf): Httperf command (last client): httperf --hog --timeout 60 --num-calls 10 --num-conns 3333 --port 8080 --burst-length 10 --client 23/24 --server 10.20.100.4 --wset=4000000,0.50
2012-03-18 23:19:50 [2, 7]: 4gpluss-nogzip(httperf): Starting test
2012-03-18 23:19:53 WARNING [0, 3]: Varnish failed to start. Fallback attempts starting
2012-03-18 23:19:53 [1, 0]: Removed (hopefully incompatible) parameter to try to start varnish. Key: thread_pool_add_delay=1
2012-03-18 23:19:54 [1, 0]: Removed (hopefully incompatible) parameter to try to start varnish. Key: sess_timeout=60000s
2012-03-18 23:19:55 [1, 1]: Fallback worked. Parameter that seemed to cause problems: sess_timeout
2012-03-18 23:20:18 WARNING [0,22]: 4gpluss-nogzip(httperf): Out of bounds: s_bodybytes(0) less than lower boundary 25769803776
2012-03-18 23:20:18 [1, 0]: 4gpluss-nogzip(httperf): Load: 00:20:18 up 6 days, 12:06, 0 users, load average: 1.33, 1.98, 4.81
2012-03-18 23:20:18 [1, 0]: 4gpluss-nogzip(httperf): Test name: 4gpluss-nogzip
2012-03-18 23:20:18 [1, 0]: 4gpluss-nogzip(httperf): Varnish options:
2012-03-18 23:20:18 [1, 0]: 4gpluss-nogzip(httperf): -t=60000
2012-03-18 23:20:18 [1, 0]: 4gpluss-nogzip(httperf): -s=malloc,12G
2012-03-18 23:20:18 [1, 0]: 4gpluss-nogzip(httperf): Varnish parameters:
2012-03-18 23:20:18 [1, 0]: 4gpluss-nogzip(httperf): sess_timeout=60000s
2012-03-18 23:20:18 [1, 0]: 4gpluss-nogzip(httperf): http_gzip_support=off
2012-03-18 23:20:18 [1, 0]: 4gpluss-nogzip(httperf): send_timeout=60000s
2012-03-18 23:20:18 [1, 0]: 4gpluss-nogzip(httperf): Payload size (excludes headers): 5G
2012-03-18 23:20:18 [1, 0]: 4gpluss-nogzip(httperf): Branch: master
2012-03-18 23:20:18 [1, 0]: 4gpluss-nogzip(httperf): Number of clients involved: 24
2012-03-18 23:20:18 [1, 0]: 4gpluss-nogzip(httperf): Type of test: httperf
2012-03-18 23:20:18 [1, 0]: 4gpluss-nogzip(httperf): Test iterations: 1
2012-03-18 23:20:18 [1, 0]: 4gpluss-nogzip(httperf): Runtime: 20 seconds
2012-03-18 23:20:18 [1, 0]: 4gpluss-nogzip(httperf): VCL:
backend foo {
.host = "localhost";
.port = "80";
}
sub vcl_recv {
# Only using a single object for the nogzip-variant to reduce
# memory footprint and save time.
set req.url = "/1";
}
2012-03-18 23:20:18 [1, 0]: 4gpluss-nogzip(httperf): Number of total connections: 25
2012-03-18 23:20:18 [1, 0]: 4gpluss-nogzip(httperf): Note: connections are subject to rounding when divided among clients. Expect slight deviations.
2012-03-18 23:20:18 [1, 0]: 4gpluss-nogzip(httperf): Requests per connection: 1
2012-03-18 23:20:18 [1, 0]: 4gpluss-nogzip(httperf): Extra options to httperf: --wset=2,0.05 --timeout 6000
2012-03-18 23:20:18 [1, 0]: 4gpluss-nogzip(httperf): Httperf command (last client): httperf --hog --timeout 60 --num-calls 1 --num-conns 1 --port 8080 --burst-length 10 --client 23/24 --server 10.20.100.4 --wset=2,0.05 --timeout 6000
2012-03-18 23:20:26 [2, 7]: purge-fail(httperf): Starting test
2012-03-18 23:28:34 WARNING [0,487]: purge-fail(httperf): Panic detected. I think!
2012-03-18 23:28:34 WARNING [0, 0]: purge-fail(httperf):
Last panic at: Sun, 18 Mar 2012 23:28:17 GMT
Assert error in HSH_Lookup(), cache/cache_hash.c line 336:
Condition((oc->busyobj) != NULL) not true.
thread = (cache-worker)
ident = Linux,2.6.32-39-server,x86_64,-smalloc,-smalloc,-hcritbit,epoll
Backtrace:
0x431a88: pan_ic+d8
0x42a42d: HSH_Lookup+89d
0x416ce7: cnt_lookup+1c7
0x41a97d: CNT_Session+4ed
0x43639d: ses_pool_task+fd
0x433272: Pool_Work_Thread+112
0x4404b8: wrk_thread_real+c8
0x7fdd9b9df9ca: _end+7fdd9b35c212
0x7fdd9b73ccdd: _end+7fdd9b0b9525
sp = 0x7fdd8cd03b20 {
fd = 12, id = 12, xid = 1355193974,
client = 10.20.100.9 24776,
step = STP_LOOKUP,
handling = hash,
restarts = 0, esi_level = 0
ws = 0x7fdd9598a150 {
id = "req",
{s,f,r,e} = {0x7fdd9598b728,+96,+59640,+59640},
},
http[req] = {
ws = 0x7fdd9598a150[req]
"PURGE",
"/foo",
"HTTP/1.1",
"User-Agent: httperf/0.9.0",
"Host: 10.20.100.4",
},
worker = 0x7fdd9cef6c60 {
ws = 0x7fdd9cef6e20 {
id = "wrk",
{s,f,r,e} = {0x7fdd9cef6450,0x7fdd9cef6450,(nil),+2048},
},
},
vcl = {
srcname = {
"input",
"Default",
},
},
},
2012-03-18 23:28:34 [1, 0]: purge-fail(httperf): Varnishstat uptime and measured run-time is too large (measured: 482 stat: 15 diff: 467). Did we crash?
2012-03-18 23:28:34 WARNING [0, 0]: purge-fail(httperf): Out of bounds: client_req(1170) less than lower boundary 299800
2012-03-18 23:28:35 [1, 0]: purge-fail(httperf): Load: 00:28:35 up 6 days, 12:14, 0 users, load average: 0.23, 0.68, 2.98
2012-03-18 23:28:35 [1, 0]: purge-fail(httperf): Test name: purge-fail
2012-03-18 23:28:35 [1, 0]: purge-fail(httperf): Varnish options:
2012-03-18 23:28:35 [1, 0]: purge-fail(httperf): -w=5,100
2012-03-18 23:28:35 [1, 0]: purge-fail(httperf): Varnish parameters:
2012-03-18 23:28:35 [1, 0]: purge-fail(httperf): Payload size (excludes headers): 1K
2012-03-18 23:28:35 [1, 0]: purge-fail(httperf): Branch: master
2012-03-18 23:28:35 [1, 0]: purge-fail(httperf): Number of clients involved: 24
2012-03-18 23:28:35 [1, 0]: purge-fail(httperf): Type of test: httperf
2012-03-18 23:28:35 [1, 0]: purge-fail(httperf): Test iterations: 1
2012-03-18 23:28:35 [1, 0]: purge-fail(httperf): Runtime: 482 seconds
2012-03-18 23:28:35 [1, 0]: purge-fail(httperf): VCL:
backend foo {
.host = "localhost";
.port = "80";
}
sub vcl_recv {
if (!req.url ~ "/0/0.html") {
set req.request = "PURGE";
}
set req.url = "/foo";
return (lookup);
}
sub vcl_hit {
if (req.request == "PURGE") {
set obj.ttl = 0s;
error 200 "OK";
}
}
sub vcl_miss {
if (req.request == "PURGE") {
error 200 "Not in cache but not confusing httperf";
}
}
2012-03-18 23:28:35 [1, 0]: purge-fail(httperf): Number of total connections: 300000
2012-03-18 23:28:35 [1, 0]: purge-fail(httperf): Note: connections are subject to rounding when divided among clients. Expect slight deviations.
2012-03-18 23:28:35 [1, 0]: purge-fail(httperf): Requests per connection: 1
2012-03-18 23:28:35 [1, 0]: purge-fail(httperf): Extra options to httperf: --wset=999,0.5 --timeout=5
2012-03-18 23:28:35 [1, 0]: purge-fail(httperf): Httperf command (last client): httperf --hog --timeout 60 --num-calls 1 --num-conns 12500 --port 8080 --burst-length 10 --client 23/24 --server 10.20.100.4 --wset=999,0.5 --timeout=5
2012-03-18 23:28:43 [2, 7]: streaming-gzip(httperf): Starting test
2012-03-18 23:31:08 WARNING [0,145]: Tests finished with problems detected. Failed expectations: 18 Total run time: 10746 seconds
More information about the varnish-test
mailing list