Re: Kernel fails on Dreamcast - results of bisection

[Adrian McMenamin <adrian@newgolddream.dyndns.info>]

[-- Warning: decoded text below may be mangled, UTF-8 assumed --]
[-- Attachment #1: Type: text/plain; charset="windows-1254", Size: 12149 bytes --]

On Sat, 2009-03-21 at 22:37 +0000, Adrian McMenamin wrote:
> I bisected the kernel in your (Paul's) git as I knew that it was not
> working well on the Dreamcast 
....

> This is the result of the bisection. I cannot see what bit of this patch
> is causing the difficulties but I'm pretty sure that this is where it
> is. The actual problem is a race condition, as it does not happen on
> every boot...
> 
> adrian@bossclass:~/lethal-repo$ git bisect good
> 955c0778723501cc16fec40501cd54b7e72d3e74 is first bad commit
> commit 955c0778723501cc16fec40501cd54b7e72d3e74
> Author: Magnus Damm <damm@igel.co.jp>
> Date:   Thu Jan 22 09:55:31 2009 +0000
> 
>     sh: rework clocksource and sched_clock
>     
>     Rework and simplify the sched_clock and clocksource code. Instead
>     of registering the clocksource in a shared file we move it into the
>     tmu driver. Also, add code to handle sched_clock in the case of no
>     clocksource.
>     
>     Signed-off-by: Magnus Damm <damm@igel.co.jp>
>     Signed-off-by: Paul Mundt <lethal@linux-sh.org>
> 
> 

To test this further I reverted this commit and it does indeed seem to
fix the problem - the next line on the console in systems that boot (as
opposed to fail) is indeed one about the System Clock.

(I am now getting a lot of messages about failures of the udev script -
possibly because I have just turned a lot of debugging stuff on - in any
case the system does boot and works with that commit reverted).

I don't pretend to know why Magnus's patch is breaking the Dreamcast,
but I am pretty sure it is. Could it be reverted before being pushed
upstream while we wait for one that works?

Thanks

[    0.000000] Linux version 2.6.29-rc7-00246-gc76acf0 (adrian@bossclass) (gcc version 4.2.2) #38 PREEMPT Sat Mar 21 23:20:59 GMT 2009
[    0.000000] Boot params:
[    0.000000] ... MOUNT_ROOT_RDONLY - 91f0c75f
[    0.000000] ... RAMDISK_FLAGS     - e1ff3018
[    0.000000] ... ORIG_ROOT_DEV     - 89093610
[    0.000000] ... LOADER_TYPE       - 3612e108
[    0.000000] ... INITRD_START      - 46088904
[    0.000000] ... INITRD_SIZE       - 6002306c
[    0.000000] console [sercon0] enabled
[    0.000000] Booting machvec: Sega Dreamcast
[    0.000000] Node 0: start_pfn = 0xc000, low = 0xd000
[    0.000000] Zone PFN ranges:
[    0.000000]   Normal   0x0000c000 -> 0x0000d000
[    0.000000] Movable zone start PFN for each node
[    0.000000] early_node_map[1] active PFN ranges
[    0.000000]     0: 0x0000c000 -> 0x0000d000
[    0.000000] Built 1 zonelists in Zone order, mobility grouping on.  Total pages: 4064
[    0.000000] Kernel command line: root=/dev/nfs rw nfsroot\x192.168.61.50:/home/adrian/debdist ip=dhcp earlyprintk=serial video=pvr2fb:640x480-32@60 console=ttySC1 panic=7
[    0.000000] PID hash table entries: 64 (order: 6, 256 bytes)
[    0.000000] Using tmu for system timer
[    0.000000] Using 12.469 MHz high precision timer.
[    0.009855] Console: colour dummy device 80x25
[    0.014826] Lock dependency validator: Copyright (c) 2006 Red Hat, Inc., Ingo Molnar
[    0.023379] ... MAX_LOCKDEP_SUBCLASSES:  8
[    0.027997] ... MAX_LOCK_DEPTH:          48
[    0.032564] ... MAX_LOCKDEP_KEYS:        8191
[    0.037341] ... CLASSHASH_SIZE:          4096
[    0.042077] ... MAX_LOCKDEP_ENTRIES:     8192
[    0.046883] ... MAX_LOCKDEP_CHAINS:      16384
[    0.051787] ... CHAINHASH_SIZE:          8192
[    0.056592]  memory used by lock dependency info: 2335 kB
[    0.062561]  per task-struct memory footprint: 1152 bytes
[    0.068609] Dentry cache hash table entries: 2048 (order: 1, 8192 bytes)
[    0.076255] Inode-cache hash table entries: 1024 (order: 0, 4096 bytes)
[    0.086394] Memory: 9404k/16384k available (2276k kernel code, 773k data, 104k init)
[    0.094955] PVR\x040205c1 CVR\0000000 PRR\0000000
[    0.100260] I-cache : n_ways=1 n_sets%6 way_incr92
[    0.106134] I-cache : entry_mask=0x00001fe0 alias_mask=0x00001000 n_aliases=2
[    0.114022] D-cache : n_ways=1 n_setsQ2 way_incr\x16384
[    0.119884] D-cache : entry_mask=0x00003fe0 alias_mask=0x00003000 n_aliases=4
[    0.128712] SLUB: Genslabs\x10, HWalign2, Order=0-3, MinObjects=0, CPUs=1, Nodes=1
[    0.137452] Calibrating delay loop (skipped)... 199.50 BogoMIPS PRESET (lpj99012)
[    0.147811] Mount-cache hash table entries: 512
[    0.162103] CPU: SH7750
[    0.209214] net_namespace: 360 bytes
[    0.216183] NET: Registered protocol family 16
[    0.359931] bio: create slab <bio-0> at 0
[    0.387586] Autoconfig PCI channel 0x8c2f6cf8
[    0.392453] Scanning bus 00, I/O 0x01001600:0x01003600, Mem 0x01840000:0x01848000
[    0.401502] 00:00.0 Class 0200: 11db:1234 (rev 10)
[    0.406897]         I/O at 0x01001600 [size=0x100]
[    0.412330]         Mem at 0x01840000 [size=0x100]
[    0.422454] PCI: Fixing up device 0000:00:00.0
[    0.494982]  maple: bus core now registered
[    0.501115] NET: Registered protocol family 2
[    0.507560] IP route cache hash table entries: 1024 (order: 0, 4096 bytes)
[    0.518585] TCP established hash table entries: 512 (order: 0, 4096 bytes)
[    0.526564] TCP bind hash table entries: 512 (order: 2, 16384 bytes)
[    0.534245] TCP: Hash tables configured (established 512 bind 512)
[    0.541198] TCP reno registered
[    0.547115] NET: Registered protocol family 1
[    0.555960] maple : detected Dreamcast Controller: function 0x1: at (0, 0)
[    0.563648] maple : no driver found
[    0.573208] maple : detected Dreamcast Controller: function 0x1: at (1, 0)
[    0.580963] maple : no driver found
[    0.588013] maple : detected Keyboard: function 0x40: at (2, 0)
[    0.594596] maple : no driver found
[    0.602284] maple : detected Dreamcast Mouse: function 0x200: at (3, 0)
[    0.609964] maple : no driver found
[    0.620835] sq: Registering store queue API.
[    0.635694] cpufreq: SuperH CPU frequency driver.
[    0.641741] cpufreq: clock framework rate rounding not supported on this CPU.
[    0.669573] HugeTLB registered 64 KB page size, pre-allocated 0 pages
[    1.074440] msgmni has been set to 18
[    1.094301] alg: No test for stdrng (krng)
[    1.099987] io scheduler noop registered
[    1.104430] io scheduler anticipatory registered (default)
[    3.639032] SuperH SCI(F) driver initialized
[    3.645264] sh-sci: ttySC0 at MMIO 0xffe00000 (irq = 23) is a sci
[    3.657133] sh-sci: ttySC1 at MMIO 0xffe80000 (irq = 40) is a scif
�[    3.664554] console handover: boot [sercon0] -> real [ttySC1]
[    3.679176] 8139too Fast Ethernet driver 0.9.28
[    3.692938] eth0: RealTek RTL8139 at 0xa1001700, 00:d0:f1:03:12:b9, IRQ 83
[    3.704324] TCP cubic registered
[    3.707730] NET: Registered protocol family 17
[    3.731847] RPC: Registered udp transport module.
[    3.736916] RPC: Registered tcp transport module.
[    4.267055] eth0: link up, 100Mbps, full-duplex, lpa 0x45E1
[    5.276317] Sending DHCP requests ., OK
[    5.288813] IP-Config: Got DHCP answer from 192.168.61.50, my address is 192.168.61.55
[    5.303600] IP-Config: Complete:
[    5.306947]      device=eth0, addr\x192.168.61.55, mask%5.255.255.224, gw\x192.168.61.50,
[    5.315652]      host\x192.168.61.55, domain=, nis-domain=(none),
[    5.322063]      bootserver\x192.168.61.50, rootserver\x192.168.61.50, rootpath[    5.331334] Looking up port of RPC 100003/2 on 192.168.61.50
[    5.347340] Looking up port of RPC 100005/1 on 192.168.61.50
[    5.383447] VFS: Mounted root (nfs filesystem) on device 0:13.
[    5.391477] Freeing unused kernel memory: 104k freed
INIT: �version 2.86 booting�
�Starting the hotplug events dispatcher: udevd.
Synthesizing the initial hotplug events...udevd-event[862]: rename_netif: error changing netif name eth0 to eth1: Device or resource busy
done.
Waiting for /dev to be fully populated...udevd-event[1559]: udev_node_mknod: mknod(/dev/ttyz2, 020660, 3, 162) failed: No space left on device
udevd-event[1560]: udev_db_add_device: unable to create db link '/dev/.udev/db/devices@virtual@tty@ttyz3': No space left on device
udevd-event[1562]: udev_db_add_device: unable to create db link '/dev/.udev/db/devices@virtual@tty@ttyz4': No space left on device
udevd-event[1563]: udev_node_mknod: mknod(/dev/ttyz5, 020660, 3, 165) failed: No space left on device
udevd-event[1564]: udev_db_add_device: unable to create db link '/dev/.udev/db/devices@virtual@tty@ttyz6': No space left on device
udevd-event[1565]: udev_node_mknod: mknod(/dev/ttyz7, 020660, 3, 167) failed: No space left on device
udevd-event[1566]: udev_node_mknod: mknod(/dev/ttyz8, 020660, 3, 168) failed: No space left on device
udevd-event[1567]: udev_node_mknod: mknod(/dev/ttyz9, 020660, 3, 169) failed: No space left on device
udevd-event[1568]: udev_db_add_device: unable to create db link '/dev/.udev/db/devices@virtual@tty@ttyza': No space left on device
udevd-event[1569]: udev_node_mknod: mknod(/dev/ttyzb, 020660, 3, 171) failed: No space left on device
udevd-event[1570]: udev_node_mknod: mknod(/dev/ttyzc, 020660, 3, 172) failed: No space left on device
udevd-event[1571]: udev_node_mknod: mknod(/dev/ttyzd, 020660, 3, 173) failed: No space left on device
udevd-event[1572]: udev_node_mknod: mknod(/dev/ttyze, 020660, 3, 174) failed: No space left on device
done.
udevd-event[1573]: udev_node_mknod: mknod(/dev/ttyzf, 020660, 3, 175) failed: No space left on device
udevd-event[1574]: udev_node_mknod: mknod(/dev/vcs, 020660, 7, 0) failed: No space left on device
udevd-event[1575]: udev_node_mknod: mknod(/dev/vcsa, 020660, 7, 128) failed: No space left on device
Setting the system clock..
Cannot access the Hardware Clock via any known method.
Use the --debug option to see the details of our search for an access method.
Loading kernel modules...FATAL: Could not load /lib/modules/2.6.29-rc7-00246-gc76acf0/modules.dep: No such file or directory
Loading device-mapper support.
Setting kernel variables...done.
Mounting local filesystems...done.
Activating swapfile swap...done.
Setting up networking....
Setting up ALSA...done (none loaded).
INIT: �Entering runlevel: 2�
�Starting system log daemon: syslogdmknod: `/dev/xconsole': No space left on device
chown: cannot access `/dev/xconsole': No such file or directory
  syslogd: /dev/xconsole: No such file or directory
  syslogd: cannot create /dev/log: No space left on device
.
Starting kernel log daemon: klogd.
Starting mouse interface server: gpm/etc/rc2.d/S20gpm: line 65: /dev/input/mice: No such file or directory
/etc/rc2.d/S20gpm: line 65: /dev/input/mice: No such file or directory
/etc/rc2.d/S20gpm: line 65: /dev/input/mice: No such file or directory
udevd-event[1817]: udev_node_mknod: mknod(/dev/vcs1, 020660, 7, 1) failed: No space left on device
udevd-event[1818]: udev_node_mknod: mknod(/dev/vcsa1, 020660, 7, 129) failed: No space left on device
.
Starting NBD client process: FATAL: Could not load /lib/modules/2.6.29-rc7-00246-gc76acf0/modules.dep: No such file or directory
Connecting...Activating...
nbd-client.
* Not starting internet superserver: no services enabled.
Starting OpenBSD Secure Shell server: sshdmodprobe: FATAL: Could not load /lib/modules/2.6.29-rc7-00246-gc76acf0/modules.dep: No such file or directory

.
modprobe: FATAL: Could not load /lib/modules/2.6.29-rc7-00246-gc76acf0/modules.dep: No such file or directory

Starting NTP server: ntpdmodprobe: FATAL: Could not load /lib/modules/2.6.29-rc7-00246-gc76acf0/modules.dep: No such file or directory

.
[   91.359819] warning: `ntpd' uses 32-bit capabilities (legacy support in use)
Starting periodic command scheduler: crond.
��udevd-event[1905]: udev_node_mknod: mknod(/dev/vcs1, 020660, 7, 1) failed: No space left on device
udevd-event[1906]: udev_node_mknod: mknod(/dev/vcsa1, 020660, 7, 129) failed: No space left on device
udevd-event[1907]: udev_node_mknod: mknod(/dev/vcs2, 020660, 7, 2) failed: No space left on device
udevd-event[1908]: udev_node_mknod: mknod(/dev/vcsa2, 020660, 7, 130) failed: No space left on device

Debian GNU/Linux 4.0 dreamy ttySC1

dreamy login:

--
To unsubscribe from this list: send the line "unsubscribe linux-sh" in
the body of a message to majordomo@vger.kernel.org
More majordomo info at  http://vger.kernel.org/majordomo-info.html