Please disregard this posting, since the issue turned out to be user error.
On Thu, Sep 27, 2012 at 10:10:09AM -0500, Mark Dechiaro wrote: > Below is the error message we received upon reloading a reservation that > ended. > > With regard to the Cygwin error message, we have that line already configured > inside of cygwin-sshd-config.sh. Can someone shed some light as to what this > reload script is failing on? > > root@vlab-192-18 ~ > $ grep ^ssh-host-config cygwin-sshd-config.sh > ssh-host-config -y -c "nodosfilewarning ntsec" -w "$PASSWORD" > > root@vlab-192-18 ~ > $ uname -a > CYGWIN_NT-6.1 vlab-192-18 1.7.16(0.262/5/3) 2012-07-20 22:55 i686 Cygwin > > > > reservation failed on vlab-192-18-bak: process failed after trying to load or > make available > ------------------------------------------------------------------------ > time: 2012-09-27 09:53:59 > caller: State.pm:reservation_failed(213) > ( 0) State.pm, reservation_failed (line: 213) > (-1) new.pm, process (line: 298) > (-2) vcld, make_new_child (line: 568) > (-3) vcld, main (line: 346) > ------------------------------------------------------------------------ > management node: xxxx.uchicago.edu > reservation PID: 18645 > parent vcld PID: 5919 > > request ID: 225 > reservation ID: 225 > request state/laststate: reload/inuse > request start time: 2012-09-27 09:50:05 > request end time: 2012-09-27 10:20:05 > for imaging: no > log ID: none > > computer: vlab-192-18-bak > computer id: 24 > computer type: virtualmachine > computer eth0 MAC address: 00:50:56:01:99:12 > computer eth1 MAC address: 00:50:56:01:9a:12 > computer private IP address: 10.50.84.18 > computer public IP address: xxx.xxx.xxx.18 > computer in block allocation: no > provisioning module: VCL::Module::Provisioning::VMware::VMware > > vm host: xxx0002 > vm host ID: 3 > vm host computer ID: 13 > vm profile: vcl0002 Storage Profile > vm profile VM path: /vmfs/volumes/T2_6045_dev_VCL2_ds01/dev > vm profile repository path: /vmfs/volumes/nfs-vcl-templates > vm profile datastore path: /vmfs/volumes/T2_6045_dev_VCL2_ds01/dev > vm profile disk type: localdisk > > image: vmwarewin7-win7vdi092720120908117-v0 > image display name: win7-vdi-09272012-0908 > image ID: 117 > image revision ID: 99 > image size: 39951 MB > use Sysprep: no > root access: yes > image owner ID: 1 > image owner affiliation: Local > image revision date created: 2012-09-27 09:08:36 > image revision production: yes > OS module: VCL::Module::OS::Windows::Version_6::7 > > user: vclreload > user name: vcl reload > user ID: 2 > user affiliation: Local > ------------------------------------------------------------------------ > RECENT LOG ENTRIES FOR THIS PROCESS: > |18645|225:225|reload| ---- WARNING ---- > |18645|225:225|reload| 2012-09-27 > 09:53:53|18645|225:225|reload|Windows.pm:search_and_replace_in_files(6286)|file > was not found: CYGWIN environment variable option "nodosfilewarning" turns > off this warning., sed output: > |18645|225:225|reload| /bin/sed: can't read CYGWIN environment variable > option nodosfilewarning turns off this warning.: No such file or directory > |18645|225:225|reload| ( 0) Windows.pm, search_and_replace_in_files (line: > 6286) > |18645|225:225|reload| (-1) Windows.pm, sanitize_files (line: 10025) > |18645|225:225|reload| (-2) Version_6.pm, sanitize_files (line: 1793) > |18645|225:225|reload| (-3) Windows.pm, post_load (line: 743) > |18645|225:225|reload| (-4) Version_6.pm, post_load (line: 194) > |18645|225:225|reload| (-5) VMware.pm, load (line: 415) > |18645|225:225|reload| ---- WARNING ---- > |18645|225:225|reload| 2012-09-27 > 09:53:53|18645|225:225|reload|Windows.pm:search_and_replace_in_files(6294)|sed > exit status is 1, output: > |18645|225:225|reload| ( 0) Windows.pm, search_and_replace_in_files (line: > 6294) > |18645|225:225|reload| (-1) Windows.pm, sanitize_files (line: 10025) > |18645|225:225|reload| (-2) Version_6.pm, sanitize_files (line: 1793) > |18645|225:225|reload| (-3) Windows.pm, post_load (line: 743) > |18645|225:225|reload| (-4) Version_6.pm, post_load (line: 194) > |18645|225:225|reload| (-5) VMware.pm, load (line: 415) > |18645|225:225|reload| ---- WARNING ---- > |18645|225:225|reload| 2012-09-27 > 09:53:54|18645|225:225|reload|Windows.pm:search_and_replace_in_files(6286)|file > was not found: > http://cygwin.com/cygwin-ug-net/using.html#using-pathnames, sed output: > |18645|225:225|reload| /bin/sed: can't read > http://cygwin.com/cygwin-ug-net/using.html#using-pathnames: No such file or > directory > |18645|225:225|reload| ( 0) Windows.pm, search_and_replace_in_files (line: > 6286) > |18645|225:225|reload| (-1) Windows.pm, sanitize_files (line: 10025) > |18645|225:225|reload| (-2) Version_6.pm, sanitize_files (line: 1793) > |18645|225:225|reload| (-3) Windows.pm, post_load (line: 743) > |18645|225:225|reload| (-4) Version_6.pm, post_load (line: 194) > |18645|225:225|reload| (-5) VMware.pm, load (line: 415) > |18645|225:225|reload| ---- WARNING ---- > |18645|225:225|reload| 2012-09-27 > 09:53:54|18645|225:225|reload|Windows.pm:sanitize_files(10026)|failed to > remove the Windows root password from: $SYSTEMROOT/System32/sysprep > |18645|225:225|reload| ( 0) Windows.pm, sanitize_files (line: 10026) > |18645|225:225|reload| (-1) Version_6.pm, sanitize_files (line: 1793) > |18645|225:225|reload| (-2) Windows.pm, post_load (line: 743) > |18645|225:225|reload| (-3) Version_6.pm, post_load (line: 194) > |18645|225:225|reload| (-4) VMware.pm, load (line: 415) > |18645|225:225|reload| (-5) new.pm, reload_image (line: 618) > 2012-09-27 > 09:53:55|18645|225:225|reload|Windows.pm:search_and_replace_in_files(6267)|no > files were found matching pattern 'xxxxx' in: $SYSTEMROOT/Panther > 2012-09-27 > 09:53:56|18645|225:225|reload|Windows.pm:search_and_replace_in_files(6271)|found > files matching pattern 'xxxxx' in C:/Cygwin/home/root/VCL: > |18645|225:225|reload| C:/Cygwin/home/root/VCL/Scripts/autologon_enable.cmd > |18645|225:225|reload| C:/Cygwin/home/root/VCL/Utilities/Sysprep/Unattend.xml > 2012-09-27 > 09:53:57|18645|225:225|reload|Windows.pm:search_and_replace_in_files(6298)|replaced > 'xxxxx' with 'WINDOWS_ROOT_PASSWORD' in > C:/Cygwin/home/root/VCL/Scripts/autologon_enable.cmd > 2012-09-27 > 09:53:57|18645|225:225|reload|utils.pm:run_ssh_command(5380)|executing SSH > command on vlab-192-18-bak: > |18645|225:225|reload| /usr/bin/ssh -i /etc/vcl/vcl.key -o > StrictHostKeyChecking=no -l root -p 22 -x vlab-192-18-bak 'unix2dos > C:/Cygwin/home/root/VCL/Scripts/autologon_enable.cmd' 2>&1 > 2012-09-27 > 09:53:58|18645|225:225|reload|utils.pm:run_ssh_command(5464)|run_ssh_command > output: > |18645|225:225|reload| unix2dos: converting file > C:/Cygwin/home/root/VCL/Scripts/autologon_enable.cmd to DOS format ... > 2012-09-27 09:53:58|18645|225:225|reload|utils.pm:run_ssh_command(5478)|SSH > command executed on vlab-192-18-bak, returning (0, "unix2dos: converting file > C:/C...") > 2012-09-27 09:53:58|18645|225:225|reload|Windows.pm:run_unix2dos(6189)|ran > unix2dos on C:/Cygwin/home/root/VCL/Scripts/autologon_enable.cmd > 2012-09-27 > 09:53:58|18645|225:225|reload|Windows.pm:search_and_replace_in_files(6298)|replaced > 'xxxxx' with 'WINDOWS_ROOT_PASSWORD' in > C:/Cygwin/home/root/VCL/Utilities/Sysprep/Unattend.xml > 2012-09-27 > 09:53:58|18645|225:225|reload|utils.pm:run_ssh_command(5380)|executing SSH > command on vlab-192-18-bak: > |18645|225:225|reload| /usr/bin/ssh -i /etc/vcl/vcl.key -o > StrictHostKeyChecking=no -l root -p 22 -x vlab-192-18-bak 'unix2dos > C:/Cygwin/home/root/VCL/Utilities/Sysprep/Unattend.xml' 2>&1 > 2012-09-27 > 09:53:59|18645|225:225|reload|utils.pm:run_ssh_command(5464)|run_ssh_command > output: > |18645|225:225|reload| unix2dos: converting file > C:/Cygwin/home/root/VCL/Utilities/Sysprep/Unattend.xml to DOS format ... > 2012-09-27 09:53:59|18645|225:225|reload|utils.pm:run_ssh_command(5478)|SSH > command executed on vlab-192-18-bak, returning (0, "unix2dos: converting file > C:/C...") > 2012-09-27 09:53:59|18645|225:225|reload|Windows.pm:run_unix2dos(6189)|ran > unix2dos on C:/Cygwin/home/root/VCL/Utilities/Sysprep/Unattend.xml > |18645|225:225|reload| ---- WARNING ---- > |18645|225:225|reload| 2012-09-27 > 09:53:59|18645|225:225|reload|Windows.pm:post_load(744)|failed to sanitize > the files on the computer > |18645|225:225|reload| ( 0) Windows.pm, post_load (line: 744) > |18645|225:225|reload| (-1) Version_6.pm, post_load (line: 194) > |18645|225:225|reload| (-2) VMware.pm, load (line: 415) > |18645|225:225|reload| (-3) new.pm, reload_image (line: 618) > |18645|225:225|reload| (-4) new.pm, process (line: 248) > |18645|225:225|reload| (-5) vcld, make_new_child (line: 568) > |18645|225:225|reload| ---- WARNING ---- > |18645|225:225|reload| 2012-09-27 > 09:53:59|18645|225:225|reload|Version_6.pm:post_load(198)|failed to execute > parent class post_load() subroutine > |18645|225:225|reload| ( 0) Version_6.pm, post_load (line: 198) > |18645|225:225|reload| (-1) VMware.pm, load (line: 415) > |18645|225:225|reload| (-2) new.pm, reload_image (line: 618) > |18645|225:225|reload| (-3) new.pm, process (line: 248) > |18645|225:225|reload| (-4) vcld, make_new_child (line: 568) > |18645|225:225|reload| (-5) vcld, main (line: 346) > |18645|225:225|reload| ---- WARNING ---- > |18645|225:225|reload| 2012-09-27 > 09:53:59|18645|225:225|reload|VMware.pm:load(419)|failed to perform OS > post-load tasks on VM vlab-192-18-bak on VM host: vcl0002 > |18645|225:225|reload| ( 0) VMware.pm, load (line: 419) > |18645|225:225|reload| (-1) new.pm, reload_image (line: 618) > |18645|225:225|reload| (-2) new.pm, process (line: 248) > |18645|225:225|reload| (-3) vcld, make_new_child (line: 568) > |18645|225:225|reload| (-4) vcld, main (line: 346) > |18645|225:225|reload| ---- WARNING ---- > |18645|225:225|reload| 2012-09-27 > 09:53:59|18645|225:225|reload|new.pm:reload_image(623)|vmwarewin7-win7vdi092720120908117-v0 > failed to load on vlab-192-18-bak, returning > |18645|225:225|reload| ( 0) new.pm, reload_image (line: 623) > |18645|225:225|reload| (-1) new.pm, process (line: 248) > |18645|225:225|reload| (-2) vcld, make_new_child (line: 568) > |18645|225:225|reload| (-3) vcld, main (line: 346) > 2012-09-27 > 09:53:59|18645|225:225|reload|utils.pm:insertloadlog(3875)|inserted > computer=24, loadimagefailed, vmwarewin7-win7vdi092720120908117-v0 failed to > load on vlab-192-18-bak > |18645|225:225|reload| ---- WARNING ---- > |18645|225:225|reload| 2012-09-27 > 09:53:59|18645|225:225|reload|new.pm:process(295)|failed to load > vlab-192-18-bak with vmwarewin7-win7vdi092720120908117-v0 > |18645|225:225|reload| ( 0) new.pm, process (line: 295) > |18645|225:225|reload| (-1) vcld, make_new_child (line: 568) > |18645|225:225|reload| (-2) vcld, main (line: 346) > 2012-09-27 > 09:53:59|18645|225:225|reload|DataStructure.pm:get_computer_state_name(2305)|attempting > to retrieve current state of computer vlab-192-18-bak from the database > 2012-09-27 > 09:53:59|18645|225:225|reload|DataStructure.pm:get_computer_state_name(2336)|retrieved > current state of computer vlab-192-18-bak from the database: reloading > 2012-09-27 > 09:53:59|18645|225:225|reload|DataStructure.pm:_automethod(834)|data > structure updated: > $self->request_data->{reservation}{225}{computer}{state}{name} > |18645|225:225|reload| computer_state_name = reloading > 2012-09-27 > 09:53:59|18645|225:225|reload|DataStructure.pm:get_computer_private_ip_address(1557)|returning > private IP address previously retrieved: 10.50.84.18 > 2012-09-27 > 09:53:59|18645|225:225|reload|utils.pm:is_inblockrequest(6163)|zero rows were > returned from database select > 2012-09-27 > 09:53:59|18645|225:225|reload|DataStructure.pm:get_image_affiliation_name(2035)|image > owner id: 1 > 2012-09-27 09:53:59|18645|225:225|reload|utils.pm:getnewdbh(2709)|database > requested (information_schema) does not match handle stored in $ENV{dbh} > (vcl_dev:uhd1dev.uchicago.edu) > 2012-09-27 09:53:59|18645|225:225|reload|utils.pm:getnewdbh(2760)|database > handle stored in $ENV{dbh} > 2012-09-27 > 09:53:59|18645|225:225|reload|DataStructure.pm:retrieve_user_data(1352)|attempting > to retrieve and store data for user: user.id = '1' > 2012-09-27 09:53:59|18645|225:225|reload|utils.pm:getnewdbh(2709)|database > requested (vcl_dev) does not match handle stored in $ENV{dbh} > (information_schema:uhd1dev.uchicago.edu) > 2012-09-27 09:53:59|18645|225:225|reload|utils.pm:getnewdbh(2760)|database > handle stored in $ENV{dbh} > 2012-09-27 > 09:53:59|18645|225:225|reload|DataStructure.pm:retrieve_user_data(1415)|data > has been retrieved for user: admin (id: 1) > > ----- End forwarded message ----- > > -- > Mark Dechiaro > University of Chicago -- Mark Dechiaro University of Chicago
