Date: Fri, 4 Aug 1995 18:00:50 +0200 (MET DST) From: Thomas Graichen <graichen@sirius.physik.fu-berlin.de> To: hackers@freebsd.org Cc: bugs@freebsd.org Subject: amd automounter broken in FreeBSD :-( Message-ID: <9508041600.AA04816@sirius.physik.fu-berlin.de>
next in thread | raw e-mail | index | archive | help
hello
bad news :-( - the "-type:=direct" option of the amd automounter is
broken under FreeBSD - if you use it and try to access a filesystem
mounted that way you gat an "Stale NFS file handle" - it's absolutely
reproducable and only valid for the "-type:=direct" option (and only
valid for FreeBSD - under DEC OSF/1 it works fine) - i've tried to
find out where is is coming from - but for that i don't understand
enough about it - i tried the amd from NetBSD, the one from Linux
(sunsite) and the latest general version i have found (unofficial
patchlevel 102) - all show the same symptom - ok here's a more exact
description of what happend: (before doing this test i recompiled the
amd from the sources with "-DDEBUG" added to the "CFLAGS+=..." list in
/usr/src/usr.sbin/amd/amd/Makefile - this way i get the appended
debugging output - by the way i treid it here at home mounting a dir
via nfs from myself - but the same happend if i treid to mount a dir
over the net from any other machine) - ok and now here's what i've
done - please can somebody look into it to fix the problem - thanks in
advance - t
root@mordillo:/usr/src/usr.sbin/amd/amd> cat > amd.share
share type:=nfs;rfs:=/usr/share;rhost:=mordillo
^D
root@mordillo:/usr/src/usr.sbin/amd/amd> cat > /etc/exports
/usr/share mordillo
^D
root@mordillo:/usr/src/usr.sbin/amd/amd> mountd; nfsd -u -t 4; nfsiod -n 4
root@mordillo:/usr/src/usr.sbin/amd/amd> ./amd -a /amd -x all -D all -l
amd.log /share amd.share -type:=direct
Aug 4 17:06:37 mordillo amd[512]/debug: Map for "root" coming from maptype
root
Aug 4 17:06:37 mordillo amd[512]/debug: add_kv: /share -> cache:=mapdefault;
type:=toplvl;fs:="amd.share";type:=direct
Aug 4 17:06:37 mordillo amd[512]/debug: -D mtab option ignored
root@mordillo:/usr/src/usr.sbin/amd/amd> df
Filesystem 1K-blocks Used Avail Capacity Mounted on
/dev/wd0a 19487 11094 6834 62% /
/dev/wd0e 453327 148312 268748 36% /usr
/dev/wd2a 19487 3 17925 0% /tmp
/dev/wd2e 264631 131319 112141 54% /home
/dev/mcd0a 613384 613384 0 100% /cdrom
procfs 4 4 0 100% /proc
amd:526 0 0 0 100% /share
root@mordillo:/usr/src/usr.sbin/amd/amd> ls /share/.
ls: /share/.: Stale NFS file handle
root@mordillo:/usr/src/usr.sbin/amd/amd> ps auxww | grep amd
root 513 0.0 2.1 296 388 ?? S 5:06PM 0:00.06 ./amd -a /amd -x all -D all -l amd.log /share amd.share -type:=direct
root@mordillo:/usr/src/usr.sbin/amd/amd> kill -INT 513
and here's the debug output - amd.log:
Aug 4 17:06:37 mordillo amd[513]/debug: backgrounded
Aug 4 17:06:37 mordillo amd[513]/info: file server localhost type local
starts up
Aug 4 17:06:37 mordillo amd[513]/debug: Locating mntfs reference to
Aug 4 17:06:37 mordillo amd[513]/debug: Immediately discarding mntfs for
//nil//
Aug 4 17:06:37 mordillo amd[513]/debug: in afs_lookuppn
Aug 4 17:06:37 mordillo amd[513]/debug: Expansion of "/share"...
Aug 4 17:06:37 mordillo amd[513]/debug: ... is "/share"
Aug 4 17:06:37 mordillo amd[513]/debug: will search map info in "root" to
find /share
Aug 4 17:06:37 mordillo amd[513]/debug: mount info is cache:=mapdefault;
type:=toplvl;fs:="amd.share";type:=direct
Aug 4 17:06:37 mordillo amd[513]/debug: strsplit saved "cache:=mapdefault;
type:=toplvl;fs:="amd.share";type:=direct"
Aug 4 17:06:37 mordillo amd[513]/debug: strsplit saved a total of 1 strings
Aug 4 17:06:37 mordillo amd[513]/debug: searching for /defaults entry
Aug 4 17:06:37 mordillo amd[513]/debug: setting path to /share
Aug 4 17:06:37 mordillo amd[513]/debug: Expansion of ""...
Aug 4 17:06:37 mordillo amd[513]/debug: ... is ""
Aug 4 17:06:37 mordillo amd[513]/debug: Expansion of "cache:=mapdefault;
type:=toplvl;fs:="amd.share";type:=direct"...
Aug 4 17:06:37 mordillo amd[513]/debug: ... is "cache:=mapdefault;
type:=toplvl;fs:="amd.share";type:=direct"
Aug 4 17:06:37 mordillo amd[513]/debug: Expansion of "${host}"...
Aug 4 17:06:37 mordillo amd[513]/debug: ... is "mordillo"
Aug 4 17:06:37 mordillo amd[513]/debug: Expansion of "mordillo"...
Aug 4 17:06:37 mordillo amd[513]/debug: ... is "mordillo"
Aug 4 17:06:37 mordillo amd[513]/debug: Expansion of "${path}"...
Aug 4 17:06:37 mordillo amd[513]/debug: ... is "/share"
Aug 4 17:06:37 mordillo amd[513]/debug: Expansion of "/share"...
Aug 4 17:06:37 mordillo amd[513]/debug: ... is "/share"
Aug 4 17:06:37 mordillo amd[513]/debug: Expansion of "amd.share"...
Aug 4 17:06:37 mordillo amd[513]/debug: ... is "amd.share"
Aug 4 17:06:37 mordillo amd[513]/debug: Expansion of "rw"...
Aug 4 17:06:37 mordillo amd[513]/debug: ... is "rw"
Aug 4 17:06:37 mordillo amd[513]/debug: Expansion of "rw"...
Aug 4 17:06:37 mordillo amd[513]/debug: ... is "rw"
Aug 4 17:06:37 mordillo amd[513]/debug: Expansion of "${opts}"...
Aug 4 17:06:37 mordillo amd[513]/debug: ... is "${opts}"
Aug 4 17:06:37 mordillo amd[513]/debug: Expansion of "${opts}"...
Aug 4 17:06:37 mordillo amd[513]/debug: ... is "rw"
Aug 4 17:06:37 mordillo amd[513]/debug: Locating mntfs reference to /share
Aug 4 17:06:37 mordillo amd[513]/debug: Immediately discarding mntfs for
//nil//
Aug 4 17:06:37 mordillo amd[513]/debug: Got a hit with direct
Aug 4 17:06:37 mordillo amd[513]/map: Trying mount of amd.share on /share
fstype direct
Aug 4 17:06:37 mordillo amd[513]/debug: backgrounding mount of "/share"
Aug 4 17:06:37 mordillo amd[514]/debug: backgrounded
Aug 4 17:06:37 mordillo amd[513]/debug: 6 new fds allocated; total is 6
Aug 4 17:06:37 mordillo amd[513]/debug: 0x27ffc bytes of memory allocated;
total is 0x27ffc (40 pages)
Aug 4 17:06:37 mordillo amd[513]/debug: Timing out automount points...
Aug 4 17:06:37 mordillo amd[513]/debug: Next mount timeout in 300s
Aug 4 17:06:37 mordillo amd[513]/debug: Select waits for 300s
Aug 4 17:06:37 mordillo amd[514]/debug: mkdir(/share)
Aug 4 17:06:37 mordillo amd[514]/debug: root_fh substitutes pid 513
Aug 4 17:06:37 mordillo amd[514]/info: defeating nfs window computation
Aug 4 17:06:37 mordillo amd[514]/debug: /share fstype 2 (auto) flags 0
(intr,rw,port=1023,timeo=8,retrans=110,direct)
Aug 4 17:06:37 mordillo amd[513]/debug: Process 514 exited with status 0
Aug 4 17:06:37 mordillo amd[513]/debug: select interrupted
Aug 4 17:06:37 mordillo amd[513]/warn: NIS domain name is not set. NIS
ignored.
Aug 4 17:06:37 mordillo amd[513]/debug: Map for amd.share coming from
maptype file
Aug 4 17:06:37 mordillo amd[513]/debug: calling map reload on amd.share
Aug 4 17:06:37 mordillo amd[513]/debug: add_kv: share -> type:=nfs;
rfs:=/usr/share;rhost:=mordillo
Aug 4 17:06:37 mordillo amd[513]/debug: calling mapc_search for wildcard
Aug 4 17:06:37 mordillo amd[513]/info: amd.share mounted fstype direct
on /share
Aug 4 17:06:37 mordillo amd[513]/debug: Timing out automount points...
Aug 4 17:06:37 mordillo amd[513]/debug: Next mount timeout in 300s
Aug 4 17:06:37 mordillo amd[513]/debug: Select waits for 300s
Aug 4 17:06:46 mordillo amd[513]/debug: lookup:
Aug 4 17:06:46 mordillo amd[513]/debug: lookuppn(/share, .)
Aug 4 17:06:46 mordillo amd[513]/debug: 0x3000 bytes of memory allocated;
total is 0x2affc (43 pages)
Aug 4 17:06:46 mordillo amd[513]/debug: Select waits for 291s
Aug 4 17:07:12 mordillo amd[513]/debug: select interrupted
Aug 4 17:07:12 mordillo amd[513]/debug: Timing out automount points...
Aug 4 17:07:12 mordillo amd[513]/debug: "/share" on /share timed out
Aug 4 17:07:12 mordillo amd[513]/debug: unmount attempt backgrounded
Aug 4 17:07:12 mordillo amd[513]/debug: Next mount timeout in 1s
Aug 4 17:07:12 mordillo amd[513]/debug: Select waits for 1s
Aug 4 17:07:12 mordillo amd[518]/debug: backgrounded
Aug 4 17:07:12 mordillo amd[518]/debug: Unmounting /share (amd.share)
Aug 4 17:07:12 mordillo amd[513]/debug: gettattr:
Aug 4 17:07:12 mordillo amd[513]/debug: stat(/share), size = 512
Aug 4 17:07:12 mordillo amd[518]/debug: /share: unmount: Interrupted
system call
Aug 4 17:07:12 mordillo amd[513]/debug: Select waits for 1s
Aug 4 17:07:12 mordillo amd[513]/debug: Process 518 exited with status 0
Aug 4 17:07:12 mordillo amd[513]/debug: select interrupted
Aug 4 17:07:12 mordillo amd[513]/info: amd.share unmounted fstype direct
from /share
Aug 4 17:07:12 mordillo amd[513]/debug: Discarding last mntfs reference
to /share fstype direct
Aug 4 17:07:12 mordillo amd[513]/debug: Select waits for 1s
Aug 4 17:07:13 mordillo amd[513]/debug: Timing out automount points...
Aug 4 17:07:13 mordillo amd[513]/debug: "" on mordillo:(pid513) timed out
Aug 4 17:07:13 mordillo amd[513]/debug: Trying unmount in foreground
Aug 4 17:07:13 mordillo amd[513]/debug: Unmounting mordillo:(pid513) ("root")
Aug 4 17:07:13 mordillo amd[513]/debug: Discarding last mntfs reference to
mordillo:(pid513) fstype root
Aug 4 17:07:13 mordillo amd[513]/debug: unmount attempt done
Aug 4 17:07:13 mordillo amd[513]/debug: Next mount timeout in 1s
Aug 4 17:07:13 mordillo amd[513]/debug: rmdir(/share)
Aug 4 17:07:13 mordillo amd[513]/debug: Last hard reference to file server
localhost - will timeout in 300s
Aug 4 17:07:13 mordillo amd[513]/info: Finishing with status 0
_______________________________________________________||_____________________
__||
Perfection is reached, not when there is no __|| thomas graichen
longer anything to add, but when there __|| freie universitaet berlin
is no longer anything to take away __|| fachbereich physik
__||
- Antoine de Saint-Exupery - __||
___________________________||____email: graichen@omega.physik.fu-berlin.de____
Want to link to this message? Use this URL: <https://mail-archive.FreeBSD.org/cgi/mid.cgi?9508041600.AA04816>