[Libwebsockets] Crash during client pipelining post

Karl Vogel karl.vogel at gmail.com
Tue Mar 10 09:27:09 CET 2020


Was trying to use the PIPELINE feature in my POST client, but once I enable
LCCSCF_PIPELINE, the client crashes when the first client gets a
reply. Works fine if I
don't include the pipeline option. Seems to be caused by a NULL
pointer dereference, not
sure if it's something I'm doing wrong or some other bug:

[2020/03/10 09:12:30:5975] I: Initial logging level 1151
[2020/03/10 09:12:30:5975] I: Libwebsockets version: 4.0.99 v4.0.0-6-g5b9fe018
[2020/03/10 09:12:30:5975] I: IPV6 compiled in and enabled
[2020/03/10 09:12:30:5975] I:  LWS_DEF_HEADER_LEN    : 4096
[2020/03/10 09:12:30:5975] I:  LWS_MAX_SMP           : 1
[2020/03/10 09:12:30:5975] I:  sizeof (*info)        : 680
[2020/03/10 09:12:30:5975] I:  SYSTEM_RANDOM_FILEPATH: '/dev/urandom'
[2020/03/10 09:12:30:5975] I:  HTTP2 support         : not configured
[2020/03/10 09:12:30:5975] D: _realloc: size 5952: context
[2020/03/10 09:12:30:5975] I: context created
[2020/03/10 09:12:30:5975] I: Using event loop: libevent
[2020/03/10 09:12:30:5975] I: Default ALPN advertisment: http/1.1
[2020/03/10 09:12:30:5975] I:  default timeout (secs): 20
[2020/03/10 09:12:30:5976] I:  Threads: 1 each 5 fds
[2020/03/10 09:12:30:5976] I:  mem: context:          5224 B (1128 ctx
+ (1 thr x 4096))
[2020/03/10 09:12:30:5976] I:  mem: http hdr size:   (4096 + 912), max count 5
[2020/03/10 09:12:30:5976] D: _realloc: size 40: fds table
[2020/03/10 09:12:30:5976] I:  mem: pollfd map:         40 B
[2020/03/10 09:12:30:5976] D: _realloc: size 40: lws_lookup
[2020/03/10 09:12:30:5976] I:  mem: platform fd map:    40 B
[2020/03/10 09:12:30:5976] I: elops_init_pt_event: loop 0x44c2e0
[2020/03/10 09:12:30:5976] D: _realloc: size 728: event pipe wsi
[2020/03/10 09:12:30:5976] D: lws_role_transition: 0x476d90: wsistate
0x200, ops pipe
[2020/03/10 09:12:30:5976] D: event pipe fd 9
[2020/03/10 09:12:30:5976] D: __insert_wsi_socket_into_fds: 0x476d90:
tsi=0, sock=9, pos-in-fds=0
[2020/03/10 09:12:30:5976] I:  Compiled with OpenSSL support
[2020/03/10 09:12:30:5976] I: Doing SSL library init
[2020/03/10 09:12:30:5980] D: _realloc: size 656: create vhost
[2020/03/10 09:12:30:5980] D: _realloc: size 112: vhost-specific plugin table
[2020/03/10 09:12:30:5980] D: _realloc: size 24: same vh list
[2020/03/10 09:12:30:5980] I: Creating Vhost 'default' (serving
disabled), 1 protocols, IPv6 on
[2020/03/10 09:12:30:5982] D: _realloc: size 72: client ctx tcr
[2020/03/10 09:12:30:5982] I: lws_tls_client_create_vhost_context: vh
default: created new client ctx 0
[2020/03/10 09:12:30:6022] I: created client ssl context for default
>>>>>>>>>>>>>> 0. LWS_CALLBACK_OPENSSL_LOAD_EXTRA_CLIENT_VERIFY_CERT
[2020/03/10 09:12:30:6022] I:  mem: per-conn:          728 bytes +
protocol rx buf
[2020/03/10 09:12:30:6022] I: lws_plat_drop_app_privileges: not changing group
[2020/03/10 09:12:30:6022] I: lws_plat_drop_app_privileges: not changing user
[2020/03/10 09:12:30:6022] I: lws_cancel_service
>>>>>>>>>>>>>> 0. LWS_CALLBACK_EVENT_WAIT_CANCELLED
connecting to host agent-server port 9898
connecting to host agent-server port 9898
[2020/03/10 09:12:30:6024] I: lws_protocol_init
>>>>>>>>>>>>>> 0. LWS_CALLBACK_PROTOCOL_INIT
[2020/03/10 09:12:30:6024] D: _realloc: size 728: client wsi
[2020/03/10 09:12:30:6024] D: lws_vhost_bind_wsi: vh default: wsi
none/none, count_bound_wsi 1
[2020/03/10 09:12:30:6024] D: lws_role_transition: 0x545a20: wsistate
0x10000200, ops h1
[2020/03/10 09:12:30:6024] I: lws_client_connect_via_info: role binding to h1
[2020/03/10 09:12:30:6024] I: lws_client_connect_via_info: protocol
binding to http
[2020/03/10 09:12:30:6024] D: _realloc: size 8: user space
>>>>>>>>>>>>>> 0. LWS_CALLBACK_CLIENT_HTTP_BIND_PROTOCOL
[2020/03/10 09:12:30:6024] I: lws_client_connect_via_info: wsi
0x545a20: h1 http entry
[2020/03/10 09:12:30:6024] D: _realloc: size 143: client stash
[2020/03/10 09:12:30:6024] I: lws_header_table_attach: wsi 0x545a20:
ah (nil) (tsi 0, count = 0) in
[2020/03/10 09:12:30:6024] D: _realloc: size 912: ah struct
[2020/03/10 09:12:30:6024] D: _realloc: size 4096: ah data
[2020/03/10 09:12:30:6024] I: _lws_create_ah: created ah 0x4b33b0
(size 4096): pool length 1
[2020/03/10 09:12:30:6024] I: lws_header_table_attach: did attach wsi
0x545a20: ah 0x4b33b0: count 1 (on exit)
[2020/03/10 09:12:30:6024] D: __lws_set_timeout: 0x545a20: 10 secs, reason 25
[2020/03/10 09:12:30:6024] D: lws_http_client_connect_via_info2:
0x545a20 (stash 0x541ac0)
[2020/03/10 09:12:30:6024] D: _realloc: size 13: strdup
[2020/03/10 09:12:30:6024] I: lws_client_connect_2_dnsreq: adding
active conn 0x545a20
[2020/03/10 09:12:30:6024] D: lwsi_set_state(0x545a20, 0x10000201)
[2020/03/10 09:12:30:6024] I: lws_client_connect_2_dnsreq: 0x545a20:
lookup agent-server:9898
[2020/03/10 09:12:30:6080] I: lws_getaddrinfo46: getaddrinfo
'agent-server' says 0
[2020/03/10 09:12:30:6080] D: lws_client_connect_3_connect: result
0x4a4ea0 result->ai_next (nil)
[2020/03/10 09:12:30:6080] I: lws_client_connect_3_connect:
agent-server ipv6 2001:db8::1
[2020/03/10 09:12:30:6080] D: lws_client_connect_3_connect: 0x545a20:
WAITING_CONNECT
[2020/03/10 09:12:30:6081] D: lwsi_set_state(0x545a20, 0x10000202)
[2020/03/10 09:12:30:6081] D: __insert_wsi_socket_into_fds: 0x545a20:
tsi=0, sock=10, pos-in-fds=1
[2020/03/10 09:12:30:6081] D: _lws_change_pollfd: wsi 0x545a20: fd 10
events 1 -> 1
[2020/03/10 09:12:30:6081] D: __lws_set_timeout: 0x545a20: 20 secs, reason 2
[2020/03/10 09:12:30:6081] D: lws_client_connect_3_connect: connect
says errno: 115
[2020/03/10 09:12:30:6081] D: _lws_change_pollfd: wsi 0x545a20: fd 10
events 1 -> 5
[2020/03/10 09:12:30:6081] D: lws_client_connect_via_info: wsi
0x545a20: adoption cb 19 to h1 http
>>>>>>>>>>>>>> 0. LWS_CALLBACK_SERVER_NEW_CLIENT_INSTANTIATED
[2020/03/10 09:12:30:6082] D: _realloc: size 728: client wsi
[2020/03/10 09:12:30:6082] D: lws_vhost_bind_wsi: vh default: wsi
none/none, count_bound_wsi 2
[2020/03/10 09:12:30:6082] D: lws_role_transition: 0x547260: wsistate
0x10000200, ops h1
[2020/03/10 09:12:30:6082] I: lws_client_connect_via_info: role binding to h1
[2020/03/10 09:12:30:6082] D: _realloc: size 138: client stash
[2020/03/10 09:12:30:6082] D: _realloc: size 8: user space
[2020/03/10 09:12:30:6082] I: lws_header_table_attach: wsi 0x547260:
ah (nil) (tsi 0, count = 1) in
[2020/03/10 09:12:30:6082] D: _realloc: size 912: ah struct
[2020/03/10 09:12:30:6082] D: _realloc: size 4096: ah data
[2020/03/10 09:12:30:6082] I: _lws_create_ah: created ah 0x5475e0
(size 4096): pool length 2
[2020/03/10 09:12:30:6082] I: lws_header_table_attach: did attach wsi
0x547260: ah 0x5475e0: count 2 (on exit)
[2020/03/10 09:12:30:6082] D: __lws_set_timeout: 0x547260: 10 secs, reason 25
[2020/03/10 09:12:30:6082] D: lws_http_client_connect_via_info2:
0x547260 (stash 0x547540)
[2020/03/10 09:12:30:6082] D: lws_vhost_active_conns: check 0x547260
0x545a20 agent-server agent-server 9898 9898
[2020/03/10 09:12:30:6082] N: lws_vhost_active_conns: apply 0x547260
to txn queue on 0x545a20 state 0x10000202
[2020/03/10 09:12:30:6082] D: lwsi_set_state(0x547260, 0x1000010f)
[2020/03/10 09:12:30:6082] D: _lws_change_pollfd: wsi 0x545a20: fd 10
events 5 -> 5
[2020/03/10 09:12:30:6082] I: lws_client_connect_4_established: wsi
0x547260: waiting to send hdrs (par state 0x202)
[2020/03/10 09:12:30:6082] D: lws_client_connect_via_info: wsi
0x547260: adoption cb 19 to h1 http
>>>>>>>>>>>>>> 1. LWS_CALLBACK_SERVER_NEW_CLIENT_INSTANTIATED
[2020/03/10 09:12:30:6082] D: _lws_change_pollfd: wsi 0x545a20: fd 10
events 5 -> 1
[2020/03/10 09:12:30:6082] I: lws_client_connect_3_connect: getsockopt
check: conn OK
[2020/03/10 09:12:30:6082] I: lws_client_connect_3_connect: Connection
started 0x4a4ea0
>>>>>>>>>>>>>> 0. LWS_CALLBACK_WSI_CREATE
[2020/03/10 09:12:30:6082] I: lws_client_connect_4_established: wsi
0x545a20: h1 http client created own conn (raw 0) vh defaultm st 0x202
[2020/03/10 09:12:30:6083] I: h1 client conn using alpn list 'h2'
[2020/03/10 09:12:30:6084] D: lws_ssl_get_error: 0x543a10 -1 -> 2 (errno 11)
[2020/03/10 09:12:30:6084] D: lwsi_set_state(0x545a20, 0x10000204)
[2020/03/10 09:12:30:6094] D: lws_event_idle_timer_cb: wait
[2020/03/10 09:12:30:6094] D: _lws_state_transition: system: changed 1
'CONTEXT_CREATED' -> 2 'INITIALIZED'
[2020/03/10 09:12:30:6094] D: _lws_state_transition: system: changed 2
'INITIALIZED' -> 3 'IFACE_COLDPLUG'
[2020/03/10 09:12:30:6094] D: _lws_state_transition: system: changed 3
'IFACE_COLDPLUG' -> 4 'DHCP'
[2020/03/10 09:12:30:6095] D: _lws_state_transition: system: changed 4
'DHCP' -> 5 'TIME_VALID'
[2020/03/10 09:12:30:6095] D: _lws_state_transition: system: changed 5
'TIME_VALID' -> 6 'POLICY_VALID'
[2020/03/10 09:12:30:6095] D: _lws_state_transition: system: changed 6
'POLICY_VALID' -> 7 'REGISTERED'
[2020/03/10 09:12:30:6095] D: _lws_state_transition: system: changed 7
'REGISTERED' -> 8 'AUTH1'
[2020/03/10 09:12:30:6095] D: _lws_state_transition: system: changed 8
'AUTH1' -> 9 'AUTH2'
[2020/03/10 09:12:30:6095] D: _lws_state_transition: system: changed 9
'AUTH2' -> 10 'OPERATIONAL'
[2020/03/10 09:12:30:6095] I: lws_state_transition_steps:
CONTEXT_CREATED -> OPERATIONAL
[2020/03/10 09:12:30:6097] N: accepting self-signed certificate
(verify_callback)
>>>>>>>>>>>>>> 0. LWS_CALLBACK_OPENSSL_PERFORM_SERVER_CERT_VERIFICAT
[2020/03/10 09:12:30:6098] D: lws_ssl_get_error: 0x543a10 1 -> 0 (errno 0)
[2020/03/10 09:12:30:6099] I: lws_role_call_alpn_negotiated: ''
[2020/03/10 09:12:30:6099] I: client connect OK
[2020/03/10 09:12:30:6099] I: lws_openssl_describe_cipher: wsi
0x545a20: TLS_AES_256_GCM_SHA384, TLS_AES_256_GCM_SHA384, 256 bits,
TLSv1.3
[2020/03/10 09:12:30:6099] D: lws_ssl_client_connect2: SSL_connect says 0
[2020/03/10 09:12:30:6099] D: get_verify says 0
>>>>>>>>>>>>>> 0. LWS_CALLBACK_CLIENT_APPEND_HANDSHAKE_HEADER
[2020/03/10 09:12:30:6099] D: _lws_change_pollfd: wsi 0x545a20: fd 10
events 1 -> 5
[2020/03/10 09:12:30:6099] D: _lws_change_pollfd: wsi 0x545a20: fd 10
events 5 -> 5
[2020/03/10 09:12:30:6099] I: lws_client_socket_service: HANDSHAKE2:
0x545a20: sending headers (wsistate 0x10000204), w sock 10
[2020/03/10 09:12:30:6099] D: body pending
[2020/03/10 09:12:30:6099] D: lwsi_set_state(0x545a20, 0x10000014)
[2020/03/10 09:12:30:6099] D: __lws_set_timeout: 0x545a20: 20 secs, reason 18
[2020/03/10 09:12:30:6099] D: _lws_change_pollfd: wsi 0x545a20: fd 10
events 5 -> 1
[2020/03/10 09:12:30:6099] D: lws_handle_POLLOUT_event: 0x545a20: non
mux: wsistate 0x10000014, ops h1
>>>>>>>>>>>>>> 0. LWS_CALLBACK_CLIENT_HTTP_WRITEABLE
writing payload 55 bytes
[2020/03/10 09:12:30:6099] I: lws_issue_raw: ssl_capable_write (55) says 55
[2020/03/10 09:12:30:6099] D: lwsi_set_state(0x545a20, 0x1000020b)
[2020/03/10 09:12:30:6099] D: __lws_set_timeout: 0x545a20: 20 secs, reason 4
[2020/03/10 09:12:30:6100] D: 0x545a20: SSL_read says -1
[2020/03/10 09:12:30:6101] D: lws_ssl_get_error: 0x543a10 -1 -> 2 (errno 11)
[2020/03/10 09:12:30:6101] D: 0x545a20: ssl err 2 errno 11
[2020/03/10 09:12:30:6101] D: lws_ssl_capable_read: WANT_READ
[2020/03/10 09:12:30:6101] D: 0x545a20: LWS_SSL_CAPABLE_MORE_SERVICE
[2020/03/10 09:12:30:6101] I: lws_buflist_aware_read: wsi 0x545a20:
lws_client_socket_service: ssl_capable_read -4
[2020/03/10 09:12:30:6101] D: lws_client_socket_service: buflist-aware-read 0 -4
[2020/03/10 09:12:30:6101] D: 0x545a20: SSL_read says -1
[2020/03/10 09:12:30:6101] D: lws_ssl_get_error: 0x543a10 -1 -> 2 (errno 11)
[2020/03/10 09:12:30:6101] D: 0x545a20: ssl err 2 errno 11
[2020/03/10 09:12:30:6101] D: lws_ssl_capable_read: WANT_READ
[2020/03/10 09:12:30:6101] D: 0x545a20: LWS_SSL_CAPABLE_MORE_SERVICE
[2020/03/10 09:12:30:6101] I: lws_buflist_aware_read: wsi 0x545a20:
lws_client_socket_service: ssl_capable_read -4
[2020/03/10 09:12:30:6101] D: lws_client_socket_service: buflist-aware-read 0 -4
[2020/03/10 09:12:30:6110] D: 0x545a20: SSL_read says 120
[2020/03/10 09:12:30:6110] I: lws_buflist_aware_read: wsi 0x545a20:
lws_client_socket_service: ssl_capable_read 120
[2020/03/10 09:12:30:6110] D: lws_client_socket_service:
buflist-aware-read 0 120
[2020/03/10 09:12:30:6110] P: WSI_TOKEN_NAME_PART 'H' 0x48
(role=0x10000000) wsi->lextable_pos=0
[2020/03/10 09:12:30:6110] P: WSI_TOKEN_NAME_PART 'T' 0x54
(role=0x10000000) wsi->lextable_pos=84
[2020/03/10 09:12:30:6110] P: WSI_TOKEN_NAME_PART 'T' 0x54
(role=0x10000000) wsi->lextable_pos=170
[2020/03/10 09:12:30:6110] P: WSI_TOKEN_NAME_PART 'P' 0x50
(role=0x10000000) wsi->lextable_pos=171
[2020/03/10 09:12:30:6111] P: WSI_TOKEN_NAME_PART '/' 0x2F
(role=0x10000000) wsi->lextable_pos=172
[2020/03/10 09:12:30:6111] P: WSI_TOKEN_NAME_PART '1' 0x31
(role=0x10000000) wsi->lextable_pos=173
[2020/03/10 09:12:30:6111] P: WSI_TOKEN_NAME_PART '.' 0x2E
(role=0x10000000) wsi->lextable_pos=174
[2020/03/10 09:12:30:6111] P: WSI_TOKEN_NAME_PART '1' 0x31
(role=0x10000000) wsi->lextable_pos=175
[2020/03/10 09:12:30:6111] P: WSI_TOKEN_NAME_PART ' ' 0x20
(role=0x10000000) wsi->lextable_pos=182
[2020/03/10 09:12:30:6111] P: known hdr 15
[2020/03/10 09:12:30:6111] P: WSI_TOK_(15) '2'
[2020/03/10 09:12:30:6111] P: WSI_TOK_(15) '0'
[2020/03/10 09:12:30:6111] P: WSI_TOK_(15) '0'
[2020/03/10 09:12:30:6111] P: WSI_TOK_(15) ' '
[2020/03/10 09:12:30:6111] P: WSI_TOK_(15) 'O'
[2020/03/10 09:12:30:6111] P: WSI_TOK_(15) 'K'
'2020/03/10 09:12:30:6111] P: WSI_TOK_(15) '
[2020/03/10 09:12:30:6112] P: *
[2020/03/10 09:12:30:6112] P: WSI_TOKEN_SKIPPING_SAW_CR '
'
[2020/03/10 09:12:30:6112] P: WSI_TOKEN_NAME_PART 'D' 0x44
(role=0x10000000) wsi->lextable_pos=0
[2020/03/10 09:12:30:6112] P: WSI_TOKEN_NAME_PART 'a' 0x61
(role=0x10000000) wsi->lextable_pos=389
[2020/03/10 09:12:30:6112] P: WSI_TOKEN_NAME_PART 't' 0x74
(role=0x10000000) wsi->lextable_pos=396
[2020/03/10 09:12:30:6112] P: WSI_TOKEN_NAME_PART 'e' 0x65
(role=0x10000000) wsi->lextable_pos=397
[2020/03/10 09:12:30:6112] P: WSI_TOKEN_NAME_PART ':' 0x3A
(role=0x10000000) wsi->lextable_pos=398
[2020/03/10 09:12:30:6112] P: known hdr 28
[2020/03/10 09:12:30:6112] P: WSI_TOK_(28) ' '
[2020/03/10 09:12:30:6112] P: WSI_TOK_(28) 'T'
[2020/03/10 09:12:30:6112] P: WSI_TOK_(28) 'u'
[2020/03/10 09:12:30:6112] P: WSI_TOK_(28) 'e'
[2020/03/10 09:12:30:6112] P: WSI_TOK_(28) ','
[2020/03/10 09:12:30:6112] P: WSI_TOK_(28) ' '
[2020/03/10 09:12:30:6113] P: WSI_TOK_(28) '1'
[2020/03/10 09:12:30:6113] P: WSI_TOK_(28) '0'
[2020/03/10 09:12:30:6113] P: WSI_TOK_(28) ' '
[2020/03/10 09:12:30:6113] P: WSI_TOK_(28) 'M'
[2020/03/10 09:12:30:6113] P: WSI_TOK_(28) 'a'
[2020/03/10 09:12:30:6113] P: WSI_TOK_(28) 'r'
[2020/03/10 09:12:30:6113] P: WSI_TOK_(28) ' '
[2020/03/10 09:12:30:6113] P: WSI_TOK_(28) '2'
[2020/03/10 09:12:30:6113] P: WSI_TOK_(28) '0'
[2020/03/10 09:12:30:6113] P: WSI_TOK_(28) '2'
[2020/03/10 09:12:30:6113] P: WSI_TOK_(28) '0'
[2020/03/10 09:12:30:6113] P: WSI_TOK_(28) ' '
[2020/03/10 09:12:30:6113] P: WSI_TOK_(28) '0'
[2020/03/10 09:12:30:6113] P: WSI_TOK_(28) '8'
[2020/03/10 09:12:30:6114] P: WSI_TOK_(28) ':'
[2020/03/10 09:12:30:6114] P: WSI_TOK_(28) '1'
[2020/03/10 09:12:30:6114] P: WSI_TOK_(28) '2'
[2020/03/10 09:12:30:6114] P: WSI_TOK_(28) ':'
[2020/03/10 09:12:30:6114] P: WSI_TOK_(28) '3'
[2020/03/10 09:12:30:6114] P: WSI_TOK_(28) '0'
[2020/03/10 09:12:30:6114] P: WSI_TOK_(28) ' '
[2020/03/10 09:12:30:6114] P: WSI_TOK_(28) 'G'
[2020/03/10 09:12:30:6114] P: WSI_TOK_(28) 'M'
[2020/03/10 09:12:30:6114] P: WSI_TOK_(28) 'T'
'2020/03/10 09:12:30:6114] P: WSI_TOK_(28) '
[2020/03/10 09:12:30:6114] P: *
[2020/03/10 09:12:30:6115] P: WSI_TOKEN_SKIPPING_SAW_CR '
'
[2020/03/10 09:12:30:6115] P: WSI_TOKEN_NAME_PART 'C' 0x43
(role=0x10000000) wsi->lextable_pos=0
[2020/03/10 09:12:30:6115] P: WSI_TOKEN_NAME_PART 'o' 0x6F
(role=0x10000000) wsi->lextable_pos=99
[2020/03/10 09:12:30:6115] P: WSI_TOKEN_NAME_PART 'n' 0x6E
(role=0x10000000) wsi->lextable_pos=106
[2020/03/10 09:12:30:6115] P: WSI_TOKEN_NAME_PART 't' 0x74
(role=0x10000000) wsi->lextable_pos=113
[2020/03/10 09:12:30:6115] P: WSI_TOKEN_NAME_PART 'e' 0x65
(role=0x10000000) wsi->lextable_pos=346
[2020/03/10 09:12:30:6115] P: WSI_TOKEN_NAME_PART 'n' 0x6E
(role=0x10000000) wsi->lextable_pos=347
[2020/03/10 09:12:30:6115] P: WSI_TOKEN_NAME_PART 't' 0x74
(role=0x10000000) wsi->lextable_pos=348
[2020/03/10 09:12:30:6115] P: WSI_TOKEN_NAME_PART '-' 0x2D
(role=0x10000000) wsi->lextable_pos=349
[2020/03/10 09:12:30:6115] P: WSI_TOKEN_NAME_PART 'T' 0x54
(role=0x10000000) wsi->lextable_pos=350
[2020/03/10 09:12:30:6115] P: WSI_TOKEN_NAME_PART 'y' 0x79
(role=0x10000000) wsi->lextable_pos=383
[2020/03/10 09:12:30:6115] P: WSI_TOKEN_NAME_PART 'p' 0x70
(role=0x10000000) wsi->lextable_pos=384
[2020/03/10 09:12:30:6116] P: WSI_TOKEN_NAME_PART 'e' 0x65
(role=0x10000000) wsi->lextable_pos=385
[2020/03/10 09:12:30:6116] P: WSI_TOKEN_NAME_PART ':' 0x3A
(role=0x10000000) wsi->lextable_pos=386
[2020/03/10 09:12:30:6116] P: known hdr 27
[2020/03/10 09:12:30:6116] P: WSI_TOK_(27) ' '
[2020/03/10 09:12:30:6116] P: WSI_TOK_(27) 't'
[2020/03/10 09:12:30:6116] P: WSI_TOK_(27) 'e'
[2020/03/10 09:12:30:6116] P: WSI_TOK_(27) 'x'
[2020/03/10 09:12:30:6116] P: WSI_TOK_(27) 't'
[2020/03/10 09:12:30:6116] P: WSI_TOK_(27) '/'
[2020/03/10 09:12:30:6116] P: WSI_TOK_(27) 'p'
[2020/03/10 09:12:30:6116] P: WSI_TOK_(27) 'l'
[2020/03/10 09:12:30:6116] P: WSI_TOK_(27) 'a'
[2020/03/10 09:12:30:6116] P: WSI_TOK_(27) 'i'
[2020/03/10 09:12:30:6116] P: WSI_TOK_(27) 'n'
'2020/03/10 09:12:30:6117] P: WSI_TOK_(27) '
[2020/03/10 09:12:30:6117] P: *
[2020/03/10 09:12:30:6117] P: WSI_TOKEN_SKIPPING_SAW_CR '
'
[2020/03/10 09:12:30:6117] P: WSI_TOKEN_NAME_PART 'C' 0x43
(role=0x10000000) wsi->lextable_pos=0
[2020/03/10 09:12:30:6117] P: WSI_TOKEN_NAME_PART 'o' 0x6F
(role=0x10000000) wsi->lextable_pos=99
[2020/03/10 09:12:30:6117] P: WSI_TOKEN_NAME_PART 'n' 0x6E
(role=0x10000000) wsi->lextable_pos=106
[2020/03/10 09:12:30:6117] P: WSI_TOKEN_NAME_PART 't' 0x74
(role=0x10000000) wsi->lextable_pos=113
[2020/03/10 09:12:30:6117] P: WSI_TOKEN_NAME_PART 'e' 0x65
(role=0x10000000) wsi->lextable_pos=346
[2020/03/10 09:12:30:6117] P: WSI_TOKEN_NAME_PART 'n' 0x6E
(role=0x10000000) wsi->lextable_pos=347
[2020/03/10 09:12:30:6117] P: WSI_TOKEN_NAME_PART 't' 0x74
(role=0x10000000) wsi->lextable_pos=348
[2020/03/10 09:12:30:6117] P: WSI_TOKEN_NAME_PART '-' 0x2D
(role=0x10000000) wsi->lextable_pos=349
[2020/03/10 09:12:30:6117] P: WSI_TOKEN_NAME_PART 'L' 0x4C
(role=0x10000000) wsi->lextable_pos=350
[2020/03/10 09:12:30:6117] P: WSI_TOKEN_NAME_PART 'e' 0x65
(role=0x10000000) wsi->lextable_pos=366
[2020/03/10 09:12:30:6118] P: WSI_TOKEN_NAME_PART 'n' 0x6E
(role=0x10000000) wsi->lextable_pos=376
[2020/03/10 09:12:30:6118] P: WSI_TOKEN_NAME_PART 'g' 0x67
(role=0x10000000) wsi->lextable_pos=377
[2020/03/10 09:12:30:6118] P: WSI_TOKEN_NAME_PART 't' 0x74
(role=0x10000000) wsi->lextable_pos=378
[2020/03/10 09:12:30:6118] P: WSI_TOKEN_NAME_PART 'h' 0x68
(role=0x10000000) wsi->lextable_pos=379
[2020/03/10 09:12:30:6118] P: WSI_TOKEN_NAME_PART ':' 0x3A
(role=0x10000000) wsi->lextable_pos=380
[2020/03/10 09:12:30:6118] P: known hdr 26
[2020/03/10 09:12:30:6118] P: WSI_TOK_(26) ' '
[2020/03/10 09:12:30:6118] P: WSI_TOK_(26) '0'
'2020/03/10 09:12:30:6118] P: WSI_TOK_(26) '
[2020/03/10 09:12:30:6118] P: *
[2020/03/10 09:12:30:6118] P: WSI_TOKEN_SKIPPING_SAW_CR '
'
[2020/03/10 09:12:30:6118] P: WSI_TOKEN_NAME_PART 'C' 0x43
(role=0x10000000) wsi->lextable_pos=0
[2020/03/10 09:12:30:6118] P: WSI_TOKEN_NAME_PART 'o' 0x6F
(role=0x10000000) wsi->lextable_pos=99
[2020/03/10 09:12:30:6119] P: WSI_TOKEN_NAME_PART 'n' 0x6E
(role=0x10000000) wsi->lextable_pos=106
[2020/03/10 09:12:30:6119] P: WSI_TOKEN_NAME_PART 'n' 0x6E
(role=0x10000000) wsi->lextable_pos=113
[2020/03/10 09:12:30:6119] P: WSI_TOKEN_NAME_PART 'e' 0x65
(role=0x10000000) wsi->lextable_pos=120
[2020/03/10 09:12:30:6119] P: WSI_TOKEN_NAME_PART 'c' 0x63
(role=0x10000000) wsi->lextable_pos=121
[2020/03/10 09:12:30:6119] P: WSI_TOKEN_NAME_PART 't' 0x74
(role=0x10000000) wsi->lextable_pos=122
[2020/03/10 09:12:30:6119] P: WSI_TOKEN_NAME_PART 'i' 0x69
(role=0x10000000) wsi->lextable_pos=123
[2020/03/10 09:12:30:6119] P: WSI_TOKEN_NAME_PART 'o' 0x6F
(role=0x10000000) wsi->lextable_pos=130
[2020/03/10 09:12:30:6119] P: WSI_TOKEN_NAME_PART 'n' 0x6E
(role=0x10000000) wsi->lextable_pos=131
[2020/03/10 09:12:30:6119] P: WSI_TOKEN_NAME_PART ':' 0x3A
(role=0x10000000) wsi->lextable_pos=132
[2020/03/10 09:12:30:6119] P: known hdr 4
[2020/03/10 09:12:30:6119] P: WSI_TOK_(4) ' '
[2020/03/10 09:12:30:6119] P: WSI_TOK_(4) 'c'
[2020/03/10 09:12:30:6119] P: WSI_TOK_(4) 'l'
[2020/03/10 09:12:30:6119] P: WSI_TOK_(4) 'o'
[2020/03/10 09:12:30:6120] P: WSI_TOK_(4) 's'
[2020/03/10 09:12:30:6120] P: WSI_TOK_(4) 'e'
'2020/03/10 09:12:30:6120] P: WSI_TOK_(4) '
[2020/03/10 09:12:30:6120] P: *
[2020/03/10 09:12:30:6120] P: WSI_TOKEN_SKIPPING_SAW_CR '
'
' 0x0D (role=0x10000000) wsi->lextable_pos=0_PART '
[2020/03/10 09:12:30:6120] P: WSI_TOKEN_NAME_PART '
' 0x0A (role=0x10000000) wsi->lextable_pos=167
[2020/03/10 09:12:30:6120] P: known hdr 8
[2020/03/10 09:12:30:6120] D: lws_client_interpret_server_handshake:
0x545a20: transitioning to h1 client
[2020/03/10 09:12:30:6120] D: lws_role_transition: 0x545a20: wsistate
0x10000119, ops h1
[2020/03/10 09:12:30:6120] I: lws_client_interpret_server_handshake:
incoming content length 0
[2020/03/10 09:12:30:6121] D: lws_ensure_user_space: 0x545a20 protocol
pss 8, user_space=0x540500
>>>>>>>>>>>>>> 0. LWS_CALLBACK_CLIENT_FILTER_PRE_ESTABLISH
>>>>>>>>>>>>>> 0. LWS_CALLBACK_ESTABLISHED_CLIENT_HTTP
LWS_CALLBACK_ESTABLISHED_CLIENT_HTTP: resp 200
[2020/03/10 09:12:30:6121] I: lws_client_interpret_server_handshake:
client connection up
[2020/03/10 09:12:30:6121] I: lws_http_transaction_completed_client:
wsi: 0x545a20 (http)
>>>>>>>>>>>>>> 0. LWS_CALLBACK_COMPLETED_CLIENT_HTTP
[2020/03/10 09:12:30:6121] D: __insert_wsi_socket_into_fds: 0x547260:
tsi=0, sock=10, pos-in-fds=1

