nginx + php-fpm执行超时错误分析

一个批量导入的接口,同步调用了第三方接口,今天出现了大批量超时问题,查看php-fpm日志

#php-fpm.log
[25-Sep-2019 08:53:55] WARNING: [pool www] child 3578, script '/home/www/app.test.me/public/index.php' (request: "POST /admin/order/import") execution timed out (115.225346 sec), terminating
[25-Sep-2019 08:53:55] WARNING: [pool www] child 3578 exited on signal 15 (SIGTERM) after 6193200.630314 seconds from start
[25-Sep-2019 08:53:55] NOTICE: [pool www] child 31629 started

查看nginx和php的配置

#nginx.conf
fastcgi_read_timeout 300
#php-fpm.conf
request_terminate_timeout=100
#php.ini
max_execution_time=0 //不限制

分析原因是php-fpm执行超时,使用测试脚本分析改进

样例1

脚本

#test.php
<?php
sleep(10)

配置

#nginx.conf
fastcgi_read_timeout 10
#php-fpm.conf
request_terminate_timeout=0 //不限制

浏览器 10 秒后返回 504 Gateway Time-out

#nginx-error.log
upstream timed out (110: Connection timed out) while reading response header from upstream

样例2

脚本

#test.php
<?php
sleep(10)

配置

#nginx.conf
fastcgi_read_timeout 10
#php-fpm.conf
request_terminate_timeout=5

浏览器 5 秒后返回 502 Bad Gateway

#nginx-error.log
recv() failed (104: Connection reset by peer) while reading response header from upstream
#php-fpm.log
[pool www] child 38629, script '/home/www/app.test.com/public/test.php' (request: "GET /test.php") execution timed out (5.392643 sec), terminating

样例3

脚本

#test.php
<?php
set_time_limit(1);
while(true){}

配置

#nginx.conf
fastcgi_read_timeout 10
#php-fpm.conf
request_terminate_timeout=5

浏览器返回 500 Internal Server Error

#php-fpm.log
[25-Sep-2019 20:50:51] PHP Fatal error: Maximum execution time of 1 second exceeded in /home/www/app.test.com/public/test.php on line 3

php.ini中的max_execution_time值 php-fpm.conf中的request_terminate_timeout值
这两项都是用来配置PHP脚本的最大执行时间。超时时php-fpm会终止脚本的执行,同时还会终止执行脚本的Worker进程。
文章开头 php-fpm child 3578被terminate后重新生成了新的Worker进程31629,所以nginx发现与自己通信的连接断了,就自然会返回502错误给客户端。客户端需再次发起请求重新建立新的连接,表象是刷新下浏览器即重新发起请求
适当调大 php-fpm.conf中的request_terminate_timeout,让PHP脚本不会因为执行时间长而被终止从而与nginx激活连接丢失。
request_terminate_timeout优先级高于max_execution_time,不想改全局的php.ini,只改php-fpm的配置就可以了。

via

nginx fpm 常见错误对比分析
nginx+php-fpm.sock时504,502错误解决办法

最后编辑于
©著作权归作者所有,转载或内容合作请联系作者
  • 序言:七十年代末,一起剥皮案震惊了整个滨河市,随后出现的几起案子,更是在滨河造成了极大的恐慌,老刑警刘岩,带你破解...
    沈念sama阅读 220,884评论 6 513
  • 序言:滨河连续发生了三起死亡事件,死亡现场离奇诡异,居然都是意外死亡,警方通过查阅死者的电脑和手机,发现死者居然都...
    沈念sama阅读 94,212评论 3 395
  • 文/潘晓璐 我一进店门,熙熙楼的掌柜王于贵愁眉苦脸地迎上来,“玉大人,你说我怎么就摊上这事。” “怎么了?”我有些...
    开封第一讲书人阅读 167,351评论 0 360
  • 文/不坏的土叔 我叫张陵,是天一观的道长。 经常有香客问我,道长,这世上最难降的妖魔是什么? 我笑而不...
    开封第一讲书人阅读 59,412评论 1 294
  • 正文 为了忘掉前任,我火速办了婚礼,结果婚礼上,老公的妹妹穿的比我还像新娘。我一直安慰自己,他们只是感情好,可当我...
    茶点故事阅读 68,438评论 6 397
  • 文/花漫 我一把揭开白布。 她就那样静静地躺着,像睡着了一般。 火红的嫁衣衬着肌肤如雪。 梳的纹丝不乱的头发上,一...
    开封第一讲书人阅读 52,127评论 1 308
  • 那天,我揣着相机与录音,去河边找鬼。 笑死,一个胖子当着我的面吹牛,可吹牛的内容都是我干的。 我是一名探鬼主播,决...
    沈念sama阅读 40,714评论 3 420
  • 文/苍兰香墨 我猛地睁开眼,长吁一口气:“原来是场噩梦啊……” “哼!你这毒妇竟也来了?” 一声冷哼从身侧响起,我...
    开封第一讲书人阅读 39,636评论 0 276
  • 序言:老挝万荣一对情侣失踪,失踪者是张志新(化名)和其女友刘颖,没想到半个月后,有当地人在树林里发现了一具尸体,经...
    沈念sama阅读 46,173评论 1 319
  • 正文 独居荒郊野岭守林人离奇死亡,尸身上长有42处带血的脓包…… 初始之章·张勋 以下内容为张勋视角 年9月15日...
    茶点故事阅读 38,264评论 3 339
  • 正文 我和宋清朗相恋三年,在试婚纱的时候发现自己被绿了。 大学时的朋友给我发了我未婚夫和他白月光在一起吃饭的照片。...
    茶点故事阅读 40,402评论 1 352
  • 序言:一个原本活蹦乱跳的男人离奇死亡,死状恐怖,灵堂内的尸体忽然破棺而出,到底是诈尸还是另有隐情,我是刑警宁泽,带...
    沈念sama阅读 36,073评论 5 347
  • 正文 年R本政府宣布,位于F岛的核电站,受9级特大地震影响,放射性物质发生泄漏。R本人自食恶果不足惜,却给世界环境...
    茶点故事阅读 41,763评论 3 332
  • 文/蒙蒙 一、第九天 我趴在偏房一处隐蔽的房顶上张望。 院中可真热闹,春花似锦、人声如沸。这庄子的主人今日做“春日...
    开封第一讲书人阅读 32,253评论 0 23
  • 文/苍兰香墨 我抬头看了看天上的太阳。三九已至,却和暖如春,着一层夹袄步出监牢的瞬间,已是汗流浃背。 一阵脚步声响...
    开封第一讲书人阅读 33,382评论 1 271
  • 我被黑心中介骗来泰国打工, 没想到刚下飞机就差点儿被人妖公主榨干…… 1. 我叫王不留,地道东北人。 一个月前我还...
    沈念sama阅读 48,749评论 3 375
  • 正文 我出身青楼,却偏偏与公主长得像,于是被迫代替她去往敌国和亲。 传闻我的和亲对象是个残疾皇子,可洞房花烛夜当晚...
    茶点故事阅读 45,403评论 2 358

推荐阅读更多精彩内容