[Search for users]
[Overall Top Noters]
[List of all Conferences]
[Download this site]
| Title: | USG buildhelp questions/answers |
|
| Moderator: | SMURF::FILTER |
|
| Created: | Mon Apr 26 1993 |
| Last Modified: | Mon Jan 20 1997 |
| Last Successful Update: | Fri Jun 06 1997 |
| Number of topics: | 2763 |
| Total number of notes: | 5802 |
484.0. "blog network problem" by SMURF::FILTER (Automatic Posting Software - mail to flume::puck) Wed Dec 22 1993 00:20
Date Of Receipt: 21-DEC-1993 16:15:55.97
From: US2RMC::"[email protected]" "Joshua M. Friedman, OSF/UNIX SDE 381-1548"
To: decwet::ode
CC: [email protected], [email protected], [email protected]
Subj: blog network problem
DECwest folks, can you help us identify what may have gone wrong in
this command, or in our networking? When I run this (from one of our
production machines, including wasted, alpha, or flambe), I
intermittently get an error. (More than half the time it errors)...
alpha-21 % blog -i -all
[ ./Makefile ]
./Makefile,v Joshua_Friedman: 4.3.17.1; Joshua_Friedman: 4.3.16.1; Anthony_Hoffman: 4.3.15.1;
blog: The following rcs command failed:
authcover rlog -l -r4.3.16.1 ./Makefile,v
Without the -i it works always ok.
Below's the trace from a blog -i -all -debug -verbose with AUTHCOVER_DEBUG on.
Here's the sdiff comparing a good run and a bad run, for the last few
lines, with the timestamps sanitized to x.y (view 132 wide):
thanks very much... -josh
==============
bad good
...
x.y: command started x.y: command started
x.y: principal_buf= PRINCIPAL=Joshua_Friedman.@ZONE x.y: principal_buf= PRINCIPAL=Joshua_Friedman.@ZONE
x.y: userbuf is USER=Joshua_Friedman x.y: userbuf is USER=Joshua_Friedman
x.y: cmdbuf is /usr/sde/ode2.0/tools/mips_ULTRIX/bin/rlog x.y: cmdbuf is /usr/sde/ode2.0/tools/mips_ULTRIX/bin/rlog
> x.y= start wait for data socket 3 and stdin
x.y= reading data socket x.y= reading data socket
./Makefile,v Joshua_Frx.y; Joshua_Friedman: 4.3.16.1; Anthony ./Makefile,v Joshua_Frx.y; Joshua_Friedman: 4.3.16.1; Ant
x.y= reading data socket x.y= reading data socket
> x.y= end wait for data socket 3 and stdin
x.y: command finished status 0 x.y: command finished status 0
x.y: sending status 0 x.y: sending status 0
x.y: parent process = 13743 closed socket and exiting | x.y: parent process = 14362 closed socket and exiting
x.y= wait for child exit x.y= wait for child exit
x.y= kxct signalled: retry = 0 <
x.y= kxct exited x.y= kxct exited
process exited with -1 | process exited with 0
blog: The following rcs command failed: <
command is: authcover rlx.y ./Makefile,v <
==============
here's the full "bad" log...
[ SET: Joshua_Friedman_test ]
[ ./Makefile ]
command is: authcover rcsstat -q -V -rJoshua_Friedman_test ./Makefile,v
rcsstat about to do fgets()
756506818.437488= kxct entered with bcsbase == /usr/sde/osf1/rcs/os/src
756506818.439440= kxct using BCS port number == 548
756506818.439440= host lookup
756506818.444320= hostname buffer.zk3.dec.com
756506818.445296= socket
756506818.445296= connect
756506818.448224= getsockname
756506818.448224= write debug
756506818.449200= socket control
756506818.449200= bind control
756506818.449200= getsockname control
756506818.449200= listen control
756506818.450176= write control port
756506818.450176= read control port
756506818.556160= accept control
756506818.558112= fork
756506818.561040= start wait for signal socket 5
756506818.624279: reading data port
756506818.596176= open for read of /home/jmf/ode/sb/test/tmp/.authcover.Joshua_Friedman failed: No such file or directory
756506818.647715: data port 3402
756506818.647715: sending data port 4559
756506818.651621: connected to dataport
756506818.659433: checking kerberos authentication
756506818.831361: authentication ok
756506818.839173: version ok
756506818.846985: local name Joshua_Friedman
756506818.846985: principal Joshua_Friedman.@ZONE
756506818.846985: reading arglist
auth is ok
756506818.995413: arglist count 7
756506819.14943: arglist length 82
756506819.18849: tempslot 0
756506819.22755: checksum 1c11
756506819.42285: arglist teminated ok
756506819.42285: arglist count/length ok
756506819.42285: arglist checksum ok
756506819.42285: arglist ok
756506819.42285: checking config
756506819.42285: tree_base is /usr/sde/osf1/rcs/os/src, tree_owner is devrcs
756506819.42285: cmd is rcsstat
756506819.46191: config file /usr/sde/osf1/rcs/os/src/kxct.conf
756506819.46191: config mode ok
756506819.54003: config ownership ok
756506819.81345: setuid/chdir ok
756506819.81345: command /usr/sde/ode2.0/tools/mips_ULTRIX/bin/rcsstat acl no_acl temp /tmp/#kxctdXXXXXX
756506819.85251: read userid 21562
756506819.89157: going to do a chmod on the file
756506819.93063: secretlen 32
756506819.93063: command started
756506819.96969: principal_buf= PRINCIPAL=Joshua_Friedman.@ZONE
756506819.96969: userbuf is USER=Joshua_Friedman
756506819.96969: cmdbuf is /usr/sde/ode2.0/tools/mips_ULTRIX/bin/rcsstat
756506819.126366= saving authorization with length = 32
756506819.198525: command finished status 0
756506819.202431: sending status 0
756506819.202431: parent process = 13737 closed socket and exiting
756506819.143934= wait for child exit
756506819.174190= writing authorization to /home/jmf/ode/sb/test/tmp/.0.5513.authcover.Joshua_Friedman
756506819.222990= temporary authorization cache written
756506819.261054= authorization saved
756506819.261054= start wait for data socket 3 and stdin
756506819.262030= reading data socket
fgets() gave us 4.3.16.1
finished with fgets()
756506819.263006= reading data socket
756506819.263006= end wait for data socket 3 and stdin
756506819.264958= kxct exited
process exited with 0
rcsstat returned revision 4.3.16.1
command is: authcover rlog -l -r4.3.16.1 ./Makefile,v
756506819.274718= kxct entered with bcsbase == /usr/sde/osf1/rcs/os/src
756506819.275694= kxct using BCS port number == 548
756506819.276670= host lookup
756506819.281550= hostname buffer.zk3.dec.com
756506819.281550= socket
756506819.281550= connect
756506819.284478= getsockname
756506819.284478= write debug
756506819.285454= socket control
756506819.285454= bind control
756506819.285454= getsockname control
756506819.286430= listen control
756506819.286430= write control port
756506819.286430= read control port
756506819.352798= accept control
756506819.354750= fork
756506819.356702= start wait for signal socket 5
756506819.432885: reading data port
756506819.432830= reading authorization from /home/jmf/ode/sb/test/tmp/.authcover.Joshua_Friedman
756506819.433806= cached authorization has length = 32
756506819.433806= cached authorization recovered
756506819.479757: data port 3405
756506819.479757: sending data port 4565
756506819.483663: connected to dataport
756506819.499287: reading arglist
756506819.642270= start wait for data socket 3 and stdin
756506819.612561: arglist count 6
756506819.616467: arglist length 64
756506819.620373: tempslot 0
756506819.620373: checksum 13b4
756506819.632091: arglist teminated ok
756506819.632091: arglist count/length ok
756506819.632091: arglist checksum ok
756506819.632091: arglist ok
756506819.632091: checking config
756506819.635997: tree_base is /usr/sde/osf1/rcs/os/src, tree_owner is devrcs
756506819.635997: cmd is rlog
756506819.635997: config file /usr/sde/osf1/rcs/os/src/kxct.conf
756506819.635997: config mode ok
756506819.659433: config ownership ok
756506819.690681: setuid/chdir ok
756506819.694587: command /usr/sde/ode2.0/tools/mips_ULTRIX/bin/rlog acl no_acl temp /tmp/#kxctdXXXXXX
756506819.698493: read userid 21562
756506819.698493: read secretlen 32
756506819.698493: checking kxct authentication
756506819.698493: got secret
756506819.698493: about to do the fopen()
756506819.698493: return from fopen()
756506819.702399: return from fgetc()
756506819.702399: return from fread()
756506819.702399: local name Joshua_Friedman
756506819.702399: principal Joshua_Friedman.@ZONE
756506819.702399: command started
756506819.706305: principal_buf= PRINCIPAL=Joshua_Friedman.@ZONE
756506819.706305: userbuf is USER=Joshua_Friedman
756506819.706305: cmdbuf is /usr/sde/ode2.0/tools/mips_ULTRIX/bin/rlog
756506819.785742= reading data socket
./Makefile,v Joshua_Friedman: 4.3.17.1; Joshua_Friedman: 4.3.16.1; Anthony_Hoffman: 4.3.15.1;
756506819.786718= reading data socket
756506819.846985: command finished status 0
756506819.850891: sending status 0
756506819.854797: parent process = 13743 closed socket and exiting
756506819.797454= wait for child exit
756506819.797454= kxct signalled: retry = 0
756506819.797454= kxct exited
process exited with -1
blog: The following rcs command failed:
command is: authcover rlog -l -r4.3.16.1 ./Makefile,v
% Received: by us2rmc.bb.dec.com; id AA23935; Tue, 21 Dec 93 16:12:45 -0500
from localhost by flambe.zk3.dec.com; (5.65/1.1.8.2/01Nov93-1038AM) id AA17519; Tue, 21 Dec 1993 16:15:15 -050
% Message-Id: <[email protected]>
% To: decwet::ode
% Cc: [email protected], [email protected], [email protected]
% Subject: blog network problem
% Date: Tue, 21 Dec 93 16:15:14 -0500
% From: "Joshua M. Friedman, OSF/UNIX SDE 381-1548" <[email protected]>
% X-Mts: smtp
| T.R | Title | User | Personal
Name | Date | Lines
|
|---|