SQL Server 2012新performance counter:非常实用的Batch Resp Statistics
转自 http://blogs.msdn.com/b/apgcdsd/archive/2013/01/30/sql-server-2012-performance-counter-batch-resp-statistics.aspx
SQL Server 2012引入了一个新的performance counter, Batch Resp Statistics。这个counter的目的是“to track SQL Batch Response times”。这个counter下面有好几档如下:

具体就是:
Batches >=000000ms & <000001ms
Batches >=000001ms & <000002ms
Batches >=000002ms & <000005ms
Batches >=000005ms & <000010ms
Batches >=000010ms & <000020ms
Batches >=000020ms & <000050ms
Batches >=000050ms & <000100ms
Batches >=000100ms & <000200ms
Batches >=000200ms & <000500ms
Batches >=000500ms & <001000ms
Batches >=001000ms & <002000ms
Batches >=002000ms & <005000ms
Batches >=005000ms & <010000ms
Batches >=010000ms & <020000ms
Batches >=020000ms & <050000ms
Batches >=050000ms & <100000ms
Batches >=100000ms
这些档的含义是怎样的呢?假定对于Batches >=010000ms & <020000ms,它的含义是这样的:
1) 如果batch (也就是一个request)的执行时间是10000ms 到20000ms之间的则计数
2) CPU time 和Elapsed time 的含义和sys.dm_exec_requests 里面的含义一致。 CPU time 就是 “请求所使用的CPU 时间”, Elapsed time 就是“请求到达后经过的总时间”。 简单说,CPU time就是batch request的CPU指令真正执行的时间,而Elapsed time 是指CPU时间加上等待的时间。比如当batch等待磁盘I/O,等待锁(就是被阻塞了)的时候,Elapsed time就一般比CPU time 长。这里注意的是因为并发执行的关系,Elapsed time 有时候并不会就恒等于CPU time 加上等待时间,而是应该有些出入。
3) CPU time:Requests 指CPU time 在这个范围内的batch request的总数。CPU time:total(ms)指CPU time在这个范围内的时间总和。Elapsed time:request 和 Elapsed time:requests 的含义类似。
4) 这些counter的值是累计的。也就是说,会一直增加,直到SQL server 重启。
为了测试这个counter,我使用ostress.exe测试工具。这个工具可以产生指定数目的连接,反复执行指定的脚本。我的测试脚本如下:
1. 首先建立测试的表
USE [Test_good]
GO
/****** Object: Table [dbo].[test] Script Date: 2012/12/26 14:57:56 ******/
DROP TABLE [dbo].[test]
GO
/****** Object: Table [dbo].[test] Script Date: 2012/12/26 14:57:56 ******/
SET ANSI_NULLS ON
GO
SET QUOTED_IDENTIFIER ON
GO
SET NSI_PADDING ON
GO
CREATE TABLE [dbo].[test] (
[colid] [int] IDENTITY(1,1) NOT NULL,
[col2] [varchar] (400) NULL
) ON [PRIMARY]
GO
SET ANSI_PADDING OFF
GO
2. 然后插入上千万的记录。

3. 然后使用如下的脚本测试。为了让测试更有趣,我在语句里面使用了rand()函数,以及动态判断是否需要人为的delay (见waitfor delay 语句)2秒钟:
use test_good
go
declare @col1 int = rand() * 10000
declare @col2 int = rand() * 100000
declare @t int
if (@col1>@col2)
begin
set @t = @col1
set @col1 = @col2
set @col2 = @t
end
begin tran
update test set col2 = getdate() where colid = (@col1+@col2)/2
declare @i int = rand() * 100
if (@i>50) waitfor delay '00:00:02'
commit tran
select @col1, @col2
select * from t est where colid between @col1 and @col2
go
select 1
declare @i int = rand() * 100
if (@i<30) waitfor delay '00:00:02'
go
select 2
go
declare @i int= rand() * 100
if (@i>30) waitfor delay '00:00:02'
go
测试的结果如下:


从这个可以看出:
系统的语句主要分为几类(按照Elapsed time):
Batches >=000000ms & <000001ms 672次
Batches >=002000ms & <005000ms 309次
如果觉得上面的图形看起来不够直观,那么还可以使用下面的语句来得到更方便阅读的结果:
(注:语句来自Neil Hambly)
SELECT [counter_name], "CPU Time:Total(ms)", "CPU Time:Requests", "Elapsed Time:Total(ms)", "Elapsed Time:Requests"
FROM (
SELECT [counter_name],[instance_name],[cntr_value]
FROM sys.dm_os_performance_counters
WHERE OBJECT_NAME LIKE '%Batch Resp Statistics%'
) os_pc
PIVOT(AVG([cntr_value]) FOR [instance_name]
IN ("CPU Time:Total(ms)", "CPU Time:Requests", "Elapsed Time:Total(ms)", "Elapsed Time:Requests")) AS Pvt;
结果如下:

这个结果一目了然:
1) 你可以看到系统所有语句的响应时间的分布情况,真正体现了这个counter 的 resp statistics 的字面含义,也即系统batch request的响应时间统计信息。
2) 你很容易知道系统的大部分的语句的响应时间和语句的总数
3) 通过比较CPU time 和Elapsed time的差异,你很容易知道batch request 是否经常因为等待(如等待I/O,阻塞等)而导致长的执行总时间。
浙公网安备 33010602011771号