[warn] a client request body is buffered to a temporary file

Maxim Dounin mdounin на mdounin.ru
Вт Июл 12 20:37:08 UTC 2022


Hello!

On Tue, Jul 12, 2022 at 08:55:35PM +0300, Gena Makhomed wrote:

> On 12.07.2022 18:40, Maxim Dounin wrote:
> 
> > А что у вас по осям? (c)
> > 
> > В смысле - что в log_format?  Следом за $status обычно идёт
> > $body_bytes_sent, и это размер тела ответа, имеющий приблизительно
> > никакого отношения к размеру тела запроса.
> 
> На том сервере log_format такой:
> 
> log_format frontend '$time_iso8601\t$geoip_country_code\t$remote_addr\t'
>                      '$scheme\t$host\t$request_method\t"$request_uri"\t'
>                      '$status\t$body_bytes_sent\t"$http_referer"\t'
>                      '"$http_user_agent"\t$request_time\t'
>                      '$upstream_response_time';
> 
> Очень удобно использовать символ табуляции в качестве разделителя,
> логи тогда без проблем читаются в mc и с помощью grep | less -S

Историческая справка, не имеющая отношения к обсуждаемому вопросу: 
эскейпинг специальных символов в access-логах делался как раз для 
удобного автоматического парсинга tab separated логов.  Hint: 
кавычки вокруг произвольных строковых полей использовать не нужно, 
так как табы экранируются.

[...]

> Вот еще раз все проверил только что:
> 
> # nginx -q -T | grep client_body_buffer_size
>      client_body_buffer_size 16k;
> 
> error.log:
> 
> 2022/07/12 20:23:26 [warn] 2479#2479: *63684 a client request body is 
> buffered to a temporary file /var/cache/nginx/client_temp/0000000290, 
> client: 111.222.33.44, server: sentry.example.com, request: "POST 
> /api/8/envelope/?sentry_key=xxxxxxxxxx&sentry_version=7 HTTP/2.0", host: 
> "sentry.example.com", referrer: "https://example.com/"
> 
> access.log:
> 
> 2022-07-12T20:23:26+03:00       XX      111.222.33.44   https 
> sentry.example.com        POST 
> "/api/8/envelope/?sentry_key=xxxxxxxxxx&sentry_version=7" 200     41 
>    "https://example.com/"     "Mozilla/5.0 (Windows NT 10.0; Win64; x64) 
> AppleWebKit/537.36 (KHTML, like Gecko) Chrome/103.0.0.0 Safari/537.36" 
>    0.037   0.002
> 
> Размер контента - всего 41 байт, что гораздо меньше чем 16 килобайт,
> и тем не менее, контент все равно пишется на диск зачем-то.
> Как такое может быть?

Процитирую ещё раз написанное в прошлом письме:

> > В смысле - что в log_format?  Следом за $status обычно идёт
> > $body_bytes_sent, и это размер тела ответа, имеющий приблизительно
> > никакого отношения к размеру тела запроса.

Из приведённой строки лога мы не знаем размер тела запроса, он 
может быть любой.  Видимое значение 41 - это размер ответа, и он 
не имеет к телу запроса примерно никакого отношения.  Судя по 
тому, что тело запроса в буфер не помещается - оно больше 16 
килобайт.

-- 
Maxim Dounin
http://mdounin.ru/



Подробная информация о списке рассылки nginx-ru