美文网首页转载部分MySQL
mysql性能优化之慢查询日志分析

mysql性能优化之慢查询日志分析

作者: wangzaiplus | 来源:发表于2019-09-18 15:24 被阅读0次

    一、慢查询

    在我们的项目中, 有很多需要优化的sql语句, 比如多表连接查询, 通常很耗时, 那么怎么知道哪些sql很耗时从而有针对性地进行优化呢

    mysql提供了记录慢查询日志的功能, 通过记录sql语句中超过指定阈值的查询语句, 找到耗时的sql, 从而对这些语句进行分析和优化

    例如: 我们设置阈值为1s, 当某条sql语句的执行时间超过了1s, 那么这条语句就会被写入到慢查询配置的日志文件中

    二、查看mysql慢查询功能的开启状态

    1. 查看是否已开启: show variables like '%slow_query%'
      image.png

    可以看到, 已经开启了

    • slow_query_log: 是否开启慢日志查询功能, ON开启, OFF关闭
    • slow_query_log_file: 慢查询日志的记录文件
    1. 查看阈值: show variables like '%long_query_time%'
      image.png
    • long_query_time: 慢查询日志的时间阈值, 当超过这个阈值时, 慢日志才会被记录, 配置的值可以为0(任何的sql语句都记录下来), 或者>0(具体的阈值), 该配置项是以秒为单位的, 并且可以设置为小数

    我这里已经修改为0了, 即所有语句都将记录到日志文件, 默认为10s

    三、如何开启慢查询

    有2种方式

    1. 临时开启, mysql重启后失效
    set global slow_query_log = ON;
    set global long_query_time = 0;
    
    1. 永久开启, 通过修改配置文件, 永久生效
      找到my.ini配置文件, 修改:
    slow-query-log=1
    slow_query_log_file="C:/ProgramData/MySQL/MySQL Server 5.7/slow_query_log/WANGZAIPLUS-slow.log"
    long_query_time=0
    

    说明:

    • slow-query-log=1: 1表示开启, 0表示关闭
    • slow_query_log_file: 即日志文件保存路径, 自己指定即可
    • long_query_time=0: 为了测试, 修改为0, 记录所有, 具体阈值根据项目实际情况设定
    • 关于mysql配置文件位置, windows系统是my.ini, 文件位置: C:\Program Files\MySQL\MySQL Server 5.7C:\ProgramData\MySQL\MySQL Server 5.7
    • linux系统是my.cnf, 文件位置: /etc/my.cnf
    1. 修改配置文件后, 需要重启mysql

    四、查看慢查询日志文件

    重启mysql后, 找到slow_query_log_file配置的日志文件, 由于阈值为0, 里面记录了所有sql, 测试一下, 写一个查询语句

    image.png

    再看log文件, 记录了一模一样的sql语句


    image.png

    简单解释下

    • # Time: sql执行的时间, 也是该日志记录的时间
    • # User@Host: 登录用户的连接信息, 用户和主机
    • 第三行:
      Query_time: sql执行消耗的时间
      Lock_time: 锁表的时间
      Rows_sent: 返回的行数
      Rows_examined: 扫描的行数
    • SET timestamp=1568771109;: 设置时间戳
    • SELECT id, username ...: 执行的sql语句

    五、通过mysqldumpslow工具分析慢查询日志

    1、安装perl环境

    通过-slow.log日志文件可以看到, 每一条sql都用这样的格式记录着, 随着sql越来越多, 到时肯定看的眼花缭乱, 所以, 我们可以借助mysql提供的mysqldumpslow工具对慢查询日志进行统计和分析

    找到mysql安装目录下的bin目录, 有一个mysqldumpslow.pl文件, 这是一个perl文件

    image.png

    运行它需要perl环境, 所以, 先安装环境, 具体安装教程可参考菜鸟教程: https://www.runoob.com/perl/perl-environment.html

    我用的是windows系统, 直接通过: http://strawberryperl.com/下载perl文件安装就行了, 环境变量也自动配置好了

    安装完成后查看: perl -version

    image.png

    搞定

    2、运行mysqldumpslow.pl工具分析慢查询日志

    首先说明各个文件路径

    • mysql安装目录: C:\Program Files\MySQL\MySQL Server 5.7\
    • 慢查询日志文件保存目录: C:\ProgramData\MySQL\MySQL Server 5.7\slow_query_log\

    进入到mysql安装目录下的bin目录: cd /d C:\Program Files\MySQL\MySQL Server 5.7\bin

    运行命令: mysqldumpslow.pl -a -s at C:\ProgramData\MySQL\MySQL Server 5.7\slow_query_log\WANGZAIPLUS-slow.log > C:\Users\wangzaiplus\Desktop\slow.txt

    运行命令说明:

    • 格式: mysqldumpslow.pl + 输出参数 + 慢查询日志路径 + 文件保存路径
    • 输出参数说明: -a: 禁止将sql中参数转换为NS, 如不加此参数, 类似于select * from user where username = 'wangzai'中的参数wangzai就会直接被替换为S, 即: select * from user where username = 'S'
    • -s at: -s: 排序, a: 倒序, t: 执行时间, 合起来就是按sql的执行时间倒序排序
    • 参数还有很多, 可以通过mysqldumpslow.pl --help查看

    运行后发现出错, 如下图:

    image.png

    原因: 慢查询日志文件C:\ProgramData\MySQL\MySQL Server 5.7\slow_query_log\WANGZAIPLUS-slow.log路径包含空格... 找不到该文件, 坑, 将-slow.log文件保存到一个不含空格的目录就行了, 如:
    D:\WANGZAIPLUS-slow.log, 或者, 最好的是在my.ini文件指定slow_query_log_file时不要包含空格

    再来执行一遍: mysqldumpslow.pl -a -s at D:\WANGZAIPLUS-slow.log > C:\Users\wangzaiplus\Desktop\slow.txt

    image.png

    执行成功, 桌面也生成了slow.txt文件

    3、分析slow.txt文件

    查看slow.txt文件, 如图

    image.png

    说明:

    • Count: 6: 该sql执行了多少次
    • Time=12.42s: 每次执行消耗的时间
    • (74s): 总共执行的时间
    • Lock=0.00s (0s): 锁表的时间
    • Rows=36354.0: 每次返回的记录数
    • (218124) : 总共返回的记录数
    • root[root]@localhost: username[password]@[127.0.0.1]
    • select * from tbcategory ...: 执行的sql语句

    可以看到, 该slow.txt文件是按照sql的执行时间倒序排序的, 可以通过输出参数指定排序规则或其他规则

    OK, 目前为止, 我们已经开启慢查询日志功能, 并通过mysql工具mysqldumpslow.pl对慢查询日志文件进行统计和输出, 当然, 还有其他分析工具, 这里就不多说了

    六、explain优化sql

    五.3分析slow.txt文件中, 可以看到

    SELECT
    *
    FROM
    `tbcategory` t1
    LEFT JOIN tbcategory t2 
    ON t1._id = t2.parentId
    

    这条查询语句执行了11.75s, 通过explain SELECT * FROM tbcategory t1 LEFT JOIN tbcategory t2 ON t1._id = t2.parentId发现, 没有使用任何索引, 查询太慢

    image.png

    parentId添加索引: create index idx_pid on tbcategory(parentId), 再次查询, 执行时间: 0.082s, 再次explain:

    image.png

    可以看到, 通过对慢sql进行优化, 可以大幅减少查询时间

    七、总结

    本文思路很简单:

    1. 修改my.ini配置文件开启慢查询日志功能
    2. 直接查看慢查询日志文件
    3. 通过mysql系统工具mysqldumpslow.pl统计分析日志文件, 找出耗时长的慢sql语句
    4. 通过explain分析慢查询语句, 并对其进行优化

    关于mysql性能优化有很多可以深入的, 这里就分享慢查询的相关知识, 如有不对的地方, 欢迎小伙伴指出, 谢谢

    相关文章

      网友评论

        本文标题:mysql性能优化之慢查询日志分析

        本文链接:https://www.haomeiwen.com/subject/rkuquctx.html