Re: More 8.2 client issues (Was: [Slow dump?) - Mailing list pgsql-performance
From | Erik Jones |
---|---|
Subject | Re: More 8.2 client issues (Was: [Slow dump?) |
Date | |
Msg-id | 459BD61C.3030202@myemma.com Whole thread Raw |
In response to | Re: More 8.2 client issues (Was: [Slow dump?) (Tom Lane <tgl@sss.pgh.pa.us>) |
Responses |
Re: More 8.2 client issues (Was: [Slow dump?)
|
List | pgsql-performance |
Tom Lane wrote: > Erik Jones <erik@myemma.com> writes: > >> Hmm... This gets stranger and stranger. When connecting to the >> database with the psql client in 8.2's bin directory and using commands >> such as \d the client hangs, or takes an extremely long time. >> > > Hangs at what point? During connection? Try strace'ing psql (or > whatever the Solaris equivalent is) to see what it's doing. > Ok, here's the truss output when attached to psql with "\d pg_class", I put a marker where the pause is. Note that today the pause is only (sic) about 3-4 seconds long before the command completes and the output is displayed and that the only difference in the system between yesterday and today is that today we don't have a dump running. I realize that most of this output below is unnecessary, but while I know what most of this is doing individually, I wouldn't know what to cut out for brevity's sake without accidentally also clipping something that is needed. read(0, 0x08047B7B, 1) (sleeping...) read(0, " \", 1) = 1 write(1, " \", 1) = 1 read(0, " d", 1) = 1 write(1, " d", 1) = 1 read(0, " ", 1) = 1 write(1, " ", 1) = 1 read(0, " ", 1) = 1 write(1, " ", 1) = 1 read(0, " p", 1) = 1 write(1, " p", 1) = 1 read(0, "7F", 1) = 1 write(1, "\b \b", 3) = 3 read(0, "7F", 1) = 1 write(1, "\b \b", 3) = 3 read(0, " p", 1) = 1 write(1, " p", 1) = 1 read(0, " g", 1) = 1 write(1, " g", 1) = 1 read(0, " _", 1) = 1 write(1, " _", 1) = 1 read(0, " c", 1) = 1 write(1, " c", 1) = 1 read(0, " l", 1) = 1 write(1, " l", 1) = 1 read(0, " a", 1) = 1 write(1, " a", 1) = 1 read(0, " s", 1) = 1 write(1, " s", 1) = 1 read(0, " s", 1) = 1 write(1, " s", 1) = 1 read(0, "\r", 1) = 1 write(1, "\n", 1) = 1 lwp_sigmask(SIG_SETMASK, 0x00000002, 0x00000000) = 0xFFBFFEFF [0x0000FFFF] ioctl(0, TCSETSW, 0xFEF431E0) = 0 lwp_sigmask(SIG_SETMASK, 0x00000000, 0x00000000) = 0xFFBFFEFF [0x0000FFFF] sigaction(SIGINT, 0x08047B80, 0x08047BD0) = 0 sigaction(SIGTERM, 0x08047B80, 0x08047BD0) = 0 sigaction(SIGQUIT, 0x08047B80, 0x08047BD0) = 0 sigaction(SIGALRM, 0x08047B80, 0x08047BD0) = 0 sigaction(SIGTSTP, 0x08047B80, 0x08047BD0) = 0 sigaction(SIGTTOU, 0x08047B80, 0x08047BD0) = 0 sigaction(SIGTTIN, 0x08047B80, 0x08047BD0) = 0 sigaction(SIGWINCH, 0x08047B80, 0x08047BD0) = 0 sigaction(SIGWINCH, 0x08047B80, 0x08047BD0) = 0 sigaction(SIGPIPE, 0x08046E20, 0x08046E70) = 0 send(4, " Q\0\0\0E5 S E L E C T ".., 230, 0) = 230 <----------------------------------------------------------- Hang is right here! sigaction(SIGPIPE, 0x08046E20, 0x08046E70) = 0 pollsys(0x08046EE8, 1, 0x00000000, 0x00000000) (sleeping...) pollsys(0x08046EE8, 1, 0x00000000, 0x00000000) = 1 recv(4, " T\0\0\0 P\003 o i d\0\0".., 16384, 0) = 140 sigaction(SIGPIPE, 0x08046E20, 0x08046E70) = 0 send(4, " Q\0\0\08F S E L E C T ".., 144, 0) = 144 sigaction(SIGPIPE, 0x08046E20, 0x08046E70) = 0 pollsys(0x08046EE8, 1, 0x00000000, 0x00000000) = 1 recv(4, " T\0\0\0D3\007 r e l h a".., 16384, 0) = 272 sigaction(SIGPIPE, 0x08046E20, 0x08046E70) = 0 send(4, " Q\0\00186 S E L E C T ".., 391, 0) = 391 sigaction(SIGPIPE, 0x08046E20, 0x08046E70) = 0 pollsys(0x08046EE8, 1, 0x00000000, 0x00000000) = 1 recv(4, " T\0\0\08F\005 a t t n a".., 16384, 0) = 1375 sigaction(SIGPIPE, 0x08046E20, 0x08046E70) = 0 send(4, " Q\0\001 g S E L E C T ".., 360, 0) = 360 sigaction(SIGPIPE, 0x08046E20, 0x08046E70) = 0 pollsys(0x08046EE8, 1, 0x00000000, 0x00000000) = 1 recv(4, " T\0\0\0DD\007 r e l n a".., 16384, 0) = 526 sigaction(SIGPIPE, 0x08046E20, 0x08046E70) = 0 send(4, " Q\0\0\090 S E L E C T ".., 145, 0) = 145 sigaction(SIGPIPE, 0x08046E20, 0x08046E70) = 0 pollsys(0x08046EE8, 1, 0x00000000, 0x00000000) = 1 recv(4, " T\0\0\0 \001 r e l n a".., 16384, 0) = 51 ioctl(0, TCGETA, 0x08046F24) = 0 ioctl(1, TCGETA, 0x08046F24) = 0 ioctl(1, TIOCGWINSZ, 0x08046F58) = 0 write(1, " T a b l e ".., 34) = 34 write(1, " C o l u m n ".., 41) = 41 write(1, " - - - - - - - - - - - -".., 41) = 41 write(1, " r e l n a m e ".., 39) = 39 write(1, " r e l n a m e s p a c".., 39) = 39 write(1, " r e l t y p e ".., 39) = 39 write(1, " r e l o w n e r ".., 39) = 39 write(1, " r e l a m ".., 39) = 39 write(1, " r e l f i l e n o d e".., 39) = 39 write(1, " r e l t a b l e s p a".., 39) = 39 write(1, " r e l p a g e s ".., 39) = 39 write(1, " r e l t u p l e s ".., 39) = 39 write(1, " r e l t o a s t r e l".., 39) = 39 write(1, " r e l t o a s t i d x".., 39) = 39 write(1, " r e l h a s i n d e x".., 39) = 39 write(1, " r e l i s s h a r e d".., 39) = 39 write(1, " r e l k i n d ".., 39) = 39 write(1, " r e l n a t t s ".., 39) = 39 write(1, " r e l c h e c k s ".., 39) = 39 write(1, " r e l t r i g g e r s".., 39) = 39 write(1, " r e l u k e y s ".., 39) = 39 write(1, " r e l f k e y s ".., 39) = 39 write(1, " r e l r e f s ".., 39) = 39 write(1, " r e l h a s o i d s ".., 39) = 39 write(1, " r e l h a s p k e y ".., 39) = 39 write(1, " r e l h a s r u l e s".., 39) = 39 write(1, " r e l h a s s u b c l".., 39) = 39 write(1, " r e l f r o z e n x i".., 39) = 39 write(1, " r e l a c l ".., 31) = 31 write(1, " r e l o p t i o n s ".., 31) = 31 write(1, " I n d e x e s :\n", 9) = 9 write(1, " " p g _ c l a s".., 45) = 45 write(1, " " p g _ c l a s".., 71) = 71 write(1, "\n", 1) = 1 lwp_sigmask(SIG_SETMASK, 0x00000002, 0x00000000) = 0xFFBFFEFF [0x0000FFFF] ioctl(0, TIOCGWINSZ, 0x08047B58) = 0 ioctl(0, TIOCSWINSZ, 0x08047B58) = 0 ioctl(0, TCGETS, 0x08047BB0) = 0 ioctl(0, TCSETSW, 0x08047BB0) = 0 lwp_sigmask(SIG_SETMASK, 0x00000000, 0x00000000) = 0xFFBFFEFF [0x0000FFFF] sigaction(SIGINT, 0x08047AA0, 0x08047B10) = 0 sigaction(SIGTERM, 0x08047AA0, 0x08047B10) = 0 sigaction(SIGQUIT, 0x08047AA0, 0x08047B10) = 0 sigaction(SIGALRM, 0x08047B00, 0x08047B70) = 0 sigaction(SIGTSTP, 0x08047AA0, 0x08047B10) = 0 sigaction(SIGTTOU, 0x08047AA0, 0x08047B10) = 0 sigaction(SIGTTIN, 0x08047AA0, 0x08047B10) = 0 sigaction(SIGWINCH, 0x08047AA0, 0x08047B10) = 0 write(1, " e m m a 2 = # ", 8) = 8 read(0, 0x08047B7B, 1) (sleeping...) -- erik jones <erik@myemma.com> software development emma(r)
pgsql-performance by date: