Skip to content

Instantly share code, notes, and snippets.

@cpretzer
Last active May 18, 2020 19:26
Show Gist options
  • Save cpretzer/9ca269d17a9aa154e7c472b8cd8e7ab3 to your computer and use it in GitHub Desktop.
Save cpretzer/9ca269d17a9aa154e7c472b8cd8e7ab3 to your computer and use it in GitHub Desktop.
Squid repro files using https_proxy
apiVersion: apps/v1
kind: Deployment
metadata:
labels:
run: curl-261
name: curl-261
namespace: default
spec:
progressDeadlineSeconds: 600
replicas: 1
revisionHistoryLimit: 10
selector:
matchLabels:
run: curl-261
template:
metadata:
annotations:
linkerd.io/inject: enabled
config.linkerd.io/proxy-version: stable-2.6.1
labels:
run: curl-261
spec:
containers:
- args:
- sleep
- "3600"
image: curlimages/curl
imagePullPolicy: Always
name: curl-261
apiVersion: apps/v1
kind: Deployment
metadata:
labels:
run: curl-270
name: curl-270
namespace: default
spec:
progressDeadlineSeconds: 600
replicas: 1
revisionHistoryLimit: 10
selector:
matchLabels:
run: curl-270
template:
metadata:
annotations:
linkerd.io/inject: enabled
config.linkerd.io/proxy-version: stable-2.7.0
labels:
run: curl-270
spec:
containers:
- args:
- sleep
- "3600"
image: curlimages/curl
imagePullPolicy: Always
name: curl
2020-02-20T21:39:03.6708319Z TRCE [ 16450.151106s] outbound: linkerd2_proxy_transport::listen accepted peer.addr=10.244.0.144:47814 orig.addr=Some(V4(10.110.207.3:3128))
2020-02-20T21:39:03.6713079Z DBUG [ 16450.152792s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_proxy_transport::tls::accept skipping TLS reason=loopback
2020-02-20T21:39:03.6839983Z TRCE [ 16450.165361s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_proxy_http::upgrade server request wants HTTP/1.1 upgrade
2020-02-20T21:39:03.6857395Z TRCE [ 16450.167377s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}: linkerd2_router::layer routing...
2020-02-20T21:39:03.6885647Z DBUG [ 16450.170157s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}: linkerd2_router target not cached
2020-02-20T21:39:03.688613Z DBUG [ 16450.170258s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}: linkerd2_router inserting new target into cache
2020-02-20T21:39:03.6886354Z TRCE [ 16450.170302s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}: linkerd2_router::cache inserting an item into the cache
2020-02-20T21:39:03.6915648Z TRCE [ 16450.173083s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}: linkerd2_proxy_http::canonicalize task init; name=NameAddr { name: "www.google.com", port: 443 }
2020-02-20T21:39:03.7246369Z TRCE [ 16450.206038s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}: linkerd2_proxy_http::canonicalize task update; name=NameAddr { name: "www.google.com", port: 443 } refined="www.google.com"
2020-02-20T21:39:03.7248442Z TRCE [ 16450.206116s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}: linkerd2_proxy_http::canonicalize task idle; name=NameAddr { name: "www.google.com", port: 443 }
2020-02-20T21:39:03.7253572Z DBUG [ 16450.206180s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}: linkerd2_proxy_http::canonicalize refined: www.google.com:443
2020-02-20T21:39:03.7254133Z TRCE [ 16450.206863s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}: linkerd2_router::layer routing...
2020-02-20T21:39:03.7254391Z DBUG [ 16450.207116s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}: linkerd2_router target not cached
2020-02-20T21:39:03.7254581Z DBUG [ 16450.207188s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}: linkerd2_router inserting new target into cache
2020-02-20T21:39:03.7254824Z TRCE [ 16450.207209s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}: linkerd2_router::cache inserting an item into the cache
2020-02-20T21:39:03.7298074Z DBUG [ 16450.211089s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}: linkerd2_app_core::profiles name not in profile suffixes
2020-02-20T21:39:03.7299768Z TRCE [ 16450.211268s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}: linkerd2_proxy_http::profiles::recognize using default route
2020-02-20T21:39:03.7301228Z DBUG [ 16450.211538s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}: linkerd2_router target not cached
2020-02-20T21:39:03.7301529Z DBUG [ 16450.211566s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}: linkerd2_router inserting new target into cache
2020-02-20T21:39:03.7302749Z TRCE [ 16450.211586s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}: linkerd2_router::cache inserting an item into the cache
2020-02-20T21:39:03.7313025Z TRCE [ 16450.212883s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}: linkerd2_proxy_http::metrics::service make: target=Route { dst_addr: DstAddr { dst_logical: Name(NameAddr { name: "www.google.com", port: 443 }), dst_concrete: Name(NameAddr { name: "www.google.com", port: 443 }), direction: Out, http_settings: Http1 { keep_alive: true, wants_h1_upgrade: true, was_absolute_form: false } }, route: Route { labels: {}, response_classes: [], retries: None, timeout: None } }
2020-02-20T21:39:03.7314183Z TRCE [ 16450.212995s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}: linkerd2_proxy_http::metrics::service make: metrics=true
2020-02-20T21:39:03.7314429Z TRCE [ 16450.213027s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}: linkerd2_proxy_http::metrics::service make: target=Route { dst_addr: DstAddr { dst_logical: Name(NameAddr { name: "www.google.com", port: 443 }), dst_concrete: Name(NameAddr { name: "www.google.com", port: 443 }), direction: Out, http_settings: Http1 { keep_alive: true, wants_h1_upgrade: true, was_absolute_form: false } }, route: Route { labels: {}, response_classes: [], retries: None, timeout: None } }
2020-02-20T21:39:03.7314656Z TRCE [ 16450.213048s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}: linkerd2_proxy_http::metrics::service make: metrics=true
2020-02-20T21:39:03.732081Z DBUG [ 16450.213280s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}: linkerd2_router target not cached
2020-02-20T21:39:03.7321074Z DBUG [ 16450.213833s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}: linkerd2_router inserting new target into cache
2020-02-20T21:39:03.7321213Z TRCE [ 16450.213850s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}: linkerd2_router::cache inserting an item into the cache
2020-02-20T21:39:03.7339283Z TRCE [ 16450.214655s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}: linkerd2_request_filter rejected
2020-02-20T21:39:03.7339853Z TRCE [ 16450.214736s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}: linkerd2_fallback unresolvable matches; trying to fall back
2020-02-20T21:39:03.7352185Z TRCE [ 16450.216453s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}: linkerd2_router::layer routing...
2020-02-20T21:39:03.7354951Z DBUG [ 16450.217162s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}: linkerd2_router target not cached
2020-02-20T21:39:03.7367771Z DBUG [ 16450.218255s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}: linkerd2_router inserting new target into cache
2020-02-20T21:39:03.7369499Z TRCE [ 16450.218296s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}: linkerd2_router::cache inserting an item into the cache
2020-02-20T21:39:03.7375637Z TRCE [ 16450.219018s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}:endpoint{peer.addr=10.110.207.3:3128 peer.id=None(NoPeerName(NotProvidedByServiceDiscovery))}: linkerd2_proxy_http::metrics::service make: target=Endpoint { dst_logical: None, dst_concrete: None, addr: V4(10.110.207.3:3128), identity: None(NoPeerName(NotProvidedByServiceDiscovery)), metadata: Metadata { weight: 10000, labels: {}, protocol_hint: Unknown, identity: None }, http_settings: Http1 { keep_alive: true, wants_h1_upgrade: true, was_absolute_form: false } }
2020-02-20T21:39:03.7375856Z TRCE [ 16450.219089s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}:endpoint{peer.addr=10.110.207.3:3128 peer.id=None(NoPeerName(NotProvidedByServiceDiscovery))}: linkerd2_proxy_http::metrics::service make: metrics=true
2020-02-20T21:39:03.7376047Z DBUG [ 16450.219274s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}:endpoint{peer.addr=10.110.207.3:3128 peer.id=None(NoPeerName(NotProvidedByServiceDiscovery))}: linkerd2_proxy_http::client building client=Endpoint { dst_logical: None, dst_concrete: None, addr: V4(10.110.207.3:3128), identity: None(NoPeerName(NotProvidedByServiceDiscovery)), metadata: Metadata { weight: 10000, labels: {}, protocol_hint: Unknown, identity: None }, http_settings: Http1 { keep_alive: true, wants_h1_upgrade: true, was_absolute_form: false } }
2020-02-20T21:39:03.7391497Z TRCE [ 16450.220636s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}:endpoint{peer.addr=10.110.207.3:3128 peer.id=None(NoPeerName(NotProvidedByServiceDiscovery))}: linkerd2_proxy_http::h1 uri=www.google.com:443
2020-02-20T21:39:03.7391727Z TRCE [ 16450.220723s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}:endpoint{peer.addr=10.110.207.3:3128 peer.id=None(NoPeerName(NotProvidedByServiceDiscovery))}: linkerd2_proxy_http::h1 using host header
2020-02-20T21:39:03.7396223Z TRCE [ 16450.220644s] daemon:tap: linkerd2_proxy_tap::daemon retained 0 of 0 taps
2020-02-20T21:39:03.739853Z TRCE [ 16450.221447s] daemon:tap: linkerd2_proxy_tap::daemon removing a service
2020-02-20T21:39:03.7398859Z DBUG [ 16450.220772s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}:endpoint{peer.addr=10.110.207.3:3128 peer.id=None(NoPeerName(NotProvidedByServiceDiscovery))}: linkerd2_proxy_http::client client request: method=CONNECT uri=www.google.com:443 version=HTTP/1.1 headers={"host": "www.google.com:443", "user-agent": "curl/7.68.0-DEV", "proxy-connection": "Keep-Alive", "l5d-dst-canonical": "www.google.com:443"}
2020-02-20T21:39:03.7399197Z TRCE [ 16450.221608s] daemon:tap: linkerd2_proxy_tap::daemon registering a service
2020-02-20T21:39:03.7399481Z TRCE [ 16450.221627s] daemon:tap: linkerd2_proxy_tap::daemon service registered
2020-02-20T21:39:03.7438543Z DBUG [ 16450.225412s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}:endpoint{peer.addr=10.110.207.3:3128 peer.id=None(NoPeerName(NotProvidedByServiceDiscovery))}: linkerd2_proxy_transport::connect connecting to 10.110.207.3:3128
2020-02-20T21:39:03.7478164Z DBUG [ 16450.229138s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}:endpoint{peer.addr=10.110.207.3:3128 peer.id=None(NoPeerName(NotProvidedByServiceDiscovery))}: linkerd2_proxy_transport::connect connection established to 10.110.207.3:3128
2020-02-20T21:39:03.747906Z TRCE [ 16450.229216s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}:endpoint{peer.addr=10.110.207.3:3128 peer.id=None(NoPeerName(NotProvidedByServiceDiscovery))}: linkerd2_proxy_transport::tls::client skipping TLS reason=not_provided_by_service_discovery
2020-02-20T21:39:03.747936Z DBUG [ 16450.229246s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}:endpoint{peer.addr=10.110.207.3:3128 peer.id=None(NoPeerName(NotProvidedByServiceDiscovery))}: linkerd2_proxy_transport::metrics client connection open
2020-02-20T21:39:03.7938245Z TRCE [ 16450.275175s] outbound:accept{peer.addr=10.244.0.144:47814}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}:endpoint{peer.addr=10.110.207.3:3128 peer.id=None(NoPeerName(NotProvidedByServiceDiscovery))}: linkerd2_proxy_http::client client response is HTTP/1.1 upgrade
2020-02-20T21:39:03.7938981Z TRCE [ 16450.275597s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_proxy_http::upgrade HTTP/1.1 upgrade has both halves
2020-02-20T21:39:03.7981612Z TRCE [ 16450.279709s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_proxy_http::upgrade HTTP upgrade successful
2020-02-20T21:39:03.7988247Z TRCE [ 16450.280381s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex poll
2020-02-20T21:39:03.798967Z TRCE [ 16450.280417s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.7991317Z TRCE [ 16450.280443s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.8078331Z TRCE [ 16450.289448s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex poll
2020-02-20T21:39:03.8079989Z TRCE [ 16450.289462s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.8080209Z TRCE [ 16450.289474s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex read 517B
2020-02-20T21:39:03.8080371Z TRCE [ 16450.289482s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex writing 517B
2020-02-20T21:39:03.8080664Z TRCE [ 16450.289670s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex wrote 517B
2020-02-20T21:39:03.8080885Z TRCE [ 16450.289678s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.8081191Z TRCE [ 16450.289693s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.8395106Z TRCE [ 16450.320614s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex poll
2020-02-20T21:39:03.8395851Z TRCE [ 16450.320677s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.8396224Z TRCE [ 16450.320700s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.8397958Z TRCE [ 16450.320803s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex read 2641B
2020-02-20T21:39:03.8398342Z TRCE [ 16450.320821s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex writing 2641B
2020-02-20T21:39:03.840069Z TRCE [ 16450.321596s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex wrote 2641B
2020-02-20T21:39:03.8401225Z TRCE [ 16450.321643s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.851857Z TRCE [ 16450.332088s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex poll
2020-02-20T21:39:03.8519395Z TRCE [ 16450.332113s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.8519686Z TRCE [ 16450.332133s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex read 80B
2020-02-20T21:39:03.8520002Z TRCE [ 16450.332141s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex writing 80B
2020-02-20T21:39:03.8520202Z TRCE [ 16450.332199s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex wrote 80B
2020-02-20T21:39:03.8520572Z TRCE [ 16450.332207s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.8520909Z TRCE [ 16450.332214s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.8548298Z TRCE [ 16450.336200s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex poll
2020-02-20T21:39:03.8548626Z TRCE [ 16450.336259s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.8548897Z TRCE [ 16450.336314s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex read 130B
2020-02-20T21:39:03.8549148Z TRCE [ 16450.336329s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex writing 130B
2020-02-20T21:39:03.8549318Z TRCE [ 16450.336450s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex wrote 130B
2020-02-20T21:39:03.8549534Z TRCE [ 16450.336466s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.8549753Z TRCE [ 16450.336479s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.8565518Z TRCE [ 16450.337982s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex poll
2020-02-20T21:39:03.856587Z TRCE [ 16450.338051s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.8567441Z TRCE [ 16450.338073s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex read 66B
2020-02-20T21:39:03.8567702Z TRCE [ 16450.338086s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex writing 66B
2020-02-20T21:39:03.8567877Z TRCE [ 16450.338158s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex wrote 66B
2020-02-20T21:39:03.8568107Z TRCE [ 16450.338166s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.8568322Z TRCE [ 16450.338174s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.8627843Z TRCE [ 16450.344354s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex poll
2020-02-20T21:39:03.8628487Z TRCE [ 16450.344372s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.8628683Z TRCE [ 16450.344387s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.8628884Z TRCE [ 16450.344402s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex read 643B
2020-02-20T21:39:03.8629109Z TRCE [ 16450.344411s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex writing 643B
2020-02-20T21:39:03.8630889Z TRCE [ 16450.344461s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex wrote 643B
2020-02-20T21:39:03.8631314Z TRCE [ 16450.344576s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.864559Z TRCE [ 16450.345839s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex poll
2020-02-20T21:39:03.8645885Z TRCE [ 16450.345858s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.86461Z TRCE [ 16450.345876s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex read 31B
2020-02-20T21:39:03.8646319Z TRCE [ 16450.345890s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex writing 31B
2020-02-20T21:39:03.8647158Z TRCE [ 16450.345945s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex wrote 31B
2020-02-20T21:39:03.8647372Z TRCE [ 16450.345951s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.8647588Z TRCE [ 16450.345971s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.9252008Z TRCE [ 16450.406240s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex poll
2020-02-20T21:39:03.9252684Z TRCE [ 16450.406292s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.9252963Z TRCE [ 16450.406313s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.9253213Z TRCE [ 16450.406339s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex read 3574B
2020-02-20T21:39:03.9253697Z TRCE [ 16450.406348s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex writing 3574B
2020-02-20T21:39:03.9254114Z TRCE [ 16450.406463s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex wrote 3574B
2020-02-20T21:39:03.9254364Z TRCE [ 16450.406511s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.926071Z TRCE [ 16450.407283s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex poll
2020-02-20T21:39:03.9262293Z TRCE [ 16450.407474s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.9262597Z TRCE [ 16450.407496s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.9262895Z TRCE [ 16450.407517s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex read 1334B
2020-02-20T21:39:03.9263173Z TRCE [ 16450.407525s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex writing 1334B
2020-02-20T21:39:03.9263675Z TRCE [ 16450.407702s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex wrote 1334B
2020-02-20T21:39:03.9263927Z TRCE [ 16450.407719s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.9294796Z TRCE [ 16450.410064s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex poll
2020-02-20T21:39:03.9295192Z TRCE [ 16450.410273s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.929554Z TRCE [ 16450.410319s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.9296162Z TRCE [ 16450.410391s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex read 4096B
2020-02-20T21:39:03.9301427Z TRCE [ 16450.410585s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex writing 4096B
2020-02-20T21:39:03.9301693Z TRCE [ 16450.410686s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex wrote 4096B
2020-02-20T21:39:03.9302107Z TRCE [ 16450.410732s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.9302559Z TRCE [ 16450.410749s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex read 3204B
2020-02-20T21:39:03.9302981Z TRCE [ 16450.410759s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex writing 3204B
2020-02-20T21:39:03.9304852Z TRCE [ 16450.410871s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex wrote 3204B
2020-02-20T21:39:03.9305397Z TRCE [ 16450.411036s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.9305775Z TRCE [ 16450.411085s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex read 607B
2020-02-20T21:39:03.9306057Z TRCE [ 16450.411453s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex writing 607B
2020-02-20T21:39:03.9306302Z TRCE [ 16450.411980s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex wrote 607B
2020-02-20T21:39:03.9306494Z TRCE [ 16450.412298s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.9311083Z TRCE [ 16450.412425s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex poll
2020-02-20T21:39:03.9312337Z TRCE [ 16450.412433s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.9312742Z TRCE [ 16450.412474s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex read 63B
2020-02-20T21:39:03.9313102Z TRCE [ 16450.412486s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex writing 63B
2020-02-20T21:39:03.9313357Z TRCE [ 16450.412719s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex wrote 63B
2020-02-20T21:39:03.9313602Z TRCE [ 16450.412751s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.9313789Z TRCE [ 16450.412776s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.9332962Z TRCE [ 16450.414152s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex poll
2020-02-20T21:39:03.9333483Z TRCE [ 16450.414289s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.9333749Z TRCE [ 16450.414402s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex read 0B
2020-02-20T21:39:03.9334015Z TRCE [ 16450.414432s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex eof
2020-02-20T21:39:03.9334344Z TRCE [ 16450.414444s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex shutting down
2020-02-20T21:39:03.9334592Z TRCE [ 16450.414746s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.9393804Z TRCE [ 16450.420870s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex poll
2020-02-20T21:39:03.9408363Z TRCE [ 16450.420920s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex already shutdown
2020-02-20T21:39:03.9409123Z TRCE [ 16450.422134s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex reading
2020-02-20T21:39:03.9409357Z TRCE [ 16450.422152s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex read 0B
2020-02-20T21:39:03.9409601Z TRCE [ 16450.422173s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex eof
2020-02-20T21:39:03.9409849Z TRCE [ 16450.422188s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_duplex shutting down
2020-02-20T21:39:03.9418577Z INFO [ 16450.422334s] outbound:accept{peer.addr=10.244.0.144:47814}: linkerd2_proxy_http::upgrade tcp duplex error: Transport endpoint is not connected (os error 107)
2020-02-20T17:47:50.4522058Z [ 5589.989191700s] TRACE outbound: linkerd2_proxy_transport::listen: accepted peer.addr=10.244.0.145:55022 orig.addr=Some(V4(10.110.207.3:3128))
2020-02-20T17:47:50.4522711Z [ 5589.989256100s] DEBUG outbound:accept{peer.addr=10.244.0.145:55022}: linkerd2_proxy_transport::tls::accept: skipping TLS reason=loopback
2020-02-20T17:47:50.4522988Z [ 5589.989462000s] TRACE outbound:accept{peer.addr=10.244.0.145:55022}: linkerd2_proxy_http::upgrade: server request wants HTTP/1.1 upgrade
2020-02-20T17:47:50.4523179Z [ 5589.989514000s] TRACE outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}: linkerd2_router::layer: routing...
2020-02-20T17:47:50.4523664Z [ 5589.989542700s] DEBUG outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}: linkerd2_router: target not cached
2020-02-20T17:47:50.4523913Z [ 5589.989652200s] DEBUG outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}: linkerd2_router: inserting new target into cache
2020-02-20T17:47:50.452413Z [ 5589.989665700s] TRACE outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}: linkerd2_router::cache: inserting an item into the cache
2020-02-20T17:47:50.4534966Z [ 5589.989807500s] TRACE outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}: linkerd2_proxy_http::canonicalize: task init; name=NameAddr { name: "www.google.com", port: 443 }
2020-02-20T17:47:50.4732316Z [ 5590.10288600s] TRACE outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}: linkerd2_proxy_http::canonicalize: task update; name=NameAddr { name: "www.google.com", port: 443 } refined="www.google.com"
2020-02-20T17:47:50.4732937Z [ 5590.10347200s] TRACE outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}: linkerd2_proxy_http::canonicalize: task idle; name=NameAddr { name: "www.google.com", port: 443 }
2020-02-20T17:47:50.4733208Z [ 5590.10406600s] DEBUG outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}: linkerd2_proxy_http::canonicalize: refined: www.google.com:443
2020-02-20T17:47:50.4733447Z [ 5590.10435800s] TRACE outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}: linkerd2_router::layer: routing...
2020-02-20T17:47:50.4733813Z [ 5590.10617300s] DEBUG outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}: linkerd2_router: target not cached
2020-02-20T17:47:50.4734112Z [ 5590.10638800s] DEBUG outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}: linkerd2_router: inserting new target into cache
2020-02-20T17:47:50.4734317Z [ 5590.10648200s] TRACE outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}: linkerd2_router::cache: inserting an item into the cache
2020-02-20T17:47:50.4737261Z [ 5590.10767600s] DEBUG outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}: linkerd2_app_core::profiles: name not in profile suffixes
2020-02-20T17:47:50.4738629Z [ 5590.10798000s] TRACE outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}: linkerd2_proxy_http::profiles::recognize: using default route
2020-02-20T17:47:50.473885Z [ 5590.10899100s] DEBUG outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}: linkerd2_router: target not cached
2020-02-20T17:47:50.473982Z [ 5590.10915000s] DEBUG outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}: linkerd2_router: inserting new target into cache
2020-02-20T17:47:50.4740076Z [ 5590.10927300s] TRACE outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}: linkerd2_router::cache: inserting an item into the cache
2020-02-20T17:47:50.4758193Z [ 5590.11817700s] TRACE outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}: linkerd2_retry: retryable=false
2020-02-20T17:47:50.4759236Z [ 5590.11931300s] DEBUG outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}: linkerd2_router: target not cached
2020-02-20T17:47:50.4759564Z [ 5590.11956600s] DEBUG outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}: linkerd2_router: inserting new target into cache
2020-02-20T17:47:50.4787657Z [ 5590.11984300s] TRACE outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}: linkerd2_router::cache: inserting an item into the cache
2020-02-20T17:47:50.4795596Z [ 5590.12125900s] TRACE outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}: linkerd2_request_filter: rejected
2020-02-20T17:47:50.4795857Z [ 5590.12191700s] TRACE outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}: linkerd2_fallback: unresolvable matches; trying to fall back
2020-02-20T17:47:50.4797081Z [ 5590.13192000s] TRACE outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}: linkerd2_router::layer: routing...
2020-02-20T17:47:50.4797384Z [ 5590.13528100s] DEBUG outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}: linkerd2_router: target not cached
2020-02-20T17:47:50.4797631Z [ 5590.13635200s] DEBUG outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}: linkerd2_router: inserting new target into cache
2020-02-20T17:47:50.4798044Z [ 5590.13651000s] TRACE outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}: linkerd2_router::cache: inserting an item into the cache
2020-02-20T17:47:50.479991Z [ 5590.14318700s] TRACE outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}:endpoint{peer.addr=10.110.207.3:3128 peer.id=None(NoPeerName(NotProvidedByServiceDiscovery))}: linkerd2_proxy_http::normalize_uri: make authority=Some(10.110.207.3:3128)
2020-02-20T17:47:50.480046Z [ 5590.14447900s] DEBUG outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}:endpoint{peer.addr=10.110.207.3:3128 peer.id=None(NoPeerName(NotProvidedByServiceDiscovery))}: linkerd2_proxy_http::client: building client=Endpoint { dst_logical: None, dst_concrete: None, addr: V4(10.110.207.3:3128), identity: None(NoPeerName(NotProvidedByServiceDiscovery)), metadata: Metadata { weight: 10000, labels: {}, protocol_hint: Unknown, identity: None }, http_settings: Http1 { keep_alive: true, wants_h1_upgrade: true, was_absolute_form: false } }
2020-02-20T17:47:50.4800749Z [ 5590.14633800s] TRACE outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}:endpoint{peer.addr=10.110.207.3:3128 peer.id=None(NoPeerName(NotProvidedByServiceDiscovery))}: linkerd2_proxy_http::normalize_uri: Normalizing URI authority=10.110.207.3:3128
2020-02-20T17:47:50.4800937Z [ 5590.14660300s] DEBUG outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}:endpoint{peer.addr=10.110.207.3:3128 peer.id=None(NoPeerName(NotProvidedByServiceDiscovery))}: linkerd2_proxy_http::client: client request: method=CONNECT uri=10.110.207.3:3128 version=HTTP/1.1 headers={"host": "www.google.com:443", "user-agent": "curl/7.68.0-DEV", "proxy-connection": "Keep-Alive", "l5d-dst-canonical": "www.google.com:443"}
2020-02-20T17:47:50.4802174Z [ 5590.14793200s] DEBUG outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}:endpoint{peer.addr=10.110.207.3:3128 peer.id=None(NoPeerName(NotProvidedByServiceDiscovery))}: linkerd2_proxy_transport::connect: connecting to 10.110.207.3:3128
2020-02-20T17:47:50.480243Z [ 5590.15345300s] TRACE daemon:tap: linkerd2_proxy_tap::daemon: retained 0 of 0 taps
2020-02-20T17:47:50.4802629Z [ 5590.15411000s] TRACE daemon:tap: linkerd2_proxy_tap::daemon: removing a service
2020-02-20T17:47:50.480286Z [ 5590.15432900s] TRACE daemon:tap: linkerd2_proxy_tap::daemon: registering a service
2020-02-20T17:47:50.4803067Z [ 5590.15442700s] DEBUG outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}:endpoint{peer.addr=10.110.207.3:3128 peer.id=None(NoPeerName(NotProvidedByServiceDiscovery))}: linkerd2_proxy_transport::connect: connection established to 10.110.207.3:3128
2020-02-20T17:47:50.4803376Z [ 5590.15451200s] TRACE daemon:tap: linkerd2_proxy_tap::daemon: service registered
2020-02-20T17:47:50.4803608Z [ 5590.15473600s] TRACE outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}:endpoint{peer.addr=10.110.207.3:3128 peer.id=None(NoPeerName(NotProvidedByServiceDiscovery))}: linkerd2_proxy_transport::tls::client: skipping TLS reason=not_provided_by_service_discovery
2020-02-20T17:47:50.4803841Z [ 5590.15491100s] DEBUG outbound:accept{peer.addr=10.244.0.145:55022}:source{target.addr=10.110.207.3:3128}:addr{addr=www.google.com:443}:logical{dst.logical=www.google.com:443}:concrete{dst.concrete=www.google.com:443}:endpoint{peer.addr=10.110.207.3:3128 peer.id=None(NoPeerName(NotProvidedByServiceDiscovery))}: linkerd2_proxy_transport::metrics: client connection open
2020-02-20T17:47:50.4892446Z [ 5590.21770100s] TRACE outbound:accept{peer.addr=10.244.0.145:55022}: linkerd2_proxy_http::upgrade: HTTP/1.1 upgrade has both halves
2020-02-20T17:47:50.489423Z [ 5590.23502200s] DEBUG outbound:accept{peer.addr=10.244.0.145:55022}: linkerd2_proxy_http::upgrade: client HTTP upgrade error: no upgrade available
2020-02-20T17:47:52.8378126Z [ 5592.374899400s] TRACE daemon:admin{listen.addr=0.0.0.0:4191}: linkerd2_proxy_transport::listen: accepted peer.addr=10.244.0.1:60820 orig.addr=None
2020-02-20T17:47:52.8379202Z [ 5592.375002800s] DEBUG daemon:admin{listen.addr=0.0.0.0:4191}:accept{peer.addr=10.244.0.1:60820}: linkerd2_proxy_transport::tls::accept: attempting TLS handshake
2020-02-20T17:47:52.8379723Z [ 5592.375253900s] TRACE daemon:admin{listen.addr=0.0.0.0:4191}:accept{peer.addr=10.244.0.1:60820}: linkerd2_proxy_transport::tls::accept: read sz=121
2020-02-20T17:47:52.8380015Z [ 5592.375308300s] TRACE daemon:admin{listen.addr=0.0.0.0:4191}:accept{peer.addr=10.244.0.1:60820}: linkerd2_proxy_transport::tls::conditional_accept: match_client_hello: failed to parse up to SNI
2020-02-20T17:47:52.8380441Z [ 5592.375328000s] TRACE daemon:admin{listen.addr=0.0.0.0:4191}:accept{peer.addr=10.244.0.1:60820}: linkerd2_proxy_transport::tls::accept: conditional_accept sni=default.default.serviceaccount.identity.linkerd.cluster.local match=NotMatched
2020-02-20T17:47:52.8385809Z [ 5592.375342500s] TRACE daemon:admin{listen.addr=0.0.0.0:4191}:accept{peer.addr=10.244.0.1:60820}: linkerd2_proxy_transport::tls::accept: passing through accepted connection without TLS
2020-02-20T17:47:52.8386126Z [ 5592.375445000s] TRACE daemon:admin{listen.addr=0.0.0.0:4191}:accept{peer.addr=10.244.0.1:60820}: linkerd2_metrics::serve: gzipping metrics
2020-02-20T17:47:52.8386411Z [ 5592.375487000s] TRACE daemon:admin{listen.addr=0.0.0.0:4191}:accept{peer.addr=10.244.0.1:60820}: linkerd2_http_metrics::requests::report: Formatting HTTP request metrics prfefix= targets=1
2020-02-20T17:47:52.8386739Z [ 5592.375935500s] TRACE daemon:admin{listen.addr=0.0.0.0:4191}:accept{peer.addr=10.244.0.1:60820}: linkerd2_http_metrics::requests::report: Formatting HTTP request metrics prfefix=route targets=1
2020-02-20T17:47:52.8390142Z [ 5592.376144500s] TRACE daemon:admin{listen.addr=0.0.0.0:4191}:accept{peer.addr=10.244.0.1:60820}: linkerd2_http_metrics::retries: Formatting HTTP retry metrics prfefix=route targets=0
2020-02-20T17:47:52.8390352Z [ 5592.376244900s] TRACE daemon:admin{listen.addr=0.0.0.0:4191}:accept{peer.addr=10.244.0.1:60820}: linkerd2_http_metrics::requests::report: Formatting HTTP request metrics prfefix=route_actual targets=1
2020-02-20T17:47:52.8396442Z [ 5592.376818600s] TRACE daemon:admin{listen.addr=0.0.0.0:4191}:accept{peer.addr=10.244.0.1:60820}: linkerd2_http_metrics::requests::report: Formatting HTTP request metrics prfefix=control targets=1
2020-02-20T17:47:53.5847853Z [ 5593.121937900s] TRACE daemon:admin{listen.addr=0.0.0.0:4191}:accept{peer.addr=10.244.0.130:41936}: linkerd2_metrics::serve: gzipping metrics
2020-02-20T17:47:53.5848599Z [ 5593.121982600s] TRACE daemon:admin{listen.addr=0.0.0.0:4191}:accept{peer.addr=10.244.0.130:41936}: linkerd2_http_metrics::requests::report: Formatting HTTP request metrics prfefix= targets=1
2020-02-20T17:47:53.5848944Z [ 5593.122063800s] TRACE daemon:admin{listen.addr=0.0.0.0:4191}:accept{peer.addr=10.244.0.130:41936}: linkerd2_http_metrics::requests::report: Formatting HTTP request metrics prfefix=route targets=1
2020-02-20T17:47:53.584992Z [ 5593.122183700s] TRACE daemon:admin{listen.addr=0.0.0.0:4191}:accept{peer.addr=10.244.0.130:41936}: linkerd2_http_metrics::retries: Formatting HTTP retry metrics prfefix=route targets=0
2020-02-20T17:47:53.5850153Z [ 5593.122221100s] TRACE daemon:admin{listen.addr=0.0.0.0:4191}:accept{peer.addr=10.244.0.130:41936}: linkerd2_http_metrics::requests::report: Formatting HTTP request metrics prfefix=route_actual targets=1
2020-02-20T17:47:53.5850314Z [ 5593.122293200s] TRACE daemon:admin{listen.addr=0.0.0.0:4191}:accept{peer.addr=10.244.0.130:41936}: linkerd2_http_metrics::requests::report: Formatting HTTP request metrics prfefix=control targets=1
2020-02-20T17:47:56.6135165Z [ 5596.150683800s] TRACE daemon:admin{listen.addr=0.0.0.0:4191}: linkerd2_proxy_transport::listen: accepted peer.addr=10.244.0.1:60882 orig.addr=None
2020-02-20T17:47:56.6135906Z [ 5596.150732600s] DEBUG daemon:admin{listen.addr=0.0.0.0:4191}:accept{peer.addr=10.244.0.1:60882}: linkerd2_proxy_transport::tls::accept: attempting TLS handshake
2020-02-20T17:47:56.6136846Z [ 5596.150898000s] TRACE daemon:admin{listen.addr=0.0.0.0:4191}:accept{peer.addr=10.244.0.1:60882}: linkerd2_proxy_transport::tls::accept: read sz=119
2020-02-20T17:47:56.6137119Z [ 5596.150930500s] TRACE daemon:admin{listen.addr=0.0.0.0:4191}:accept{peer.addr=10.244.0.1:60882}: linkerd2_proxy_transport::tls::conditional_accept: match_client_hello: failed to parse up to SNI
2020-02-20T17:47:56.6137431Z [ 5596.150945400s] TRACE daemon:admin{listen.addr=0.0.0.0:4191}:accept{peer.addr=10.244.0.1:60882}: linkerd2_proxy_transport::tls::accept: conditional_accept sni=default.default.serviceaccount.identity.linkerd.cluster.local match=NotMatched
2020-02-20T17:47:56.6137684Z [ 5596.150969800s] TRACE daemon:admin{listen.addr=0.0.0.0:4191}:accept{peer.addr=10.244.0.1:60882}: linkerd2_proxy_transport::tls::accept: passing through accepted connection without TLS
2020/02/20 00:27:38.961| 5,2| TcpAcceptor.cc(220) doAccept: New connection on FD 12
2020/02/20 00:27:38.961| 5,2| TcpAcceptor.cc(295) acceptNext: connection on local=[::]:3128 remote=[::] FD 12 flags=9
2020/02/20 00:27:38.961| 51,3| fd.cc(198) fd_open: fd_open() FD 11 HTTP Request
2020/02/20 00:27:38.961| 28,4| Eui48.cc(178) lookup: id=0x562ba4967f74 query ARP table
2020/02/20 00:27:38.962| 28,4| Eui48.cc(222) lookup: id=0x562ba4967f74 query ARP on each interface (80 found)
2020/02/20 00:27:38.962| 28,4| Eui48.cc(228) lookup: id=0x562ba4967f74 found interface lo
2020/02/20 00:27:38.962| 28,4| Eui48.cc(228) lookup: id=0x562ba4967f74 found interface eth0
2020/02/20 00:27:38.962| 28,4| Eui48.cc(237) lookup: id=0x562ba4967f74 looking up ARP address for 10.244.0.144 on eth0
2020/02/20 00:27:38.962| 28,3| Eui48.cc(516) lookup: id=0x562ba4967f74 10.244.0.144 NOT found
2020/02/20 00:27:38.962| 33,4| client_side.cc(3674) httpAccept: local=10.244.0.147:3128 remote=10.244.0.144:56052 FD 11 flags=1: accepted
2020/02/20 00:27:38.962| 35,4| fqdncache.cc(425) fqdncache_nbgethostbyaddr: fqdncache_nbgethostbyaddr: Name '10.244.0.144'.
2020/02/20 00:27:38.962| 78,3| dns_internal.cc(1794) idnsPTRLookup: idnsPTRLookup: buf is 43 bytes for 10.244.0.144, id = 0x261f
2020/02/20 00:27:38.964| 50,3| comm.cc(957) comm_udp_sendto: comm_udp_sendto: Attempt to send UDP packet to 10.96.0.10:53 using FD 9 using Port 52080
2020/02/20 00:27:38.965| 28,4| FilledChecklist.cc(66) ~ACLFilledChecklist: ACLFilledChecklist destroyed 0x7ffc0d8cf278
2020/02/20 00:27:38.965| 28,4| Checklist.cc(197) ~ACLChecklist: ACLChecklist::~ACLChecklist: destroyed 0x7ffc0d8cf278
2020/02/20 00:27:38.965| 5,3| comm.cc(553) commSetConnTimeout: local=10.244.0.147:3128 remote=10.244.0.144:56052 FD 11 flags=1 timeout 300
2020/02/20 00:27:38.965| 33,4| client_side.cc(231) readSomeData: local=10.244.0.147:3128 remote=10.244.0.144:56052 FD 11 flags=1: reading request...
2020/02/20 00:27:38.967| 5,3| IoCallback.cc(116) finish: called for local=10.244.0.147:3128 remote=10.244.0.144:56052 FD 11 flags=1 (0, 0)
2020/02/20 00:27:38.967| 5,3| Read.cc(91) ReadNow: local=10.244.0.147:3128 remote=10.244.0.144:56052 FD 11 flags=1, size 16382, retval 163, errno 0
2020/02/20 00:27:38.967| 33,3| client_side.cc(2259) parseHttpRequest: parseHttpRequest: req_hdr = {host: www.google.com:443
user-agent: curl/7.68.0-DEV
proxy-connection: Keep-Alive
l5d-dst-canonical: www.google.com:443
}
2020/02/20 00:27:38.967| 33,3| client_side.cc(2263) parseHttpRequest: parseHttpRequest: end = {
}
2020/02/20 00:27:38.967| 33,3| client_side.cc(2267) parseHttpRequest: parseHttpRequest: prefix_sz = 163, req_line_sz = 37
2020/02/20 00:27:38.967| 87,3| clientStream.cc(144) clientStreamInsertHead: clientStreamInsertHead: Inserted node 0x562ba45c5b18 with data 0x562ba496b090 after head
2020/02/20 00:27:38.967| 11,2| client_side.cc(2346) parseHttpRequest: HTTP Client local=10.244.0.147:3128 remote=10.244.0.144:56052 FD 11 flags=1
2020/02/20 00:27:38.967| 11,2| client_side.cc(2347) parseHttpRequest: HTTP Client REQUEST:
---------
CONNECT www.google.com:443 HTTP/1.1
host: www.google.com:443
user-agent: curl/7.68.0-DEV
proxy-connection: Keep-Alive
l5d-dst-canonical: www.google.com:443
----------
2020/02/20 00:27:38.967| 5,4| AsyncCall.cc(26) AsyncCall: The AsyncCall clientLifetimeTimeout constructed, this=0x562ba45c5ba0 [call1404]
2020/02/20 00:27:38.968| 5,3| comm.cc(553) commSetConnTimeout: local=10.244.0.147:3128 remote=10.244.0.144:56052 FD 11 flags=1 timeout 86400
2020/02/20 00:27:38.968| 23,3| url.cc(357) urlParse: urlParse: Split URL 'www.google.com:443' into proto='', host='www.google.com', port='443', path=''
2020/02/20 00:27:38.968| 14,3| Address.cc(389) lookupHostIP: Given Non-IP 'www.google.com': Name does not resolve
2020/02/20 00:27:38.968| 33,3| client_side.cc(874) clientSetKeepaliveFlag: http_ver = HTTP/1.1
2020/02/20 00:27:38.968| 33,3| client_side.cc(875) clientSetKeepaliveFlag: method = CONNECT
2020/02/20 00:27:38.968| 33,3| client_side.h(96) mayUseConnection: This 0x562ba496a018 marked 1
2020/02/20 00:27:38.968| 85,3| client_side_request.cc(130) ClientRequestContext: 0x562ba45c63f8 ClientRequestContext constructed
2020/02/20 00:27:38.968| 83,3| client_side_request.cc(1685) doCallouts: Doing calloutContext->hostHeaderVerify()
2020/02/20 00:27:38.968| 85,3| client_side_request.cc(632) hostHeaderVerify: validate host=www.google.com, port=443, portStr=443
2020/02/20 00:27:38.968| 85,3| client_side_request.cc(646) hostHeaderVerify: validate skipped.
2020/02/20 00:27:38.968| 83,3| client_side_request.cc(1692) doCallouts: Doing calloutContext->clientAccessCheck()
2020/02/20 00:27:38.968| 28,3| Checklist.cc(70) preCheck: 0x562ba496c7b8 checking slow rules
2020/02/20 00:27:38.968| 28,3| Ip.cc(539) match: aclIpMatchIp: '10.244.0.144:56052' NOT found
2020/02/20 00:27:38.968| 28,3| Acl.cc(158) matches: checked: localhost = 0
2020/02/20 00:27:38.968| 28,3| Acl.cc(158) matches: checked: http_access#1 = 0
2020/02/20 00:27:38.968| 14,3| ipcache.cc(619) ipcache_gethostbyname: ipcache_gethostbyname: 'www.google.com', flags=1
2020/02/20 00:27:38.968| 14,3| Address.cc(389) lookupHostIP: Given Non-IP 'www.google.com': Name does not resolve
2020/02/20 00:27:38.968| 14,4| ipcache.cc(501) ipcache_nbgethostbyname: ipcache_nbgethostbyname: Name 'www.google.com'.
2020/02/20 00:27:38.968| 14,3| Address.cc(389) lookupHostIP: Given Non-IP 'www.google.com': Name does not resolve
2020/02/20 00:27:38.968| 78,3| dns_internal.cc(1745) idnsALookup: idnsALookup: buf is 32 bytes for www.google.com, id = 0xab58
2020/02/20 00:27:38.968| 50,3| comm.cc(957) comm_udp_sendto: comm_udp_sendto: Attempt to send UDP packet to 10.96.0.10:53 using FD 9 using Port 52080
2020/02/20 00:27:38.968| 78,3| dns_internal.cc(1683) idnsSendSlaveAAAAQuery: buf is 32 bytes for www.google.com, id = 0x757e
2020/02/20 00:27:38.968| 50,3| comm.cc(957) comm_udp_sendto: comm_udp_sendto: Attempt to send UDP packet to 10.96.0.10:53 using FD 9 using Port 52080
2020/02/20 00:27:38.968| 28,3| DestinationIp.cc(70) match: aclMatchAcl: Can't yet compare 'to_localhost' ACL for 'www.google.com'
2020/02/20 00:27:38.968| 14,4| ipcache.cc(501) ipcache_nbgethostbyname: ipcache_nbgethostbyname: Name 'www.google.com'.
2020/02/20 00:27:38.968| 14,3| Address.cc(389) lookupHostIP: Given Non-IP 'www.google.com': Name does not resolve
2020/02/20 00:27:38.968| 28,3| Acl.cc(158) matches: checked: to_localhost = -1 async
2020/02/20 00:27:38.968| 28,3| Acl.cc(158) matches: checked: http_access#2 = -1 async
2020/02/20 00:27:38.968| 28,3| Acl.cc(158) matches: checked: http_access = -1 async
2020/02/20 00:27:38.968| 33,3| client_side.cc(3234) clientParseRequests: Not parsing new requests, as this request may need the connection
2020/02/20 00:27:38.969| 78,3| dns_internal.cc(1277) idnsRead: idnsRead: starting with FD 9
2020/02/20 00:27:38.969| 78,3| dns_internal.cc(1323) idnsRead: idnsRead: FD 9: received 62 bytes from 10.96.0.10:53
2020/02/20 00:27:38.969| 78,3| dns_internal.cc(1130) idnsGrokReply: idnsGrokReply: QID 0xab58, 1 answers
2020/02/20 00:27:38.969| 78,3| dns_internal.cc(1323) idnsRead: idnsRead: FD 9: received 43 bytes from 10.96.0.10:53
2020/02/20 00:27:38.969| 78,3| dns_internal.cc(1130) idnsGrokReply: idnsGrokReply: QID 0x261f, -3 answers
2020/02/20 00:27:38.969| 78,3| dns_internal.cc(1195) idnsGrokReply: idnsGrokReply: error Name Error: The domain name does not exist. (3)
2020/02/20 00:27:38.969| 35,3| fqdncache.cc(331) fqdncacheParse: fqdncacheParse: Lookup of '10.244.0.144' failed (Name Error: The domain name does not exist.)
2020/02/20 00:27:38.975| 78,3| dns_internal.cc(1277) idnsRead: idnsRead: starting with FD 9
2020/02/20 00:27:38.975| 78,3| dns_internal.cc(1323) idnsRead: idnsRead: FD 9: received 74 bytes from 10.96.0.10:53
2020/02/20 00:27:38.975| 78,3| dns_internal.cc(1130) idnsGrokReply: idnsGrokReply: QID 0x757e, 1 answers
2020/02/20 00:27:38.975| 14,3| ipcache.cc(364) ipcacheParse: ipcacheParse: 2 answers for 'www.google.com'
2020/02/20 00:27:38.975| 14,3| ipcache.cc(433) ipcacheParse: ipcacheParse: www.google.com #0 [2607:f8b0:4005:808::2004]
2020/02/20 00:27:38.975| 14,3| ipcache.cc(422) ipcacheParse: ipcacheParse: www.google.com #1 172.217.5.100
2020/02/20 00:27:38.975| 14,3| ipcache.cc(364) ipcacheParse: ipcacheParse: 2 answers for 'www.google.com'
2020/02/20 00:27:38.975| 14,3| ipcache.cc(433) ipcacheParse: ipcacheParse: www.google.com #0 [2607:f8b0:4005:808::2004]
2020/02/20 00:27:38.975| 14,3| ipcache.cc(422) ipcacheParse: ipcacheParse: www.google.com #1 172.217.5.100
2020/02/20 00:27:38.975| 14,3| ipcache.cc(174) ipcacheRelease: ipcacheRelease: Releasing entry for 'www.google.com'
2020/02/20 00:27:38.975| 14,3| ipcache.cc(619) ipcache_gethostbyname: ipcache_gethostbyname: 'www.google.com', flags=1
2020/02/20 00:27:38.975| 28,3| Ip.cc(539) match: aclIpMatchIp: '[2607:f8b0:4005:808::2004]' NOT found
2020/02/20 00:27:38.975| 28,3| Ip.cc(539) match: aclIpMatchIp: '172.217.5.100' NOT found
2020/02/20 00:27:38.975| 28,3| Acl.cc(158) matches: checked: to_localhost = 0
2020/02/20 00:27:38.975| 28,3| InnerNode.cc(97) resumeMatchingAt: checked: http_access#2 = 0
2020/02/20 00:27:38.975| 28,3| Acl.cc(158) matches: checked: CONNECT = 1
2020/02/20 00:27:38.975| 28,3| Acl.cc(158) matches: checked: Safe_ports = 1
2020/02/20 00:27:38.975| 28,3| Acl.cc(158) matches: checked: !Safe_ports = 0
2020/02/20 00:27:38.975| 28,3| Acl.cc(158) matches: checked: http_access#3 = 0
2020/02/20 00:27:38.975| 28,3| Acl.cc(158) matches: checked: CONNECT = 1
2020/02/20 00:27:38.976| 28,3| Acl.cc(158) matches: checked: SSL_ports = 1
2020/02/20 00:27:38.976| 28,3| Acl.cc(158) matches: checked: !SSL_ports = 0
2020/02/20 00:27:38.976| 28,3| Acl.cc(158) matches: checked: http_access#4 = 0
2020/02/20 00:27:38.976| 28,3| Acl.cc(158) matches: checked: Safe_ports = 1
2020/02/20 00:27:38.976| 28,3| Acl.cc(158) matches: checked: !Safe_ports = 0
2020/02/20 00:27:38.976| 28,3| Acl.cc(158) matches: checked: http_access#5 = 0
2020/02/20 00:27:38.976| 28,3| Acl.cc(158) matches: checked: Safe_ports = 1
2020/02/20 00:27:38.976| 28,3| Acl.cc(158) matches: checked: http_access#6 = 1
2020/02/20 00:27:38.976| 28,3| InnerNode.cc(97) resumeMatchingAt: checked: http_access = 1
2020/02/20 00:27:38.976| 28,3| Checklist.cc(63) markFinished: 0x562ba496c7b8 answer ALLOWED for match
2020/02/20 00:27:38.976| 28,3| Checklist.cc(163) checkCallback: ACLChecklist::checkCallback: 0x562ba496c7b8 answer=ALLOWED
2020/02/20 00:27:38.976| 85,2| client_side_request.cc(742) clientAccessCheckDone: The request CONNECT www.google.com:443 is ALLOWED; last ACL checked: Safe_ports
2020/02/20 00:29:57.624| 5,2| TcpAcceptor.cc(220) doAccept: New connection on FD 12
2020/02/20 00:29:57.624| 5,2| TcpAcceptor.cc(295) acceptNext: connection on local=[::]:3128 remote=[::] FD 12 flags=9
2020/02/20 00:29:57.624| 51,3| fd.cc(198) fd_open: fd_open() FD 11 HTTP Request
2020/02/20 00:29:57.624| 28,4| Eui48.cc(178) lookup: id=0x562ba499e934 query ARP table
2020/02/20 00:29:57.624| 28,4| Eui48.cc(222) lookup: id=0x562ba499e934 query ARP on each interface (80 found)
2020/02/20 00:29:57.624| 28,4| Eui48.cc(228) lookup: id=0x562ba499e934 found interface lo
2020/02/20 00:29:57.624| 28,4| Eui48.cc(228) lookup: id=0x562ba499e934 found interface eth0
2020/02/20 00:29:57.624| 28,4| Eui48.cc(237) lookup: id=0x562ba499e934 looking up ARP address for 10.244.0.145 on eth0
2020/02/20 00:29:57.624| 28,3| Eui48.cc(516) lookup: id=0x562ba499e934 10.244.0.145 NOT found
2020/02/20 00:29:57.624| 33,4| client_side.cc(3674) httpAccept: local=10.244.0.147:3128 remote=10.244.0.145:41176 FD 11 flags=1: accepted
2020/02/20 00:29:57.624| 35,4| fqdncache.cc(425) fqdncache_nbgethostbyaddr: fqdncache_nbgethostbyaddr: Name '10.244.0.145'.
2020/02/20 00:29:57.625| 78,3| dns_internal.cc(1794) idnsPTRLookup: idnsPTRLookup: buf is 43 bytes for 10.244.0.145, id = 0xea36
2020/02/20 00:29:57.625| 50,3| comm.cc(957) comm_udp_sendto: comm_udp_sendto: Attempt to send UDP packet to 10.96.0.10:53 using FD 9 using Port 52080
2020/02/20 00:29:57.625| 28,4| FilledChecklist.cc(66) ~ACLFilledChecklist: ACLFilledChecklist destroyed 0x7ffc0d8cf278
2020/02/20 00:29:57.625| 28,4| Checklist.cc(197) ~ACLChecklist: ACLChecklist::~ACLChecklist: destroyed 0x7ffc0d8cf278
2020/02/20 00:29:57.625| 5,3| comm.cc(553) commSetConnTimeout: local=10.244.0.147:3128 remote=10.244.0.145:41176 FD 11 flags=1 timeout 300
2020/02/20 00:29:57.625| 33,4| client_side.cc(231) readSomeData: local=10.244.0.147:3128 remote=10.244.0.145:41176 FD 11 flags=1: reading request...
2020/02/20 00:29:57.625| 5,3| IoCallback.cc(116) finish: called for local=10.244.0.147:3128 remote=10.244.0.145:41176 FD 11 flags=1 (0, 0)
2020/02/20 00:29:57.625| 5,3| Read.cc(91) ReadNow: local=10.244.0.147:3128 remote=10.244.0.145:41176 FD 11 flags=1, size 16382, retval 162, errno 0
2020/02/20 00:29:57.625| 33,3| client_side.cc(2259) parseHttpRequest: parseHttpRequest: req_hdr = {host: www.google.com:443
user-agent: curl/7.68.0-DEV
proxy-connection: Keep-Alive
l5d-dst-canonical: www.google.com:443
}
2020/02/20 00:29:57.625| 33,3| client_side.cc(2263) parseHttpRequest: parseHttpRequest: end = {
}
2020/02/20 00:29:57.625| 33,3| client_side.cc(2267) parseHttpRequest: parseHttpRequest: prefix_sz = 162, req_line_sz = 36
2020/02/20 00:29:57.625| 87,3| clientStream.cc(144) clientStreamInsertHead: clientStreamInsertHead: Inserted node 0x562ba45c5b18 with data 0x562ba496b090 after head
2020/02/20 00:29:57.625| 11,2| client_side.cc(2346) parseHttpRequest: HTTP Client local=10.244.0.147:3128 remote=10.244.0.145:41176 FD 11 flags=1
2020/02/20 00:29:57.625| 11,2| client_side.cc(2347) parseHttpRequest: HTTP Client REQUEST:
---------
CONNECT 10.110.207.3:3128 HTTP/1.1
host: www.google.com:443
user-agent: curl/7.68.0-DEV
proxy-connection: Keep-Alive
l5d-dst-canonical: www.google.com:443
----------
2020/02/20 00:29:57.625| 5,4| AsyncCall.cc(26) AsyncCall: The AsyncCall clientLifetimeTimeout constructed, this=0x562ba499e980 [call1807]
2020/02/20 00:29:57.625| 5,3| comm.cc(553) commSetConnTimeout: local=10.244.0.147:3128 remote=10.244.0.145:41176 FD 11 flags=1 timeout 86400
2020/02/20 00:29:57.625| 23,3| url.cc(357) urlParse: urlParse: Split URL '10.110.207.3:3128' into proto='', host='10.110.207.3', port='3128', path=''
2020/02/20 00:29:57.625| 23,3| HttpRequest.h(82) SetHost: HttpRequest::SetHost() given IP: 10.110.207.3
2020/02/20 00:29:57.625| 33,3| client_side.cc(874) clientSetKeepaliveFlag: http_ver = HTTP/1.1
2020/02/20 00:29:57.625| 33,3| client_side.cc(875) clientSetKeepaliveFlag: method = CONNECT
2020/02/20 00:29:57.625| 33,3| client_side.h(96) mayUseConnection: This 0x562ba496a018 marked 1
2020/02/20 00:29:57.625| 85,3| client_side_request.cc(130) ClientRequestContext: 0x562ba45c63f8 ClientRequestContext constructed
2020/02/20 00:29:57.625| 83,3| client_side_request.cc(1685) doCallouts: Doing calloutContext->hostHeaderVerify()
2020/02/20 00:29:57.625| 85,3| client_side_request.cc(632) hostHeaderVerify: validate host=www.google.com, port=443, portStr=443
2020/02/20 00:29:57.625| 85,3| client_side_request.cc(646) hostHeaderVerify: validate skipped.
2020/02/20 00:29:57.625| 83,3| client_side_request.cc(1692) doCallouts: Doing calloutContext->clientAccessCheck()
2020/02/20 00:29:57.625| 28,3| Checklist.cc(70) preCheck: 0x562ba496c7b8 checking slow rules
2020/02/20 00:29:57.625| 28,3| Ip.cc(539) match: aclIpMatchIp: '10.244.0.145:41176' NOT found
2020/02/20 00:29:57.625| 28,3| Acl.cc(158) matches: checked: localhost = 0
2020/02/20 00:29:57.625| 28,3| Acl.cc(158) matches: checked: http_access#1 = 0
2020/02/20 00:29:57.625| 14,3| ipcache.cc(619) ipcache_gethostbyname: ipcache_gethostbyname: '10.110.207.3', flags=1
2020/02/20 00:29:57.625| 14,4| ipcache.cc(810) ipcacheCheckNumeric: ipcacheCheckNumeric: HIT_BYPASS for '10.110.207.3' == 10.110.207.3
2020/02/20 00:29:57.625| 28,3| Ip.cc(539) match: aclIpMatchIp: '10.110.207.3' NOT found
2020/02/20 00:29:57.625| 28,3| Acl.cc(158) matches: checked: to_localhost = 0
2020/02/20 00:29:57.625| 28,3| Acl.cc(158) matches: checked: http_access#2 = 0
2020/02/20 00:29:57.625| 28,3| Acl.cc(158) matches: checked: CONNECT = 1
2020/02/20 00:29:57.625| 28,3| Acl.cc(158) matches: checked: Safe_ports = 0
2020/02/20 00:29:57.625| 28,3| Acl.cc(158) matches: checked: !Safe_ports = 1
2020/02/20 00:29:57.625| 28,3| Acl.cc(158) matches: checked: http_access#3 = 1
2020/02/20 00:29:57.625| 28,3| Acl.cc(158) matches: checked: http_access = 1
2020/02/20 00:29:57.625| 28,3| Checklist.cc(63) markFinished: 0x562ba496c7b8 answer DENIED for match
2020/02/20 00:29:57.625| 28,3| Checklist.cc(163) checkCallback: ACLChecklist::checkCallback: 0x562ba496c7b8 answer=DENIED
2020/02/20 00:29:57.626| 85,2| client_side_request.cc(742) clientAccessCheckDone: The request CONNECT 10.110.207.3:3128 is DENIED; last ACL checked: Safe_ports
2020/02/20 00:29:57.626| 28,4| FilledChecklist.cc(66) ~ACLFilledChecklist: ACLFilledChecklist destroyed 0x7ffc0d8ceac8
2020/02/20 00:29:57.626| 28,4| Checklist.cc(197) ~ACLChecklist: ACLChecklist::~ACLChecklist: destroyed 0x7ffc0d8ceac8
2020/02/20 00:29:57.626| 28,4| FilledChecklist.cc(66) ~ACLFilledChecklist: ACLFilledChecklist destroyed 0x7ffc0d8ceac8
2020/02/20 00:29:57.626| 28,4| Checklist.cc(197) ~ACLChecklist: ACLChecklist::~ACLChecklist: destroyed 0x7ffc0d8ceac8
2020/02/20 00:29:57.626| 73,3| HttpRequest.cc(687) storeId: sent back canonicalUrl:10.110.207.3:3128
2020/02/20 00:29:57.626| 20,3| store.cc(774) storeCreatePureEntry: storeCreateEntry: '10.110.207.3:3128'
2020/02/20 00:29:57.626| 20,3| MemObject.cc(97) MemObject: new MemObject 0x562ba496d1e0
2020/02/20 00:29:57.626| 20,3| store.cc(499) setReleaseFlag: StoreEntry::setReleaseFlag: '[null_store_key]'
2020/02/20 00:29:57.626| 20,3| store_key_md5.cc(89) storeKeyPrivate: storeKeyPrivate: CONNECT 10.110.207.3:3128
2020/02/20 00:29:57.626| 20,3| store.cc(447) hashInsert: StoreEntry::hashInsert: Inserting Entry e:=XI/0x562ba496d160*0 key '8F9E75ADFE2AB4D74395E0A079A8B7FF'
2020/02/20 00:29:57.626| 20,3| store.cc(483) lock: storeCreateEntry locked key 8F9E75ADFE2AB4D74395E0A079A8B7FF e:=XIV/0x562ba496d160*1
2020/02/20 00:29:57.626| 20,3| store.cc(483) lock: clientReplyContext::setReplyToStoreEntry locked key 8F9E75ADFE2AB4D74395E0A079A8B7FF e:=XIV/0x562ba496d160*2
2020/02/20 00:29:57.626| 4,4| errorpage.cc(603) errorAppendEntry: Creating an error page for entry 0x562ba496d160 with errorstate 0x562ba496d038 page id 1
2020/02/20 00:29:57.626| 4,2| errorpage.cc(1262) BuildContent: No existing error page language negotiated for ERR_ACCESS_DENIED. Using default error file.
2020/02/20 00:29:57.626| 4,3| errorpage.cc(1101) Convert: errorConvert: %%l --> '/*
* Copyright (C) 1996-2016 The Squid Software Foundation and contributors
---
apiVersion: v1
data:
squid.conf: |
# ----------------------------------------------------------------------------
# Basic squid configuration
# ----------------------------------------------------------------------------
# common settings
# ---------------
http_port 3128
cache_effective_user squid
cache_effective_group squid
workers 1
debug_options ALL,9
# Standard ACL configuration
# --------------------------
# Allow proxing standard web traffic only
acl SSL_ports port 443
# acl SSL_ports port 3128
acl Safe_ports port 80
acl Safe_ports port 443
# acl Safe_ports port 3128
acl CONNECT method CONNECT
# ACLs to target for logging
acl success_codes http_status 100-199 # informational
acl success_codes http_status 200-299 # successful transactions
acl success_codes http_status 300-399 # redirection
acl failure_codes http_status 400-499 # client error
acl failure_codes http_status 500-599 # server error
acl success_hier hier_code HIER_DIRECT
acl failure_hier hier_code HIER_NONE
acl failure all-of CONNECT failure_hier
acl failure all-of !CONNECT failure_codes
acl success all-of CONNECT success_hier
acl success all-of !CONNECT success_codes
# ACL operators
# -------------
http_access allow localhost
http_access deny to_localhost
http_access deny CONNECT !Safe_ports
http_access deny CONNECT !SSL_ports
http_access deny !Safe_ports
http_access allow Safe_ports
http_access deny all
# Logging configuration
# ---------------------
log_mime_hdrs on
access_log daemon:/var/log/squid/access.log squid !success
cache_log /var/log/squid/cache.log
kind: ConfigMap
metadata:
creationTimestamp: "2020-02-19T23:46:20Z"
name: squid-config
namespace: default
resourceVersion: "215862"
selfLink: /api/v1/namespaces/default/configmaps/squid-config
uid: f6c1636d-9a7b-45e1-bc48-456f80dcff14
---
apiVersion: v1
kind: Service
metadata:
labels:
run: squid
name: squid
spec:
ports:
- port: 3128
protocol: TCP
targetPort: 3128
selector:
run: squid
sessionAffinity: None
type: ClusterIP
---
apiVersion: apps/v1
kind: Deployment
metadata:
generation: 1
labels:
run: squid
name: squid
spec:
progressDeadlineSeconds: 600
replicas: 1
revisionHistoryLimit: 10
selector:
matchLabels:
run: squid
strategy:
rollingUpdate:
maxSurge: 25%
maxUnavailable: 25%
type: RollingUpdate
template:
metadata:
labels:
run: squid
spec:
containers:
- image: scbunn/squid:latest
imagePullPolicy: Always
name: squid
terminationMessagePath: /dev/termination-log
terminationMessagePolicy: File
volumeMounts:
- name: squid-conf
mountPath: /etc/squid/squid.conf
subPath: squid.conf
dnsPolicy: ClusterFirst
restartPolicy: Always
schedulerName: default-scheduler
volumes:
- name: squid-conf
configMap:
name: squid-config
items:
- key: squid.conf
path: squid.conf
Sign up for free to join this conversation on GitHub. Already have an account? Sign in to comment