Received: from localhost (unknown [200.46.204.183])
	by mail.postgresql.org (Postfix) with ESMTP id 78C5864FC2F
	for <pgsql-admin-postgresql.org@mail.postgresql.org>;
	Wed,  5 Nov 2008 20:31:05 -0400 (AST)
Received: from mail.postgresql.org ([200.46.204.86])
	by localhost (mx1.hub.org [200.46.204.183]) (amavisd-maia, port 10024)
	with ESMTP id 98978-01 for
	<pgsql-admin-postgresql.org@mail.postgresql.org>;
	Wed,  5 Nov 2008 20:31:04 -0400 (AST)
X-Greylist: domain auto-whitelisted by SQLgrey-1.7.6
Received: from web110411.mail.gq1.yahoo.com (web110411.mail.gq1.yahoo.com
	[67.195.8.235])
	by mail.postgresql.org (Postfix) with SMTP id AD08464FD69
	for <pgsql-admin@postgresql.org>; Wed,  5 Nov 2008 20:31:04 -0400 (AST)
Received: (qmail 82476 invoked by uid 60001); 6 Nov 2008 00:31:02 -0000
DomainKey-Signature: a=rsa-sha1; q=dns; c=nofws; s=s1024; d=yahoo.com;
	h=X-YMail-OSG:Received:X-Mailer:Date:From:Subject:To:MIME-Version:Content-Type:Message-ID;
	b=31Ls3bw7jrBQHmgveMb1dfEWofarUKECD+mL465ua1gLsunrOzegtroQl+RmvSVRQsdlYnCS3e3+HpKFexFPw5AJV3jCHWL6MVSeCdKTvl2ew1OD1SgXbLnh39S89hrF+QEqpBIG+f+K+9J2eQTHcN0Wuypma3TeIiqpj5iBMDo=;
X-YMail-OSG: 
 UP3fE_YVM1k692RjmqmG5QbhWUi60KAoFNGlbSTpwLE0hUicuzntWO3QAZLMmWeyqmHDMCmFYMnJmOjx88V0wRw1SXl8RnkLVPOiMP5TgOB4sAtujOWcyvIwqWH_0uyequneipy_KxasQxbmmW8vX2Qc5VqHY.VoiMx2sjd1RpBpR9w7l5J9C9JG5A--
Received: from [98.166.112.215] by web110411.mail.gq1.yahoo.com via HTTP;
	Wed, 05 Nov 2008 16:31:02 PST
X-Mailer: YahooMailRC/1155.20 YahooMailWebService/0.7.260.1
Date: Wed, 5 Nov 2008 16:31:02 -0800 (PST)
From: Jessica Richard <rjessil@yahoo.com>
Subject: time stamp and durations in postgres log file
To: pgsql-admin@postgresql.org
MIME-Version: 1.0
Content-Type: multipart/alternative; boundary="0-559572207-1225931462=:82437"
Message-ID: <413566.82437.qm@web110411.mail.gq1.yahoo.com>
X-Archive-Number: 200811/35
X-Sequence-Number: 30689

--0-559572207-1225931462=:82437
Content-Type: text/plain; charset=us-ascii

in my Postgres log file, I see something like this:

usename dbname, .., logtimestamp1... <execute> ... insert ....

then the next line:

username, dbname, ... logtimestamp2... duration: 0.2 ms

My questions:

1. Is this 0.2 ms how much time the insert takes to finish?

2. does "logtimestamp2 - logtimestamp1 " have to be equal 0.2 ms?

I am trying to create a statistics report to tell how much all database transactions take all together out of a large log file.  I added up all the duration times and this number is bigger than the time span (logtimestampFrist - logtimestampLast). It does not make sense to me, probably I did something while calculating? But I would like to sure that the line with duration time is really for the transaction in the line above it.

Thanks,
Jessica


      
--0-559572207-1225931462=:82437
Content-Type: text/html; charset=us-ascii

<html><head><style type="text/css"><!-- DIV {margin:0px;} --></style></head><body><div style="font-family:times new roman,new york,times,serif;font-size:12pt"><div>in my Postgres log file, I see something like this:<br><br>usename dbname, .., logtimestamp1... &lt;execute&gt; ... insert ....<br><br>then the next line:<br><br>username, dbname, ... logtimestamp2... duration: 0.2 ms<br><br>My questions:<br><br>1. Is this 0.2 ms how much time the insert takes to finish?<br><br>2. does "logtimestamp2 - logtimestamp1 " have to be equal 0.2 ms?<br><br>I am trying to create a statistics report to tell how much all database transactions take all together out of a large log file.&nbsp; I added up all the duration times and this number is bigger than the time span (logtimestampFrist - logtimestampLast). It does not make sense to me, probably I did something while calculating? But I would like to sure that the line with duration time is really for the transaction in
 the line above it.<br><br>Thanks,<br>Jessica<br><br></div></div><br>

      </body></html>
--0-559572207-1225931462=:82437--