~ubuntu-branches/ubuntu/trusty/mariadb-5.5/trusty-proposed

« back to all changes in this revision

Viewing changes to mysql-test/suite/sys_vars/t/slow_query_log_func.test

  • Committer: Package Import Robot
  • Author(s): Otto Kekäläinen
  • Date: 2013-12-22 10:27:05 UTC
  • Revision ID: package-import@ubuntu.com-20131222102705-mndw7s12mz0szrcn
Tags: upstream-5.5.32
Import upstream version 5.5.32

Show diffs side-by-side

added added

removed removed

Lines of Context:
 
1
# save
 
2
SET @global_slow_query_log = @@global.slow_query_log;
 
3
SET @global_log_output = @@global.log_output;
 
4
###############################################################################
 
5
# Begin the functionality testing for slow_query_log                          #
 
6
###############################################################################
 
7
 
 
8
SET @@session.long_query_time=1;
 
9
 
 
10
SET @@global.log_output = 'TABLE';
 
11
 
 
12
#=========================================
 
13
--echo '----When slow_query_log = OFF----'
 
14
#=========================================
 
15
 
 
16
SET @@global.slow_query_log = OFF;
 
17
TRUNCATE mysql.slow_log;
 
18
# The sleep is the slow query
 
19
SELECT sleep(2);
 
20
 
 
21
SELECT count(*) FROM mysql.slow_log;
 
22
 
 
23
#=========================================
 
24
--echo '----When slow_query_log = ON-----'
 
25
#=========================================
 
26
 
 
27
SET @@global.slow_query_log = ON;
 
28
TRUNCATE mysql.slow_log;
 
29
# The sleep is the slow query
 
30
SELECT sleep(2);
 
31
 
 
32
SELECT count(*) > 0 FROM mysql.slow_log;
 
33
 
 
34
 
 
35
#==========================================================================
 
36
--echo 'Bug#47905 stored procedures not logged correctly to slow query log'
 
37
#==========================================================================
 
38
# assumes logging to table turned on with long_query_time=1 as above
 
39
 
 
40
TRUNCATE mysql.slow_log;
 
41
 
 
42
DELIMITER //;
 
43
CREATE PROCEDURE p_test() 
 
44
BEGIN
 
45
   select sleep(2);
 
46
   select 1;
 
47
END//
 
48
DELIMITER ;//
 
49
 
 
50
CALL p_test();
 
51
SELECT count(*) > 0 FROM mysql.slow_log;
 
52
DROP PROCEDURE p_test;
 
53
 
 
54
#==============================================================================
 
55
--echo Bug53191 Lock_time in slow log is negative when logging stored routines
 
56
#==============================================================================
 
57
TRUNCATE mysql.slow_log;
 
58
connect (con2,localhost,root,,);
 
59
connection default;
 
60
 
 
61
CREATE TABLE t1 (c0 INT PRIMARY KEY AUTO_INCREMENT, c1 TIMESTAMP, c2 TIMESTAMP);
 
62
delimiter //;
 
63
CREATE FUNCTION f_slow_now() RETURNS TIMESTAMP
 
64
BEGIN
 
65
  DO SLEEP(2);
 
66
  RETURN NOW();
 
67
END//
 
68
 
 
69
CREATE FUNCTION f_slow_current_time() RETURNS TIME
 
70
BEGIN
 
71
  DO SLEEP(2);
 
72
  RETURN CURRENT_TIME();
 
73
END
 
74
//
 
75
 
 
76
INSERT INTO t1 (c1,c2) VALUES (now(), f_slow_now())//
 
77
 
 
78
CREATE TRIGGER tf_before BEFORE INSERT ON t1
 
79
FOR EACH ROW BEGIN
 
80
   SET new.c2 = f_slow_now();
 
81
END//
 
82
 
 
83
CREATE PROCEDURE p1()
 
84
BEGIN
 
85
  INSERT INTO t1 (c1,c2) values (now(),now());
 
86
  DO SLEEP(2);
 
87
  INSERT INTO t1 (c1,c2) values (now(),now());
 
88
end//
 
89
 
 
90
delimiter ;//
 
91
 
 
92
INSERT INTO t1 (c1,c2) VALUES (now(), now());
 
93
CALL p1();
 
94
 
 
95
SELECT c1-c2 FROM t1;
 
96
--echo *** There shouldn't less than 1 s difference between each row
 
97
SELECT t1.c1-self.c1 > 1 FROM t1, t1 as self WHERE t1.c0=self.c0+1 ORDER BY t1.c0; 
 
98
 
 
99
DROP TRIGGER tf_before;
 
100
DROP FUNCTION f_slow_now;
 
101
DROP FUNCTION f_slow_current_time;
 
102
DROP TABLE t1;
 
103
 
 
104
DROP TABLE IF EXISTS t1;
 
105
CREATE TABLE t1(c1 INT) ENGINE=MyISAM;
 
106
DROP PROCEDURE IF EXISTS p1;
 
107
delimiter |; 
 
108
CREATE PROCEDURE p1()
 
109
BEGIN
 
110
  INSERT INTO t1 VALUES (1);
 
111
  SELECT COUNT(*) FROM t1 WHERE c1= 1;
 
112
  UPDATE t1 SET c1=c1*2;
 
113
END|
 
114
delimiter ;|
 
115
 
 
116
--echo Connection 2
 
117
connection con2;
 
118
LOCK TABLE t1 WRITE;
 
119
 
 
120
--echo Back to default connection
 
121
connection default;
 
122
send CALL p1();
 
123
 
 
124
--echo Wait three seconds and unlock the table
 
125
connection con2;
 
126
sleep 3;
 
127
UNLOCK TABLES;
 
128
connection default;
 
129
reap;
 
130
--echo Slow log:
 
131
--echo **** 1 == we have slow log entries
 
132
SELECT count(*) > 0 FROM mysql.slow_log;
 
133
--echo **** 0 == None of the entries have a lock time greater than 10 s
 
134
SELECT count(*) FROM mysql.slow_log WHERE lock_time > 10;
 
135
disconnect con2;
 
136
DROP TABLE t1;
 
137
DROP PROCEDURE p1;
 
138
 
 
139
 
 
140
#==================================================================   Restore
 
141
SET @@global.log_output = @global_log_output;
 
142
SET @global.slow_query_log = @global_slow_query_log;
 
143
 
 
144
###############################################################################
 
145
# End of the functionality test for slow_query_log                            #
 
146
###############################################################################
 
147