Program received signal SIGSEGV, Segmentation fault.
0x00007ffff7dde5d8 in event_add () from /lib64/libevent-2.1.so.6
Missing separate debuginfos, use: dnf debuginfo-install
libevent-2.1.8-7.fc31.x86_64 lua-libs-5.3.5-6.fc31.x86_64
openssl-libs-1.1.1d-2.fc31.x86_64 zlib-1.2.11-20.fc31.x86_64
(gdb) bt
#0  0x00007ffff7dde5d8 in event_add () from /lib64/libevent-2.1.so.6
#1  0x0000000000430f80 in elops_io_event (wsi=0x547260, flags=5) at
../lib/event-libs/libevent/libevent.c:281
#2  0x0000000000430542 in lws_plat_insert_socket_into_fds
(context=0x46e3d0, wsi=0x547260) at ../lib/plat/unix/unix-fds.c:156
#3  0x0000000000416a39 in __insert_wsi_socket_into_fds
(context=0x46e3d0, wsi=0x547260) at ../lib/core-net/pollfd.c:318
#4  0x000000000041912d in
_lws_generic_transaction_completed_active_conn (_wsi=0x7fffffffd398)
at ../lib/core-net/wsi.c:840
#5  0x0000000000425cb9 in lws_http_transaction_completed_client
(wsi=0x545a20) at ../lib/roles/http/client/client-http.c:512
#6  0x00000000004268ab in lws_client_interpret_server_handshake
(wsi=0x545a20) at ../lib/roles/http/client/client-http.c:936
#7  0x0000000000425b49 in lws_client_socket_service (wsi=0x545a20,
pollfd=0x7fffffffd748) at ../lib/roles/http/client/client-http.c:471
#8  0x000000000041e652 in rops_handle_POLLIN_h1 (pt=0x46e4f0,
wsi=0x545a20, pollfd=0x7fffffffd748) at ../lib/roles/h1/ops-h1.c:695
#9  0x00000000004353cf in lws_service_fd_tsi (context=0x46e3d0,
pollfd=0x7fffffffd748, tsi=0) at ../lib/core-net/service.c:703
#10 0x000000000043097e in lws_event_cb (sock_fd=10, revents=2,
ctx=0x545ab8) at ../lib/event-libs/libevent/libevent.c:134
#11 0x00007ffff7ddfbb7 in event_process_active_single_queue () from
/lib64/libevent-2.1.so.6
#12 0x00007ffff7de030f in event_base_loop () from /lib64/libevent-2.1.so.6
#13 0x000000000040700c in start_event_loop () at ../src/agent.c:528
#14 0x00000000004081ec in main (argc=12, argv=0x7fffffffd9f8) at
../src/agent.c:1019
(gdb) up
#1  0x0000000000430f80 in elops_io_event (wsi=0x547260, flags=5) at
../lib/event-libs/libevent/libevent.c:281
281                event_add(wsi->w_read.event.watcher, NULL);
(gdb) p wsi->w_read
$1 = {event = {watcher = 0x0}, context = 0x0, actual_events = 0 '\000'}


More information about the Libwebsockets mailing list