[Varnish] #1825: Cannot Start Varnish After Just Restarting The Service

Varnish varnish-bugs at varnish-cache.org
Wed Dec 2 10:41:44 CET 2015


#1825: Cannot Start Varnish After Just Restarting The Service
------------------------+--------------------
 Reporter:  ghostshell  |       Owner:
     Type:  defect      |      Status:  new
 Priority:  normal      |   Milestone:
Component:  varnishd    |     Version:  4.1.0
 Severity:  major       |  Resolution:
 Keywords:              |
------------------------+--------------------
Description changed by fgsch:

Old description:

> I upgraded via the CentOS package manager using the official repo from v4
> to v4.1, had a small issue which I got fixed and everything was working
> fine. I needed to restart the varnish service yesterday and now it shows
> started but when I check the status of varnish or go to a web site hosted
> on the server the service shows not started and I cannot access any of
> my sites. I was able to get the access log going again, but I cannot
> figure out how to get the log going showing varnish startup/service
> errors or the success messages when it goes to start so all I have is
> the log info from messages which is:
>
> {{{
> Nov 30 23:30:42 www varnishd[16665]: Child (16667) not responding to CLI,
> killin
> g it.
> Nov 30 23:30:42 www varnishd[16665]: Child (16667) died signal=11 (core
> dumped)
> Nov 30 23:30:42 www varnishd[16665]: Child (16667) Panic message:
>  Assert error in child_sigsegv_handler(), mgt/mgt_child.c line 297:
>   Condition(Segmentation fault by instruction at 0x205970) not true.
> thread = (cache-worker)
> version = varnish-4.1.0 revision 3041728
> ident =
> Linux,2.6.32-573.8.1.el6.x86_64,x86_64,-junix,-smalloc,-smalloc,-hcritbi
> t,epoll
> Backtrace:
>   0x432483: varnishd() [0x432483]
>   0x450de9: varnishd() [0x450de9]
>   0x34a480f790: libpthread.so.0() [0x34a480f790]
>   0x43c2b9: varnishd(VCL_DefaultDirector+0x19) [0x43c2b9]
>   0x436b9e: varnishd(CNT_Request+0x74e) [0x436b9e]
>   0x44cc3b: varnishd(HTTP1_Session+0x11b) [0x44cc3b]
>   0x439921: varnishd(SES_Proto_Req+0x61) [0x439921]
>   0x447aed: varnishd() [0x447aed]
>   0x447eeb: varnishd() [0x447eeb]
>   0x34a4807a51: libpthread.so.0() [0x34a4807a51]
> req = 0x7fe026896020 {
>   vxid = 2, step = R_STP_RECV,
>   req_body = R_BODY_NONE,
>   restarts = 0, esi_level = 0,
>   sp = 0x7fe02640f420 {
>     fd = 13, vxid = 1,
>     client = 180.76.15.6 56796,
>     step = S_STP_H1PROC,
>   },
>   worker = 0x7fe02d7eebc0 {
>     stack = {0x7fe02d7ef000 -> 0x7fe02d7e3000},
>     ws = 0x7fe02d7eedb8 {
>       id = "wrk",
>       {s,f,r,e} = {0x7fe02d7ee380,0x7fe02d7ee380,(nil),+2040},
>     },
>     VCL::method = none,
>     ws = 0x7fe026896200 {
>       id = "req",
>       {s,f,r,e} = {0x7fe026898000,+216,(nil),+57336},
>     },
>     http_conn = 0x7fe026896128 {
>       fd = 13,
>       doclose = NULL,
>       ws = 0x7fe026896200,
>       {rxbuf_b, rxbuf_e} = {0x7fe026898000, 0x7fe0268980b8},
>       {pipeline_b, pipeline_e} = {(nil), (nil)},
>       content_length = -1,
>       body_status = none,
>       first_byte_timeout = 0.000000,
>       between_bytes_timeout = 0.000000,
>     },
>     http[req] = 0x7fe026896298 {
>       ws[req] = 0x7fe026896200,
>       hdrs {
>         "GET",
>         "/",
>         "HTTP/1.1",
>         "Host: wsww",
>         "Accept-Lang
> Nov 30 23:30:42 www varnishd[16665]: child (17228) Started
> Nov 30 23:30:43 www varnishd[16665]: Pushing vcls failed:
> Could not load compiled VCL.
> #011dlopen(vcl_boot/vgc.so) = vcl_boot/vgc.so: cannot open shared object
> file: N
> o such file or directory
> Nov 30 23:30:44 www varnishd[16665]: Child (17228) ended
> Nov 30 23:30:44 www varnishd[16665]: Child (17228) said Child starts
> Nov 30 23:30:44 www varnishd[16665]: Child (17228) said Child dies
> Nov 30 23:31:53 www named[2444]: error (network unreachable) resolving
> 'www.amaz
> on.it/A/IN': 2001:502:4612::1#53
> Nov 30 23:32:20 www varnishd[16665]: Manager got SIGINT
> Nov 30 23:32:24 www varnishd[18670]: Platform:
> Linux,2.6.32-573.8.1.el6.x86_64,x
> 86_64,-junix,-smalloc,-smalloc,-hcritbit
> Nov 30 23:32:24 www varnishd[18670]: child (18672) Started
> Nov 30 23:32:24 www varnishd[18670]: Child (18672) said Child starts
> Nov 30 23:32:51 www varnishd[18670]: Manager got SIGINT
> Nov 30 23:32:52 www varnishd[18670]: Child (18672) ended
> Nov 30 23:32:52 www varnishd[18670]: Child (18672) said Child die
> }}}
>
> All my sites are currently down, the only solution I have for the
> moment is to downgrade to 4.0 from 4.1.0-1. I tested the downgrade
> and the service and my sites came right online once the downgrade was
> complete. I would like to keep updated.

New description:

 I upgraded via the CentOS package manager using the official repo from v4
 to v4.1, had a small issue which I got fixed and everything was working
 fine. I needed to restart the varnish service yesterday and now it shows
 started but when I check the status of varnish or go to a web site hosted
 on the server the service shows not started and I cannot access any of
 my sites. I was able to get the access log going again, but I cannot
 figure out how to get the log going showing varnish startup/service
 errors or the success messages when it goes to start so all I have is
 the log info from messages which is:

 {{{
 Nov 30 23:30:42 www varnishd[16665]: Child (16667) not responding to CLI,
 killin
 g it.
 Nov 30 23:30:42 www varnishd[16665]: Child (16667) died signal=11 (core
 dumped)
 Nov 30 23:30:42 www varnishd[16665]: Child (16667) Panic message:
  Assert error in child_sigsegv_handler(), mgt/mgt_child.c line 297:
   Condition(Segmentation fault by instruction at 0x205970) not true.
 thread = (cache-worker)
 version = varnish-4.1.0 revision 3041728
 ident =
 Linux,2.6.32-573.8.1.el6.x86_64,x86_64,-junix,-smalloc,-smalloc,-hcritbit,epoll
 Backtrace:
   0x432483: varnishd() [0x432483]
   0x450de9: varnishd() [0x450de9]
   0x34a480f790: libpthread.so.0() [0x34a480f790]
   0x43c2b9: varnishd(VCL_DefaultDirector+0x19) [0x43c2b9]
   0x436b9e: varnishd(CNT_Request+0x74e) [0x436b9e]
   0x44cc3b: varnishd(HTTP1_Session+0x11b) [0x44cc3b]
   0x439921: varnishd(SES_Proto_Req+0x61) [0x439921]
   0x447aed: varnishd() [0x447aed]
   0x447eeb: varnishd() [0x447eeb]
   0x34a4807a51: libpthread.so.0() [0x34a4807a51]
 req = 0x7fe026896020 {
   vxid = 2, step = R_STP_RECV,
   req_body = R_BODY_NONE,
   restarts = 0, esi_level = 0,
   sp = 0x7fe02640f420 {
     fd = 13, vxid = 1,
     client = 180.76.15.6 56796,
     step = S_STP_H1PROC,
   },
   worker = 0x7fe02d7eebc0 {
     stack = {0x7fe02d7ef000 -> 0x7fe02d7e3000},
     ws = 0x7fe02d7eedb8 {
       id = "wrk",
       {s,f,r,e} = {0x7fe02d7ee380,0x7fe02d7ee380,(nil),+2040},
     },
     VCL::method = none,
     ws = 0x7fe026896200 {
       id = "req",
       {s,f,r,e} = {0x7fe026898000,+216,(nil),+57336},
     },
     http_conn = 0x7fe026896128 {
       fd = 13,
       doclose = NULL,
       ws = 0x7fe026896200,
       {rxbuf_b, rxbuf_e} = {0x7fe026898000, 0x7fe0268980b8},
       {pipeline_b, pipeline_e} = {(nil), (nil)},
       content_length = -1,
       body_status = none,
       first_byte_timeout = 0.000000,
       between_bytes_timeout = 0.000000,
     },
     http[req] = 0x7fe026896298 {
       ws[req] = 0x7fe026896200,
       hdrs {
         "GET",
         "/",
         "HTTP/1.1",
         "Host: wsww",
         "Accept-Lang
 Nov 30 23:30:42 www varnishd[16665]: child (17228) Started
 Nov 30 23:30:43 www varnishd[16665]: Pushing vcls failed:
 Could not load compiled VCL.
 #011dlopen(vcl_boot/vgc.so) = vcl_boot/vgc.so: cannot open shared object
 file: No such file or directory
 Nov 30 23:30:44 www varnishd[16665]: Child (17228) ended
 Nov 30 23:30:44 www varnishd[16665]: Child (17228) said Child starts
 Nov 30 23:30:44 www varnishd[16665]: Child (17228) said Child dies
 Nov 30 23:31:53 www named[2444]: error (network unreachable) resolving
 'www.amaz
 on.it/A/IN': 2001:502:4612::1#53
 Nov 30 23:32:20 www varnishd[16665]: Manager got SIGINT
 Nov 30 23:32:24 www varnishd[18670]: Platform:
 Linux,2.6.32-573.8.1.el6.x86_64,x
 86_64,-junix,-smalloc,-smalloc,-hcritbit
 Nov 30 23:32:24 www varnishd[18670]: child (18672) Started
 Nov 30 23:32:24 www varnishd[18670]: Child (18672) said Child starts
 Nov 30 23:32:51 www varnishd[18670]: Manager got SIGINT
 Nov 30 23:32:52 www varnishd[18670]: Child (18672) ended
 Nov 30 23:32:52 www varnishd[18670]: Child (18672) said Child die
 }}}

 All my sites are currently down, the only solution I have for the
 moment is to downgrade to 4.0 from 4.1.0-1. I tested the downgrade
 and the service and my sites came right online once the downgrade was
 complete. I would like to keep updated.

--

-- 
Ticket URL: <https://www.varnish-cache.org/trac/ticket/1825#comment:3>
Varnish <https://varnish-cache.org/>
The Varnish HTTP Accelerator



More information about the varnish-bugs mailing list