search

hashicorp / vagrant

Vagrant is a tool for building and distributing development environments.
https://www.vagrantup.com
Other
26.27k stars 4.43k forks source link

rsync-auto in Windows - `check': wrong number of arguments (2 for 1) (ArgumentError) #6041

Closed nuncanada closed 9 years ago

nuncanada commented 9 years ago

$ vagrant --debug rsync-auto INFO global: Vagrant version: 1.7.2 INFO global: Ruby version: 2.0.0 INFO global: RubyGems version: 2.0.14 INFO global: VAGRANT_DETECTED_OS="CYGWIN_NT-6.3" INFO global: VAGRANT_EXECUTABLE="C:\HashiCorp\Vagrant\embedded\gems\gems\vagrant-1.7.2\bin\vagrant" INFO global: VAGRANT_INSTALLER_EMBEDDED_DIR="C:\HashiCorp\Vagrant\embedded" INFO global: VAGRANT_INSTALLER_ENV="1" INFO global: VAGRANT_INSTALLER_VERSION="2" INFO global: VAGRANT_INTERNAL_BUNDLERIZED="1" INFO global: VAGRANT_LOG="debug" INFO global: Plugins: INFO global: - bundler = 1.7.11 INFO global: - mime-types = 1.25.1 INFO global: - rest-client = 1.6.9 INFO global: - vagrant-cachier = 1.2.1 INFO global: - vagrant-hosts-provisioner = 2.0 INFO global: - vagrant-proxyconf = 1.5.0 INFO global: - vagrant-share = 1.1.4 INFO global: - vagrant-triggers = 0.5.0 INFO global: - vagrant-winnfsd = 1.0.11 DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/commands/box/plugin.rb INFO manager: Registered plugin: box command DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/commands/destroy/plugin.rb INFO manager: Registered plugin: destroy command DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/commands/global-status/plugin.rb INFO manager: Registered plugin: global-status command DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/commands/halt/plugin.rb INFO manager: Registered plugin: halt command DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/commands/help/plugin.rb INFO manager: Registered plugin: help command DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/commands/init/plugin.rb INFO manager: Registered plugin: init command DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/commands/list-commands/plugin.rb INFO manager: Registered plugin: list-commands command DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/commands/login/plugin.rb INFO manager: Registered plugin: vagrant-login DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/commands/package/plugin.rb INFO manager: Registered plugin: package command DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/commands/plugin/plugin.rb INFO manager: Registered plugin: plugin command DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/commands/provision/plugin.rb INFO manager: Registered plugin: provision command DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/commands/push/plugin.rb INFO manager: Registered plugin: push command DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/commands/rdp/plugin.rb INFO manager: Registered plugin: rdp command DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/commands/reload/plugin.rb INFO manager: Registered plugin: reload command DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/commands/resume/plugin.rb INFO manager: Registered plugin: resume command DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/commands/ssh/plugin.rb INFO manager: Registered plugin: ssh command DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/commands/ssh_config/plugin.rb INFO manager: Registered plugin: ssh-config command DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/commands/status/plugin.rb INFO manager: Registered plugin: status command DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/commands/suspend/plugin.rb INFO manager: Registered plugin: suspend command DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/commands/up/plugin.rb INFO manager: Registered plugin: up command DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/commands/version/plugin.rb INFO manager: Registered plugin: version command DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/communicators/ssh/plugin.rb INFO manager: Registered plugin: ssh communicator DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/communicators/winrm/plugin.rb INFO manager: Registered plugin: winrm communicator DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/guests/arch/plugin.rb INFO manager: Registered plugin: Arch guest DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/guests/coreos/plugin.rb INFO manager: Registered plugin: CoreOS guest DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/guests/darwin/plugin.rb INFO manager: Registered plugin: Darwin guest DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/guests/debian/plugin.rb INFO manager: Registered plugin: Debian guest DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/guests/esxi/plugin.rb INFO manager: Registered plugin: ESXi guest. DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/guests/fedora/plugin.rb INFO manager: Registered plugin: Fedora guest DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/guests/freebsd/plugin.rb INFO manager: Registered plugin: FreeBSD guest DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/guests/funtoo/plugin.rb INFO manager: Registered plugin: Funtoo guest DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/guests/gentoo/plugin.rb INFO manager: Registered plugin: Gentoo guest DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/guests/linux/plugin.rb INFO manager: Registered plugin: Linux guest. DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/guests/mint/plugin.rb INFO manager: Registered plugin: Mint guest DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/guests/netbsd/plugin.rb INFO manager: Registered plugin: NetBSD guest DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/guests/nixos/plugin.rb INFO manager: Registered plugin: NixOS guest DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/guests/omnios/plugin.rb INFO manager: Registered plugin: OmniOS guest. DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/guests/openbsd/plugin.rb INFO manager: Registered plugin: OpenBSD guest DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/guests/pld/plugin.rb INFO manager: Registered plugin: PLD Linux guest DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/guests/redhat/plugin.rb INFO manager: Registered plugin: RedHat guest DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/guests/smartos/plugin.rb INFO manager: Registered plugin: SmartOS guest. DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/guests/solaris/plugin.rb INFO manager: Registered plugin: Solaris guest. DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/guests/solaris11/plugin.rb INFO manager: Registered plugin: Solaris 11 guest. DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/guests/suse/plugin.rb INFO manager: Registered plugin: SUSE guest DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/guests/tinycore/plugin.rb INFO manager: Registered plugin: TinyCore Linux guest. DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/guests/ubuntu/plugin.rb INFO manager: Registered plugin: Ubuntu guest DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/guests/windows/plugin.rb INFO manager: Registered plugin: Windows guest. DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/hosts/arch/plugin.rb INFO manager: Registered plugin: Arch host DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/hosts/bsd/plugin.rb INFO manager: Registered plugin: BSD host DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/hosts/darwin/plugin.rb INFO manager: Registered plugin: Mac OS X host DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/hosts/freebsd/plugin.rb INFO manager: Registered plugin: FreeBSD host DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/hosts/gentoo/plugin.rb INFO manager: Registered plugin: Gentoo host DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/hosts/linux/plugin.rb INFO manager: Registered plugin: Linux host DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/hosts/null/plugin.rb INFO manager: Registered plugin: null host DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/hosts/redhat/plugin.rb INFO manager: Registered plugin: Red Hat host DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/hosts/slackware/plugin.rb INFO manager: Registered plugin: Slackware host DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/hosts/suse/plugin.rb INFO manager: Registered plugin: SUSE host DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/hosts/windows/plugin.rb INFO manager: Registered plugin: Windows host DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/kernel_v1/plugin.rb INFO manager: Registered plugin: kernel DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/kernel_v2/plugin.rb INFO manager: Registered plugin: kernel DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/providers/docker/plugin.rb INFO manager: Registered plugin: docker-provider DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/providers/hyperv/plugin.rb INFO manager: Registered plugin: Hyper-V provider DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/providers/virtualbox/plugin.rb INFO manager: Registered plugin: VirtualBox provider DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/provisioners/ansible/plugin.rb INFO manager: Registered plugin: ansible DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/provisioners/cfengine/plugin.rb INFO manager: Registered plugin: CFEngine Provisioner DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/provisioners/chef/plugin.rb INFO manager: Registered plugin: chef DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/provisioners/docker/plugin.rb INFO manager: Registered plugin: docker DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/provisioners/file/plugin.rb INFO manager: Registered plugin: file DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/provisioners/puppet/plugin.rb INFO manager: Registered plugin: puppet DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/provisioners/salt/plugin.rb INFO manager: Registered plugin: salt DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/provisioners/shell/plugin.rb INFO manager: Registered plugin: shell DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/pushes/atlas/plugin.rb INFO manager: Registered plugin: atlas DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/pushes/ftp/plugin.rb INFO manager: Registered plugin: ftp DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/pushes/heroku/plugin.rb INFO manager: Registered plugin: heroku DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/pushes/local-exec/plugin.rb INFO manager: Registered plugin: local-exec DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/pushes/noop/plugin.rb INFO manager: Registered plugin: noop DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/synced_folders/nfs/plugin.rb INFO manager: Registered plugin: NFS synced folders DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/synced_folders/rsync/plugin.rb INFO manager: Registered plugin: RSync synced folders DEBUG global: Loading core plugin: C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/synced_folders/smb/plugin.rb INFO manager: Registered plugin: SMB synced folders INFO global: Loading plugins! INFO manager: Registered plugin: vagrant-share INFO proxyconf: Trying to load vagrant-aws INFO proxyconf: Failed to load vagrant-aws: #<LoadError: cannot load such file -- vagrant-aws> INFO proxyconf: Ignoring the error INFO proxyconf: Trying to load vagrant-omnibus INFO proxyconf: Failed to load vagrant-omnibus: #<LoadError: cannot load such file -- vagrant-omnibus> INFO proxyconf: Ignoring the error INFO proxyconf: Trying to load vagrant-vbguest INFO proxyconf: Failed to load vagrant-vbguest: #<LoadError: cannot load such file -- vagrant-vbguest> INFO proxyconf: Ignoring the error INFO manager: Registered plugin: vagrant-proxyconf INFO manager: Registered plugin: HostsProvisioner INFO manager: Registered plugin: WinNFSd INFO manager: Registered plugin: Triggers INFO manager: Registered plugin: vagrant-cachier INFO vagrant: vagrant invoked: ["--debug", "rsync-auto"] DEBUG vagrant: Creating Vagrant environment INFO environment: Environment initialized (#Vagrant::Environment:0x3a60de8) INFO environment: - cwd: C:/www/vagrant/dspace INFO environment: Home path: C:/Users/flaviobb/.vagrant.d INFO environment: Local data path: C:/www/vagrant/dspace/.vagrant DEBUG environment: Creating: C:/www/vagrant/dspace/.vagrant INFO environment: Running hook: environment_plugins_loaded INFO runner: Preparing hooks for middleware sequence... INFO runner: 5 hooks defined. INFO runner: Running action: #Vagrant::Action::Builder:0x33a0278 INFO warden: Calling IN action: #VagrantPlugins::Triggers::Action::Trigger:0x3a9b0a8 INFO warden: Calling IN action: #VagrantPlugins::Triggers::Action::Trigger:0x3acc920 INFO warden: Calling IN action: #VagrantPlugins::Triggers::Action::Trigger:0x3b058d8 INFO warden: Calling OUT action: #VagrantPlugins::Triggers::Action::Trigger:0x3b058d8 INFO warden: Calling OUT action: #VagrantPlugins::Triggers::Action::Trigger:0x3acc920 INFO warden: Calling OUT action: #VagrantPlugins::Triggers::Action::Trigger:0x3a9b0a8 INFO environment: Running hook: environment_load INFO runner: Preparing hooks for middleware sequence... INFO runner: 7 hooks defined. INFO runner: Running action: #Vagrant::Action::Builder:0x3c2b728 INFO warden: Calling IN action: #VagrantPlugins::Triggers::Action::Trigger:0x3c3b088 INFO warden: Calling IN action: #VagrantPlugins::Triggers::Action::Trigger:0x3c75120 INFO warden: Calling IN action: #VagrantPlugins::Triggers::Action::Trigger:0x3cc91e0 INFO warden: Calling OUT action: #VagrantPlugins::Triggers::Action::Trigger:0x3cc91e0 INFO warden: Calling OUT action: #VagrantPlugins::Triggers::Action::Trigger:0x3c75120 INFO warden: Calling OUT action: #VagrantPlugins::Triggers::Action::Trigger:0x3c3b088 INFO cli: CLI: [] "rsync-auto" [] D, [2015-07-27T14:46:16.943556 #3548] DEBUG -- : Celluloid 0.17.0 is running in BACKPORTED mode. [ http://git.io/vJf3J ] DEBUG cli: Invoking command class: VagrantPlugins::SyncedFolderRSync::Command::RsyncAuto [] DEBUG rsync-auto: Getting target VMs for command. Arguments: DEBUG rsync-auto: -- names: [] DEBUG rsync-auto: -- options: nil DEBUG rsync-auto: Loading all machines... INFO loader: Set :root = #Pathname:C:/www/vagrant/dspace/Vagrantfile DEBUG loader: Populating proc cache for #Pathname:C:/www/vagrant/dspace/Vagrantfile DEBUG loader: Load procs for pathname: C:/www/vagrant/dspace/Vagrantfile INFO root: Version requirements from Vagrantfile: [">= 1.6.0"] INFO root: - Version requirements satisfied! INFO loader: Loading configuration in order: [:home, :root] DEBUG loader: Loading from: root (evaluating) DEBUG provisioner: Provisioner defined: DEBUG provisioner: Provisioner defined: DEBUG provisioner: Provisioner defined: DEBUG provisioner: Provisioner defined: DEBUG provisioner: Provisioner defined: DEBUG provisioner: Provisioner defined: DEBUG provisioner: Provisioner defined: DEBUG provisioner: Provisioner defined: DEBUG provisioner: Provisioner defined: DEBUG provisioner: Provisioner defined: DEBUG provisioner: Provisioner defined: DEBUG provisioner: Provisioner defined: DEBUG provisioner: Provisioner defined: DEBUG provisioner: Provisioner defined: DEBUG provisioner: Provisioner defined: DEBUG loader: Configuration loaded successfully, finalizing and returning DEBUG push: finalizing INFO rsync-auto: Active machine found with name vagrant-dspace. Using provider: virtualbox INFO environment: Getting machine: vagrant-dspace (virtualbox) INFO environment: Uncached load of machine. DEBUG base: Windows. Trying VBOX_INSTALL_PATH for VBoxManage DEBUG base: VBOX_INSTALL_PATH value: C:\Program Files\Oracle\VirtualBox\ INFO subprocess: Starting process: ["C:\cygwin64\bin/cygpath.EXE", "-w", "-l", "-a", "C:/Program Files/Oracle/VirtualBox/VBoxManage.exe"] DEBUG subprocess: Selecting on IO DEBUG subprocess: stdout: C:\Program Files\Oracle\VirtualBox\VBoxManage.exe DEBUG subprocess: Waiting for process to exit. Remaining to timeout: 31999 DEBUG subprocess: Exit status: 0 INFO base: VBoxManage path: C:\Program Files\Oracle\VirtualBox\VBoxManage.exe INFO subprocess: Starting process: ["C:\Program Files\Oracle\VirtualBox\VBoxManage.exe", "--version"] DEBUG subprocess: Selecting on IO DEBUG subprocess: stdout: 4.3.26r98988 DEBUG subprocess: Waiting for process to exit. Remaining to timeout: 32000 DEBUG subprocess: Exit status: 0 DEBUG meta: Finding driver for VirtualBox version: 4.3.26 INFO meta: Using VirtualBox driver: VagrantPlugins::ProviderVirtualBox::Driver::Version_4_3 DEBUG base: Windows. Trying VBOX_INSTALL_PATH for VBoxManage DEBUG base: VBOX_INSTALL_PATH value: C:\Program Files\Oracle\VirtualBox\ INFO subprocess: Starting process: ["C:\cygwin64\bin/cygpath.EXE", "-w", "-l", "-a", "C:/Program Files/Oracle/VirtualBox/VBoxManage.exe"] DEBUG subprocess: Selecting on IO DEBUG subprocess: stdout: C:\Program Files\Oracle\VirtualBox\VBoxManage.exe DEBUG subprocess: Waiting for process to exit. Remaining to timeout: 32000 DEBUG subprocess: Exit status: 0 INFO base: VBoxManage path: C:\Program Files\Oracle\VirtualBox\VBoxManage.exe INFO loader: Set "30609984_machine_vagrant-dspace" = [] INFO loader: Loading configuration in order: [:home, :root, "30609984_machine_vagrant-dspace"] DEBUG loader: Loading from: root (cache) DEBUG loader: Configuration loaded successfully, finalizing and returning DEBUG push: finalizing INFO box_collection: Box found: dspace-trusty64 (virtualbox) INFO loader: Set :"31126884_dspace-trusty64_virtualbox" = #Pathname:C:/Users/flaviobb/.vagrant.d/boxes/dspace-trusty64/0/virtualbox/Vagrantfile DEBUG loader: Populating proc cache for #Pathname:C:/Users/flaviobb/.vagrant.d/boxes/dspace-trusty64/0/virtualbox/Vagrantfile DEBUG loader: Load procs for pathname: C:/Users/flaviobb/.vagrant.d/boxes/dspace-trusty64/0/virtualbox/Vagrantfile INFO loader: Loading configuration in order: [:"31126884_dspace-trusty64_virtualbox", :home, :root, "30609984_machine_vagrant-dspace"] DEBUG loader: Loading from: 31126884_dspace-trusty64_virtualbox (evaluating) DEBUG loader: Upgrading config from version 1 to 2 DEBUG loader: Upgrading config to version 2 DEBUG loader: Upgraded to version 2 with 0 warnings and 0 errors DEBUG loader: Loading from: root (cache) DEBUG loader: Configuration loaded successfully, finalizing and returning DEBUG push: finalizing INFO machine: Initializing machine: vagrant-dspace INFO machine: - Provider: VagrantPlugins::ProviderVirtualBox::Provider INFO machine: - Box: #Vagrant::Box:0x43287c0 INFO machine: - Data dir: C:/www/vagrant/dspace/.vagrant/machines/vagrant-dspace/virtualbox DEBUG virtualbox: Instantiating the driver for machine ID: "2283a85f-d0c4-45bf-aac7-d8e08fd7718f" DEBUG base: Windows. Trying VBOX_INSTALL_PATH for VBoxManage DEBUG base: VBOX_INSTALL_PATH value: C:\Program Files\Oracle\VirtualBox\ INFO subprocess: Starting process: ["C:\cygwin64\bin/cygpath.EXE", "-w", "-l", "-a", "C:/Program Files/Oracle/VirtualBox/VBoxManage.exe"] DEBUG subprocess: Selecting on IO DEBUG subprocess: stdout: C:\Program Files\Oracle\VirtualBox\VBoxManage.exe DEBUG subprocess: Waiting for process to exit. Remaining to timeout: 32000 DEBUG subprocess: Exit status: 0 INFO base: VBoxManage path: C:\Program Files\Oracle\VirtualBox\VBoxManage.exe INFO subprocess: Starting process: ["C:\Program Files\Oracle\VirtualBox\VBoxManage.exe", "--version"] DEBUG subprocess: Selecting on IO DEBUG subprocess: stdout: 4.3.26r98988 DEBUG subprocess: Waiting for process to exit. Remaining to timeout: 32000 DEBUG subprocess: Exit status: 0 DEBUG meta: Finding driver for VirtualBox version: 4.3.26 INFO meta: Using VirtualBox driver: VagrantPlugins::ProviderVirtualBox::Driver::Version_4_3 DEBUG base: Windows. Trying VBOX_INSTALL_PATH for VBoxManage DEBUG base: VBOX_INSTALL_PATH value: C:\Program Files\Oracle\VirtualBox\ INFO subprocess: Starting process: ["C:\cygwin64\bin/cygpath.EXE", "-w", "-l", "-a", "C:/Program Files/Oracle/VirtualBox/VBoxManage.exe"] DEBUG subprocess: Selecting on IO DEBUG subprocess: stdout: C:\Program Files\Oracle\VirtualBox\VBoxManage.exe DEBUG subprocess: Waiting for process to exit. Remaining to timeout: 32000 DEBUG subprocess: Exit status: 0 INFO base: VBoxManage path: C:\Program Files\Oracle\VirtualBox\VBoxManage.exe INFO subprocess: Starting process: ["C:\Program Files\Oracle\VirtualBox\VBoxManage.exe", "showvminfo", "2283a85f-d0c4-45bf-aac7-d8e08fd7718f"] DEBUG subprocess: Selecting on IO DEBUG subprocess: stdout: Name: dspace-dev Groups: / Guest OS: Ubuntu (32 bit) UUID: 2283a85f-d0c4-45bf-aac7-d8e08fd7718f Config file: C:\Users\flaviobb\VirtualBox VMs\dspace-dev\dspace-dev.vbox Snapshot folder: C:\Users\flaviobb\VirtualBox VMs\dspace-dev\Snapshots Log folder: C:\Users\flaviobb\VirtualBox VMs\dspace-dev\Logs Hardware UUID: 2283a85f-d0c4-45bf-aac7-d8e08fd7718f Memory size: 2048MB Page Fusion: off VRAM size: 12MB CPU exec cap: 100% HPET: off Chipset: piix3 Firmware: BIOS Number of CPUs: 2 PAE: off Long Mode: on Synthetic CPU: off CPUID overrides: None Boot menu mode: message and menu Boot Device (1): HardDisk Boot Device (2): Not Assigned Boot Device (3): Not Assigned Boot Device (4): Not Assigned ACPI: on IOAPIC: on Time offset: 0ms RTC: UTC Hardw. virt.ext: on Nested Paging: on Large Pages: off VT-x VPID: on VT-x unr. exec.: on State: running (since 2015-07-27T17:20:44.980000000) Monitor count: 1 3D Acceleration: off 2D Video Acceleration: off Teleporter Enabled: off Teleporter Port: 0 Teleporter Address: Teleporter Password: Tracing Enabled: off Allow Tracing to Access VM: off Tracing Configuration: Autostart Enabled: off Autostart Delay: 0 Default Frontend: Storage Controller Name (0): SATAController Storage Controller Type (0): IntelAhci Storage Controller Instance Number (0): 0 Storage Controller Max Port Count (0): 30 Storage Controller Port Count (0): 1 Storage Controller Bootable (0): on SATAController (0, 0): C:\Users\flaviobb\VirtualBox VMs\dspace-dev\box-disk1.vmdk (UUID: 11a85771-9686-47d9-a082-452c7965d4c8) NIC 1: MAC: 0800277C82C7, Attachment: NAT, Cable connected: on, Trace: off (file: none), Type: 82540EM, Reported speed: 0 Mbps, Boot priority: 0, Promisc Policy: deny, Bandwidth group: none NIC 1 Settings: MTU: 0, Socket (send: 64, receive: 64), TCP Window (send:64, receive: 64) NIC 1 Rule(0): name = tcp2231, protocol = tcp, host ip = , host port = 2231, guest ip = , guest port = 22 NIC 1 Rule(1): name = tcp8080, protocol = tcp, host ip = , host port = 8080, guest ip = , guest port = 8080 NIC 2: MAC: 080027F11675, Attachment: Host-only Interface 'VirtualBox Host-Only Ethernet Adapter #3', Cable connected: on, Trace: off (file: none), Type: 82540EM, Reported speed: 0 Mbps, Boot priority: 0, Promisc Policy: deny, Bandwidth group: none NIC 3: disabled NIC 4: disabled NIC 5: disabled NIC 6: disabled NIC 7: disabled NIC 8: disabled Pointing Device: PS/2 Mouse Keyboard Device: PS/2 Keyboard UART 1: disabled UART 2: disabled LPT 1: disabled LPT 2: disabled Audio: disabled Clipboard Mode: Bidirectional Drag'n'drop Mode: disabled Session type: headless Video mode: 720x400x0 at 0,0 VRDE: disabled USB: disabled EHCI: disabled

USB Device Filters:

Available remote USB devices: Currently Attached USB Devices: Bandwidth groups: Shared folders: Name: 'vagrant', Host path: 'C:\www\vagrant\dspace' (machine mapping), writable Name: 'vagrant-cache', Host path: 'C:\Users\flaviobb.vagrant.d\cache\dspace-trusty64' (machine mapping), writable Name: 'tmp_vagrant-puppet_manifests-5058f1af8388633f609cadb75a75dc9d', Host path: 'C:\www\vagrant\dspace' (machine mapping), writable VRDE Connection: not active Clients so far: 0 Video capturing: not active Capture screens: 0 Capture file: C:\Users\flaviobb\VirtualBox VMs\dspace-dev\dspace-dev.webm Capture dimensions: 1024x768 Capture rate: 512 kbps Capture FPS: 25 Guest: Configured memory balloon size: 0 MB OS type: Linux26_64 Additions run level: 2 Additions version: 4.3.18 r96516 Guest Facilities: Facility "VirtualBox Base Driver": active/running (last update: 2015/07/27 17:21:05 UTC) Facility "VirtualBox System Service": active/running (last update: 2015/07/27 17:21:09 UTC) Facility "Seamless Mode": not active (last update: 2015/07/27 17:21:05 UTC) Facility "Graphics Mode": not active (last update: 2015/07/27 17:21:05 UTC) DEBUG subprocess: Waiting for process to exit. Remaining to timeout: 31999 DEBUG subprocess: Exit status: 0 INFO subprocess: Starting process: ["C:\Program Files\Oracle\VirtualBox\VBoxManage.exe", "showvminfo", "2283a85f-d0c4-45bf-aac7-d8e08fd7718f", "--machinereadable"] DEBUG subprocess: Selecting on IO DEBUG subprocess: stdout: name="dspace-dev" groups="/" ostype="Ubuntu (32 bit)" UUID="2283a85f-d0c4-45bf-aac7-d8e08fd7718f" CfgFile="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\dspace-dev.vbox" SnapFldr="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\Snapshots" LogFldr="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\Logs" hardwareuuid="2283a85f-d0c4-45bf-aac7-d8e08fd7718f" memory=2048 pagefusion="off" vram=12 cpuexecutioncap=100 hpet="off" chipset="piix3" firmware="BIOS" cpus=2 pae="off" longmode="on" synthcpu="off" bootmenu="messageandmenu" boot1="disk" boot2="none" boot3="none" boot4="none" acpi="on" ioapic="on" biossystemtimeoffset=0 rtcuseutc="on" hwvirtex="on" nestedpaging="on" largepages="off" vtxvpid="on" vtxux="on" VMState="running" VMStateChangeTime="2015-07-27T17:20:44.980000000" monitorcount=1 accelerate3d="off" accelerate2dvideo="off" teleporterenabled="off" teleporterport=0 teleporteraddress="" teleporterpassword="" tracing-enabled="off" tracing-allow-vm-access="off" tracing-config="" autostart-enabled="off" autostart-delay=0 defaultfrontend="" storagecontrollername0="SATAController" storagecontrollertype0="IntelAhci" storagecontrollerinstance0="0" storagecontrollermaxportcount0="30" storagecontrollerportcount0="1" storagecontrollerbootable0="on" "SATAController-0-0"="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\box-disk1.vmdk" "SATAController-ImageUUID-0-0"="11a85771-9686-47d9-a082-452c7965d4c8" natnet1="nat" macaddress1="0800277C82C7" cableconnected1="on" nic1="nat" nictype1="82540EM" nicspeed1="0" mtu="0" sockSnd="64" sockRcv="64" tcpWndSnd="64" tcpWndRcv="64" Forwarding(0)="tcp2231,tcp,,2231,,22" Forwarding(1)="tcp8080,tcp,,8080,,8080" hostonlyadapter2="VirtualBox Host-Only Ethernet Adapter #3" macaddress2="080027F11675" cableconnected2="on" nic2="hostonly" nictype2="82540EM" nicspeed2="0" nic3="none" nic4="none" nic5="none" nic6="none" nic7="none" nic8="none" hidpointing="ps2mouse" hidkeyboard="ps2kbd" uart1="off" uart2="off" lpt1="off" lpt2="off" audio="none" clipboard="bidirectional" draganddrop="disabled" SessionType="headless" VideoMode="720,400,0"@0,0 vrde="off" usb="off" ehci="off" SharedFolderNameMachineMapping1="vagrant" SharedFolderPathMachineMapping1="C:\www\vagrant\dspace" SharedFolderNameMachineMapping2="vagrant-cache" SharedFolderPathMachineMapping2="C:\Users\flaviobb.vagrant.d\cache\dspace-trusty64" SharedFolderNameMachineMapping3="tmp_vagrant-puppet_manifests-5058f1af8388633f609cadb75a75dc9d" SharedFolderPathMachineMapping3="C:\www\vagrant\dspace" VRDEActiveConnection="off" VRDEClients=0 vcpenabled="off" vcpscreens=0 vcpfile="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\dspace-dev.webm" vcpwidth=1024 vcpheight=768 vcprate=512 vcpfps=25 GuestMemoryBalloon=0 GuestOSType="Linux26_64" GuestAdditionsRunLevel=2 GuestAdditionsVersion="4.3.18 r96516" GuestAdditionsFacility_VirtualBox Base Driver=50,1438017665511 GuestAdditionsFacility_VirtualBox System Service=50,1438017669139 GuestAdditionsFacility_Seamless Mode=0,1438017665511 GuestAdditionsFacility_Graphics Mode=0,1438017665511 DEBUG subprocess: Waiting for process to exit. Remaining to timeout: 32000 DEBUG subprocess: Exit status: 0 INFO rsync-auto: With machine: vagrant-dspace (#, @name="stderr", @level=0, @formatter=#, @out=#IO:>], @additive=true, @name="vagrant", @path="", @parent=#, @level=1, @trace=false>, @level=1, @trace=false>, @machine=#, @driver=#, @name="stderr", @level=0, @formatter=#, @out=#IO:>], @additive=true, @name="vagrant", @path="", @parent=#, @level=1, @trace=false>, @level=1, @trace=false>, @level=1, @trace=false>, @interrupted=false, @vboxmanage_path="C:\Program Files\Oracle\VirtualBox\VBoxManage.exe", @uuid="2283a85f-d0c4-45bf-aac7-d8e08fd7718f", @version="4.3.26", @driver=#, @name="stderr", @level=0, @formatter=#, @out=#IO:>], @additive=true, @name="vagrant", @path="", @parent=#, @level=1, @trace=false>, @level=1, @trace=false>, @interrupted=false, @vboxmanage_path="C:\Program Files\Oracle\VirtualBox\VBoxManage.exe", @uuid="2283a85f-d0c4-45bf-aac7-d8e08fd7718f">>, @cap_logger=#, @name="stderr", @level=0, @formatter=#, @out=#IO:>], @additive=true, @name="vagrant", @path="", @parent=#, @level=1, @trace=false>, @level=1, @trace=false>, @cap_host_chain=[[:virtualbox, #<#Class:0x39663f0:0x3a6ac40>]], @cap_args=[#], @cap_caps={:docker=>##Proc:0x3979788@C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/providers/docker/plugin.rb:54, :proxy_machine=>#Proc:0x39796e0@C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/providers/docker/plugin.rb:59}, @results_cache={}>, :hyperv=>##Proc:0x3982a40@C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/providers/hyperv/plugin.rb:25}, @results_cache={}>, :virtualbox=>##Proc:0x398eed8@C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/providers/virtualbox/plugin.rb:27, :nic_mac_addresses=>#Proc:0x398ee78@C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/providers/virtualbox/plugin.rb:32, :public_address=>#Proc:0x3ab0d08@C:/Users/flaviobb/.vagrant.d/gems/gems/vagrant-share-1.1.4/lib/vagrant-share.rb:39}, @results_cache={}>}>) DEBUG provider: Searching for cap: proxy_machine DEBUG provider: Checking in: virtualbox INFO subprocess: Starting process: ["C:\Program Files\Oracle\VirtualBox\VBoxManage.exe", "showvminfo", "2283a85f-d0c4-45bf-aac7-d8e08fd7718f", "--machinereadable"] DEBUG subprocess: Selecting on IO DEBUG subprocess: stdout: name="dspace-dev" groups="/" ostype="Ubuntu (32 bit)" UUID="2283a85f-d0c4-45bf-aac7-d8e08fd7718f" CfgFile="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\dspace-dev.vbox" SnapFldr="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\Snapshots" LogFldr="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\Logs" hardwareuuid="2283a85f-d0c4-45bf-aac7-d8e08fd7718f" memory=2048 pagefusion="off" vram=12 cpuexecutioncap=100 hpet="off" chipset="piix3" firmware="BIOS" cpus=2 pae="off" longmode="on" synthcpu="off" bootmenu="messageandmenu" boot1="disk" boot2="none" boot3="none" boot4="none" acpi="on" ioapic="on" biossystemtimeoffset=0 rtcuseutc="on" hwvirtex="on" nestedpaging="on" largepages="off" vtxvpid="on" vtxux="on" VMState="running" VMStateChangeTime="2015-07-27T17:20:44.980000000" monitorcount=1 accelerate3d="off" accelerate2dvideo="off" teleporterenabled="off" teleporterport=0 teleporteraddress="" teleporterpassword="" tracing-enabled="off" tracing-allow-vm-access="off" tracing-config="" autostart-enabled="off" autostart-delay=0 defaultfrontend="" storagecontrollername0="SATAController" storagecontrollertype0="IntelAhci" storagecontrollerinstance0="0" storagecontrollermaxportcount0="30" storagecontrollerportcount0="1" storagecontrollerbootable0="on" "SATAController-0-0"="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\box-disk1.vmdk" "SATAController-ImageUUID-0-0"="11a85771-9686-47d9-a082-452c7965d4c8" natnet1="nat" macaddress1="0800277C82C7" cableconnected1="on" nic1="nat" nictype1="82540EM" nicspeed1="0" mtu="0" sockSnd="64" sockRcv="64" tcpWndSnd="64" tcpWndRcv="64" Forwarding(0)="tcp2231,tcp,,2231,,22" Forwarding(1)="tcp8080,tcp,,8080,,8080" hostonlyadapter2="VirtualBox Host-Only Ethernet Adapter #3" macaddress2="080027F11675" cableconnected2="on" nic2="hostonly" nictype2="82540EM" nicspeed2="0" nic3="none" nic4="none" nic5="none" nic6="none" nic7="none" nic8="none" hidpointing="ps2mouse" hidkeyboard="ps2kbd" uart1="off" uart2="off" lpt1="off" lpt2="off" audio="none" clipboard="bidirectional" draganddrop="disabled" SessionType="headless" VideoMode="720,400,0"@0,0 vrde="off" usb="off" ehci="off" SharedFolderNameMachineMapping1="vagrant" SharedFolderPathMachineMapping1="C:\www\vagrant\dspace" SharedFolderNameMachineMapping2="vagrant-cache" SharedFolderPathMachineMapping2="C:\Users\flaviobb.vagrant.d\cache\dspace-trusty64" SharedFolderNameMachineMapping3="tmp_vagrant-puppet_manifests-5058f1af8388633f609cadb75a75dc9d" SharedFolderPathMachineMapping3="C:\www\vagrant\dspace" VRDEActiveConnection="off" VRDEClients=0 vcpenabled="off" vcpscreens=0 vcpfile="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\dspace-dev.webm" vcpwidth=1024 vcpheight=768 vcprate=512 vcpfps=25 GuestMemoryBalloon=0 GuestOSType="Linux26_64" GuestAdditionsRunLevel=2 GuestAdditionsVersion="4.3.18 r96516" GuestAdditionsFacility_VirtualBox Base Driver=50,1438017665511 GuestAdditionsFacility_VirtualBox System Service=50,1438017669139 GuestAdditionsFacility_Seamless Mode=0,1438017665511 GuestAdditionsFacility_Graphics Mode=0,1438017665511 DEBUG subprocess: Waiting for process to exit. Remaining to timeout: 32000 DEBUG subprocess: Exit status: 0 DEBUG virtualbox_4_3: Searching for SSH port: 22 DEBUG virtualbox_4_3: read_forward_ports: uuid=2283a85f-d0c4-45bf-aac7-d8e08fd7718f active_only=false INFO subprocess: Starting process: ["C:\Program Files\Oracle\VirtualBox\VBoxManage.exe", "showvminfo", "2283a85f-d0c4-45bf-aac7-d8e08fd7718f", "--machinereadable"] DEBUG subprocess: Selecting on IO DEBUG subprocess: stdout: name="dspace-dev" groups="/" ostype="Ubuntu (32 bit)" UUID="2283a85f-d0c4-45bf-aac7-d8e08fd7718f" CfgFile="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\dspace-dev.vbox" SnapFldr="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\Snapshots" LogFldr="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\Logs" hardwareuuid="2283a85f-d0c4-45bf-aac7-d8e08fd7718f" memory=2048 pagefusion="off" vram=12 cpuexecutioncap=100 hpet="off" chipset="piix3" firmware="BIOS" cpus=2 pae="off" longmode="on" synthcpu="off" bootmenu="messageandmenu" boot1="disk" boot2="none" boot3="none" boot4="none" acpi="on" ioapic="on" biossystemtimeoffset=0 rtcuseutc="on" hwvirtex="on" nestedpaging="on" largepages="off" vtxvpid="on" vtxux="on" VMState="running" VMStateChangeTime="2015-07-27T17:20:44.980000000" monitorcount=1 accelerate3d="off" accelerate2dvideo="off" teleporterenabled="off" teleporterport=0 teleporteraddress="" teleporterpassword="" tracing-enabled="off" tracing-allow-vm-access="off" tracing-config="" autostart-enabled="off" autostart-delay=0 defaultfrontend="" storagecontrollername0="SATAController" storagecontrollertype0="IntelAhci" storagecontrollerinstance0="0" storagecontrollermaxportcount0="30" storagecontrollerportcount0="1" storagecontrollerbootable0="on" "SATAController-0-0"="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\box-disk1.vmdk" "SATAController-ImageUUID-0-0"="11a85771-9686-47d9-a082-452c7965d4c8" natnet1="nat" macaddress1="0800277C82C7" cableconnected1="on" nic1="nat" nictype1="82540EM" nicspeed1="0" mtu="0" sockSnd="64" sockRcv="64" tcpWndSnd="64" tcpWndRcv="64" Forwarding(0)="tcp2231,tcp,,2231,,22" Forwarding(1)="tcp8080,tcp,,8080,,8080" hostonlyadapter2="VirtualBox Host-Only Ethernet Adapter #3" macaddress2="080027F11675" cableconnected2="on" nic2="hostonly" nictype2="82540EM" nicspeed2="0" nic3="none" nic4="none" nic5="none" nic6="none" nic7="none" nic8="none" hidpointing="ps2mouse" hidkeyboard="ps2kbd" uart1="off" uart2="off" lpt1="off" lpt2="off" audio="none" clipboard="bidirectional" draganddrop="disabled" SessionType="headless" VideoMode="720,400,0"@0,0 vrde="off" usb="off" ehci="off" SharedFolderNameMachineMapping1="vagrant" SharedFolderPathMachineMapping1="C:\www\vagrant\dspace" SharedFolderNameMachineMapping2="vagrant-cache" SharedFolderPathMachineMapping2="C:\Users\flaviobb.vagrant.d\cache\dspace-trusty64" SharedFolderNameMachineMapping3="tmp_vagrant-puppet_manifests-5058f1af8388633f609cadb75a75dc9d" SharedFolderPathMachineMapping3="C:\www\vagrant\dspace" VRDEActiveConnection="off" VRDEClients=0 vcpenabled="off" vcpscreens=0 vcpfile="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\dspace-dev.webm" vcpwidth=1024 vcpheight=768 vcprate=512 vcpfps=25 GuestMemoryBalloon=0 GuestOSType="Linux26_64" GuestAdditionsRunLevel=2 GuestAdditionsVersion="4.3.18 r96516" GuestAdditionsFacility_VirtualBox Base Driver=50,1438017665511 GuestAdditionsFacility_VirtualBox System Service=50,1438017669139 GuestAdditionsFacility_Seamless Mode=0,1438017665511 GuestAdditionsFacility_Graphics Mode=0,1438017665511 DEBUG subprocess: Waiting for process to exit. Remaining to timeout: 32000 DEBUG subprocess: Exit status: 0 DEBUG virtualbox_4_3: - [1, "tcp2231", 2231, 22] DEBUG virtualbox_4_3: - [1, "tcp8080", 8080, 8080] INFO interface: info: Doing an initial rsync... INFO interface: info: ==> vagrant-dspace: Doing an initial rsync... ==> vagrant-dspace: Doing an initial rsync... INFO subprocess: Starting process: ["C:\cygwin64\bin/cygpath.EXE", "-u", "-a", "C:/www/vagrant/dspace/dspace-src"] DEBUG subprocess: Selecting on IO DEBUG subprocess: stdout: /cygdrive/c/www/vagrant/dspace/dspace-src DEBUG subprocess: Waiting for process to exit. Remaining to timeout: 32000 DEBUG subprocess: Exit status: 0 DEBUG ssh: Checking whether SSH is ready... INFO subprocess: Starting process: ["C:\Program Files\Oracle\VirtualBox\VBoxManage.exe", "showvminfo", "2283a85f-d0c4-45bf-aac7-d8e08fd7718f", "--machinereadable"] DEBUG subprocess: Selecting on IO DEBUG subprocess: stdout: name="dspace-dev" groups="/" ostype="Ubuntu (32 bit)" UUID="2283a85f-d0c4-45bf-aac7-d8e08fd7718f" CfgFile="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\dspace-dev.vbox" SnapFldr="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\Snapshots" LogFldr="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\Logs" hardwareuuid="2283a85f-d0c4-45bf-aac7-d8e08fd7718f" memory=2048 pagefusion="off" vram=12 cpuexecutioncap=100 hpet="off" chipset="piix3" firmware="BIOS" cpus=2 pae="off" longmode="on" synthcpu="off" bootmenu="messageandmenu" boot1="disk" boot2="none" boot3="none" boot4="none" acpi="on" ioapic="on" biossystemtimeoffset=0 rtcuseutc="on" hwvirtex="on" nestedpaging="on" largepages="off" vtxvpid="on" vtxux="on" VMState="running" VMStateChangeTime="2015-07-27T17:20:44.980000000" monitorcount=1 accelerate3d="off" accelerate2dvideo="off" teleporterenabled="off" teleporterport=0 teleporteraddress="" teleporterpassword="" tracing-enabled="off" tracing-allow-vm-access="off" tracing-config="" autostart-enabled="off" autostart-delay=0 defaultfrontend="" storagecontrollername0="SATAController" storagecontrollertype0="IntelAhci" storagecontrollerinstance0="0" storagecontrollermaxportcount0="30" storagecontrollerportcount0="1" storagecontrollerbootable0="on" "SATAController-0-0"="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\box-disk1.vmdk" "SATAController-ImageUUID-0-0"="11a85771-9686-47d9-a082-452c7965d4c8" natnet1="nat" macaddress1="0800277C82C7" cableconnected1="on" nic1="nat" nictype1="82540EM" nicspeed1="0" mtu="0" sockSnd="64" sockRcv="64" tcpWndSnd="64" tcpWndRcv="64" Forwarding(0)="tcp2231,tcp,,2231,,22" Forwarding(1)="tcp8080,tcp,,8080,,8080" hostonlyadapter2="VirtualBox Host-Only Ethernet Adapter #3" macaddress2="080027F11675" cableconnected2="on" nic2="hostonly" nictype2="82540EM" nicspeed2="0" nic3="none" nic4="none" nic5="none" nic6="none" nic7="none" nic8="none" hidpointing="ps2mouse" hidkeyboard="ps2kbd" uart1="off" uart2="off" lpt1="off" lpt2="off" audio="none" clipboard="bidirectional" draganddrop="disabled" SessionType="headless" VideoMode="720,400,0"@0,0 vrde="off" usb="off" ehci="off" SharedFolderNameMachineMapping1="vagrant" SharedFolderPathMachineMapping1="C:\www\vagrant\dspace" SharedFolderNameMachineMapping2="vagrant-cache" SharedFolderPathMachineMapping2="C:\Users\flaviobb.vagrant.d\cache\dspace-trusty64" SharedFolderNameMachineMapping3="tmp_vagrant-puppet_manifests-5058f1af8388633f609cadb75a75dc9d" SharedFolderPathMachineMapping3="C:\www\vagrant\dspace" VRDEActiveConnection="off" VRDEClients=0 vcpenabled="off" vcpscreens=0 vcpfile="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\dspace-dev.webm" vcpwidth=1024 vcpheight=768 vcprate=512 vcpfps=25 GuestMemoryBalloon=0 GuestOSType="Linux26_64" GuestAdditionsRunLevel=2 GuestAdditionsVersion="4.3.18 r96516" GuestAdditionsFacility_VirtualBox Base Driver=50,1438017665511 GuestAdditionsFacility_VirtualBox System Service=50,1438017669139 GuestAdditionsFacility_Seamless Mode=0,1438017665511 GuestAdditionsFacility_Graphics Mode=0,1438017665511 DEBUG subprocess: Waiting for process to exit. Remaining to timeout: 32000 DEBUG subprocess: Exit status: 0 DEBUG virtualbox_4_3: Searching for SSH port: 22 DEBUG virtualbox_4_3: read_forward_ports: uuid=2283a85f-d0c4-45bf-aac7-d8e08fd7718f active_only=false INFO subprocess: Starting process: ["C:\Program Files\Oracle\VirtualBox\VBoxManage.exe", "showvminfo", "2283a85f-d0c4-45bf-aac7-d8e08fd7718f", "--machinereadable"] DEBUG subprocess: Selecting on IO DEBUG subprocess: Waiting for process to exit. Remaining to timeout: 31999 DEBUG subprocess: Exit status: 0 DEBUG subprocess: stdout: name="dspace-dev" groups="/" ostype="Ubuntu (32 bit)" UUID="2283a85f-d0c4-45bf-aac7-d8e08fd7718f" CfgFile="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\dspace-dev.vbox" SnapFldr="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\Snapshots" LogFldr="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\Logs" hardwareuuid="2283a85f-d0c4-45bf-aac7-d8e08fd7718f" memory=2048 pagefusion="off" vram=12 cpuexecutioncap=100 hpet="off" chipset="piix3" firmware="BIOS" cpus=2 pae="off" longmode="on" synthcpu="off" bootmenu="messageandmenu" boot1="disk" boot2="none" boot3="none" boot4="none" acpi="on" ioapic="on" biossystemtimeoffset=0 rtcuseutc="on" hwvirtex="on" nestedpaging="on" largepages="off" vtxvpid="on" vtxux="on" VMState="running" VMStateChangeTime="2015-07-27T17:20:44.980000000" monitorcount=1 accelerate3d="off" accelerate2dvideo="off" teleporterenabled="off" teleporterport=0 teleporteraddress="" teleporterpassword="" tracing-enabled="off" tracing-allow-vm-access="off" tracing-config="" autostart-enabled="off" autostart-delay=0 defaultfrontend="" storagecontrollername0="SATAController" storagecontrollertype0="IntelAhci" storagecontrollerinstance0="0" storagecontrollermaxportcount0="30" storagecontrollerportcount0="1" storagecontrollerbootable0="on" "SATAController-0-0"="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\box-disk1.vmdk" "SATAController-ImageUUID-0-0"="11a85771-9686-47d9-a082-452c7965d4c8" natnet1="nat" macaddress1="0800277C82C7" cableconnected1="on" nic1="nat" nictype1="82540EM" nicspeed1="0" mtu="0" sockSnd="64" sockRcv="64" tcpWndSnd="64" tcpWndRcv="64" Forwarding(0)="tcp2231,tcp,,2231,,22" Forwarding(1)="tcp8080,tcp,,8080,,8080" hostonlyadapter2="VirtualBox Host-Only Ethernet Adapter #3" macaddress2="080027F11675" cableconnected2="on" nic2="hostonly" nictype2="82540EM" nicspeed2="0" nic3="none" nic4="none" nic5="none" nic6="none" nic7="none" nic8="none" hidpointing="ps2mouse" hidkeyboard="ps2kbd" uart1="off" uart2="off" lpt1="off" lpt2="off" audio="none" clipboard="bidirectional" draganddrop="disabled" SessionType="headless" VideoMode="720,400,0"@0,0 vrde="off" usb="off" ehci="off" SharedFolderNameMachineMapping1="vagrant" SharedFolderPathMachineMapping1="C:\www\vagrant\dspace" SharedFolderNameMachineMapping2="vagrant-cache" SharedFolderPathMachineMapping2="C:\Users\flaviobb.vagrant.d\cache\dspace-trusty64" SharedFolderNameMachineMapping3="tmp_vagrant-puppet_manifests-5058f1af8388633f609cadb75a75dc9d" SharedFolderPathMachineMapping3="C:\www\vagrant\dspace" VRDEActiveConnection="off" VRDEClients=0 vcpenabled="off" vcpscreens=0 vcpfile="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\dspace-dev.webm" vcpwidth=1024 vcpheight=768 vcprate=512 vcpfps=25 GuestMemoryBalloon=0 GuestOSType="Linux26_64" GuestAdditionsRunLevel=2 GuestAdditionsVersion="4.3.18 r96516" GuestAdditionsFacility_VirtualBox Base Driver=50,1438017665511 GuestAdditionsFacility_VirtualBox System Service=50,1438017669139 GuestAdditionsFacility_Seamless Mode=0,1438017665511 GuestAdditionsFacility_Graphics Mode=0,1438017665511 DEBUG virtualbox_4_3: - [1, "tcp2231", 2231, 22] DEBUG virtualbox_4_3: - [1, "tcp8080", 8080, 8080] INFO ssh: Attempting SSH connection... INFO ssh: Attempting to connect to SSH... INFO ssh: - Host: 127.0.0.1 INFO ssh: - Port: 2231 INFO ssh: - Username: vagrant INFO ssh: - Password? false INFO ssh: - Key Path: ["C:/www/vagrant/dspace/.vagrant/machines/vagrant-dspace/virtualbox/private_key"] DEBUG ssh: == Net-SSH connection debug-level log START == DEBUG ssh: D, [2015-07-27T14:46:21.046670 #3548] DEBUG -- net.ssh.transport.session[2239890]: establishing connection to 127.0.0.1:2231 D, [2015-07-27T14:46:21.063296 #3548] DEBUG -- net.ssh.transport.session[2239890]: connection established I, [2015-07-27T14:46:21.068178 #3548] INFO -- net.ssh.transport.server_version[2238b40]: negotiating protocol version D, [2015-07-27T14:46:21.069146 #3548] DEBUG -- net.ssh.transport.server_version[2238b40]: remote is `SSH-2.0-OpenSSH_6.6.1p1 Ubuntu-2ubuntu2' D, [2015-07-27T14:46:21.069146 #3548] DEBUG -- net.ssh.transport.server_version[2238b40]: local is`SSH-2.0-Ruby/Net::SSH_2.9.2 i386-mingw32' D, [2015-07-27T14:46:21.070129 #3548] DEBUG -- tcpsocket[22393c8]: read 1632 bytes D, [2015-07-27T14:46:21.070129 #3548] DEBUG -- tcpsocket[22393c8]: received packet nr 0 type 20 len 1628 I, [2015-07-27T14:46:21.070129 #3548] INFO -- net.ssh.transport.algorithms[223c9ec]: got KEXINIT from server I, [2015-07-27T14:46:21.070129 #3548] INFO -- net.ssh.transport.algorithms[223c9ec]: sending KEXINIT D, [2015-07-27T14:46:21.070129 #3548] DEBUG -- tcpsocket[22393c8]: queueing packet nr 0 type 20 len 1684 D, [2015-07-27T14:46:21.070129 #3548] DEBUG -- tcpsocket[22393c8]: sent 1688 bytes I, [2015-07-27T14:46:21.070129 #3548] INFO -- net.ssh.transport.algorithms[223c9ec]: negotiating algorithms D, [2015-07-27T14:46:21.070129 #3548] DEBUG -- net.ssh.transport.algorithms[223c9ec]: negotiated: - kex: diffie-hellman-group-exchange-sha1 - host_key: ssh-rsa - encryption_server: aes128-cbc - encryption_client: aes128-cbc - hmac_client: hmac-sha1 - hmac_server: hmac-sha1 - compression_client: none - compression_server: none - language_client: - language_server: D, [2015-07-27T14:46:21.070129 #3548] DEBUG -- net.ssh.transport.algorithms[223c9ec]: exchanging keys D, [2015-07-27T14:46:21.071102 #3548] DEBUG -- tcpsocket[22393c8]: queueing packet nr 1 type 34 len 20 D, [2015-07-27T14:46:21.071102 #3548] DEBUG -- tcpsocket[22393c8]: sent 24 bytes D, [2015-07-27T14:46:21.081864 #3548] DEBUG -- tcpsocket[22393c8]: read 152 bytes D, [2015-07-27T14:46:21.081864 #3548] DEBUG -- tcpsocket[22393c8]: received packet nr 1 type 31 len 148 D, [2015-07-27T14:46:21.083820 #3548] DEBUG -- tcpsocket[22393c8]: queueing packet nr 2 type 32 len 140 D, [2015-07-27T14:46:21.083820 #3548] DEBUG -- tcpsocket[22393c8]: sent 144 bytes D, [2015-07-27T14:46:21.095542 #3548] DEBUG -- tcpsocket[22393c8]: read 720 bytes D, [2015-07-27T14:46:21.095542 #3548] DEBUG -- tcpsocket[22393c8]: received packet nr 2 type 33 len 700 D, [2015-07-27T14:46:21.097497 #3548] DEBUG -- tcpsocket[22393c8]: queueing packet nr 3 type 21 len 20 D, [2015-07-27T14:46:21.097497 #3548] DEBUG -- tcpsocket[22393c8]: sent 24 bytes D, [2015-07-27T14:46:21.097497 #3548] DEBUG -- tcpsocket[22393c8]: received packet nr 3 type 21 len 12 D, [2015-07-27T14:46:21.098475 #3548] DEBUG -- net.ssh.authentication.session[2299728]: beginning authentication of `vagrant' D, [2015-07-27T14:46:21.098475 #3548] DEBUG -- tcpsocket[22393c8]: queueing packet nr 4 type 5 len 28 D, [2015-07-27T14:46:21.108261 #3548] DEBUG -- tcpsocket[22393c8]: sent 52 bytes D, [2015-07-27T14:46:21.119014 #3548] DEBUG -- tcpsocket[22393c8]: read 52 bytes D, [2015-07-27T14:46:21.119014 #3548] DEBUG -- tcpsocket[22393c8]: received packet nr 4 type 6 len 28 D, [2015-07-27T14:46:21.119014 #3548] DEBUG -- net.ssh.authentication.session[2299728]: trying none D, [2015-07-27T14:46:21.119998 #3548] DEBUG -- tcpsocket[22393c8]: queueing packet nr 5 type 50 len 44 D, [2015-07-27T14:46:21.119998 #3548] DEBUG -- tcpsocket[22393c8]: sent 68 bytes D, [2015-07-27T14:46:21.130746 #3548] DEBUG -- tcpsocket[22393c8]: read 68 bytes D, [2015-07-27T14:46:21.130746 #3548] DEBUG -- tcpsocket[22393c8]: received packet nr 5 type 51 len 44 D, [2015-07-27T14:46:21.130746 #3548] DEBUG -- net.ssh.authentication.session[2299728]: allowed methods: publickey,password D, [2015-07-27T14:46:21.130746 #3548] DEBUG -- net.ssh.authentication.methods.none[f0bd48]: none failed D, [2015-07-27T14:46:21.130746 #3548] DEBUG -- net.ssh.authentication.session[2299728]: trying publickey D, [2015-07-27T14:46:21.132707 #3548] DEBUG -- net.ssh.authentication.agent[f23700]: connecting to ssh-agent E, [2015-07-27T14:46:21.132707 #3548] ERROR -- net.ssh.authentication.agent[f23700]: could not connect to ssh-agent D, [2015-07-27T14:46:21.132707 #3548] DEBUG -- net.ssh.authentication.methods.publickey[f23ed4]: trying publickey (4f:b1:42:52:37:07:99:3f:99:20:2a:8a:72:fc:10:b5) D, [2015-07-27T14:46:21.132707 #3548] DEBUG -- tcpsocket[22393c8]: queueing packet nr 6 type 50 len 348 D, [2015-07-27T14:46:21.132707 #3548] DEBUG -- tcpsocket[22393c8]: sent 372 bytes D, [2015-07-27T14:46:21.144424 #3548] DEBUG -- tcpsocket[22393c8]: read 324 bytes D, [2015-07-27T14:46:21.144424 #3548] DEBUG -- tcpsocket[22393c8]: received packet nr 6 type 60 len 300 D, [2015-07-27T14:46:21.150299 #3548] DEBUG -- tcpsocket[22393c8]: queueing packet nr 7 type 50 len 620 D, [2015-07-27T14:46:21.150299 #3548] DEBUG -- tcpsocket[22393c8]: sent 644 bytes D, [2015-07-27T14:46:21.161060 #3548] DEBUG -- tcpsocket[22393c8]: read 36 bytes D, [2015-07-27T14:46:21.161060 #3548] DEBUG -- tcpsocket[22393c8]: received packet nr 7 type 52 len 12 D, [2015-07-27T14:46:21.161060 #3548] DEBUG -- net.ssh.authentication.methods.publickey[f23ed4]: publickey succeeded (4f:b1:42:52:37:07:99:3f:99:20:2a:8a:72:fc:10:b5) DEBUG ssh: == Net-SSH connection debug-level log END == INFO ssh: SSH is ready! DEBUG ssh: Re-using SSH connection. INFO ssh: Execute: (sudo=false) DEBUG ssh: Exit status: 0 INFO subprocess: Starting process: ["C:\Program Files\Oracle\VirtualBox\VBoxManage.exe", "showvminfo", "2283a85f-d0c4-45bf-aac7-d8e08fd7718f", "--machinereadable"] DEBUG subprocess: Selecting on IO DEBUG subprocess: stdout: name="dspace-dev" groups="/" ostype="Ubuntu (32 bit)" UUID="2283a85f-d0c4-45bf-aac7-d8e08fd7718f" CfgFile="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\dspace-dev.vbox" SnapFldr="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\Snapshots" LogFldr="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\Logs" hardwareuuid="2283a85f-d0c4-45bf-aac7-d8e08fd7718f" memory=2048 pagefusion="off" vram=12 cpuexecutioncap=100 hpet="off" chipset="piix3" firmware="BIOS" cpus=2 pae="off" longmode="on" synthcpu="off" bootmenu="messageandmenu" boot1="disk" boot2="none" boot3="none" boot4="none" acpi="on" ioapic="on" biossystemtimeoffset=0 rtcuseutc="on" hwvirtex="on" nestedpaging="on" largepages="off" vtxvpid="on" vtxux="on" VMState="running" VMStateChangeTime="2015-07-27T17:20:44.980000000" monitorcount=1 accelerate3d="off" accelerate2dvideo="off" teleporterenabled="off" teleporterport=0 teleporteraddress="" teleporterpassword="" tracing-enabled="off" tracing-allow-vm-access="off" tracing-config="" autostart-enabled="off" autostart-delay=0 defaultfrontend="" storagecontrollername0="SATAController" storagecontrollertype0="IntelAhci" storagecontrollerinstance0="0" storagecontrollermaxportcount0="30" storagecontrollerportcount0="1" storagecontrollerbootable0="on" "SATAController-0-0"="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\box-disk1.vmdk" "SATAController-ImageUUID-0-0"="11a85771-9686-47d9-a082-452c7965d4c8" natnet1="nat" macaddress1="0800277C82C7" cableconnected1="on" nic1="nat" nictype1="82540EM" nicspeed1="0" mtu="0" sockSnd="64" sockRcv="64" tcpWndSnd="64" tcpWndRcv="64" Forwarding(0)="tcp2231,tcp,,2231,,22" Forwarding(1)="tcp8080,tcp,,8080,,8080" hostonlyadapter2="VirtualBox Host-Only Ethernet Adapter #3" macaddress2="080027F11675" cableconnected2="on" nic2="hostonly" nictype2="82540EM" nicspeed2="0" nic3="none" nic4="none" nic5="none" nic6="none" nic7="none" nic8="none" hidpointing="ps2mouse" hidkeyboard="ps2kbd" uart1="off" uart2="off" lpt1="off" lpt2="off" audio="none" clipboard="bidirectional" draganddrop="disabled" SessionType="headless" VideoMode="720,400,0"@0,0 vrde="off" usb="off" ehci="off" SharedFolderNameMachineMapping1="vagrant" SharedFolderPathMachineMapping1="C:\www\vagrant\dspace" SharedFolderNameMachineMapping2="vagrant-cache" SharedFolderPathMachineMapping2="C:\Users\flaviobb.vagrant.d\cache\dspace-trusty64" SharedFolderNameMachineMapping3="tmp_vagrant-puppet_manifests-5058f1af8388633f609cadb75a75dc9d" SharedFolderPathMachineMapping3="C:\www\vagrant\dspace" VRDEActiveConnection="off" VRDEClients=0 vcpenabled="off" vcpscreens=0 vcpfile="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\dspace-dev.webm" vcpwidth=1024 vcpheight=768 vcprate=512 vcpfps=25 GuestMemoryBalloon=0 GuestOSType="Linux26_64" GuestAdditionsRunLevel=2 GuestAdditionsVersion="4.3.18 r96516" GuestAdditionsFacility_VirtualBox Base Driver=50,1438017665511 GuestAdditionsFacility_VirtualBox System Service=50,1438017669139 GuestAdditionsFacility_Seamless Mode=0,1438017665511 GuestAdditionsFacility_Graphics Mode=0,1438017665511 DEBUG subprocess: Waiting for process to exit. Remaining to timeout: 32000 DEBUG subprocess: Exit status: 0 DEBUG virtualbox_4_3: Searching for SSH port: 22 DEBUG virtualbox_4_3: read_forward_ports: uuid=2283a85f-d0c4-45bf-aac7-d8e08fd7718f active_only=false INFO subprocess: Starting process: ["C:\Program Files\Oracle\VirtualBox\VBoxManage.exe", "showvminfo", "2283a85f-d0c4-45bf-aac7-d8e08fd7718f", "--machinereadable"] DEBUG subprocess: Selecting on IO DEBUG subprocess: stdout: name="dspace-dev" groups="/" ostype="Ubuntu (32 bit)" UUID="2283a85f-d0c4-45bf-aac7-d8e08fd7718f" CfgFile="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\dspace-dev.vbox" SnapFldr="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\Snapshots" LogFldr="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\Logs" hardwareuuid="2283a85f-d0c4-45bf-aac7-d8e08fd7718f" memory=2048 pagefusion="off" vram=12 cpuexecutioncap=100 hpet="off" chipset="piix3" firmware="BIOS" cpus=2 pae="off" longmode="on" synthcpu="off" bootmenu="messageandmenu" boot1="disk" boot2="none" boot3="none" boot4="none" acpi="on" ioapic="on" biossystemtimeoffset=0 rtcuseutc="on" hwvirtex="on" nestedpaging="on" largepages="off" vtxvpid="on" vtxux="on" VMState="running" VMStateChangeTime="2015-07-27T17:20:44.980000000" monitorcount=1 accelerate3d="off" accelerate2dvideo="off" teleporterenabled="off" teleporterport=0 teleporteraddress="" teleporterpassword="" tracing-enabled="off" tracing-allow-vm-access="off" tracing-config="" autostart-enabled="off" autostart-delay=0 defaultfrontend="" storagecontrollername0="SATAController" storagecontrollertype0="IntelAhci" storagecontrollerinstance0="0" storagecontrollermaxportcount0="30" storagecontrollerportcount0="1" storagecontrollerbootable0="on" "SATAController-0-0"="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\box-disk1.vmdk" "SATAController-ImageUUID-0-0"="11a85771-9686-47d9-a082-452c7965d4c8" natnet1="nat" macaddress1="0800277C82C7" cableconnected1="on" nic1="nat" nictype1="82540EM" nicspeed1="0" mtu="0" sockSnd="64" sockRcv="64" tcpWndSnd="64" tcpWndRcv="64" Forwarding(0)="tcp2231,tcp,,2231,,22" Forwarding(1)="tcp8080,tcp,,8080,,8080" hostonlyadapter2="VirtualBox Host-Only Ethernet Adapter #3" macaddress2="080027F11675" cableconnected2="on" nic2="hostonly" nictype2="82540EM" nicspeed2="0" nic3="none" nic4="none" nic5="none" nic6="none" nic7="none" nic8="none" hidpointing="ps2mouse" hidkeyboard="ps2kbd" uart1="off" uart2="off" lpt1="off" lpt2="off" audio="none" clipboard="bidirectional" draganddrop="disabled" SessionType="headless" VideoMode="720,400,0"@0,0 vrde="off" usb="off" ehci="off" SharedFolderNameMachineMapping1="vagrant" SharedFolderPathMachineMapping1="C:\www\vagrant\dspace" SharedFolderNameMachineMapping2="vagrant-cache" SharedFolderPathMachineMapping2="C:\Users\flaviobb.vagrant.d\cache\dspace-trusty64" SharedFolderNameMachineMapping3="tmp_vagrant-puppet_manifests-5058f1af8388633f609cadb75a75dc9d" SharedFolderPathMachineMapping3="C:\www\vagrant\dspace" VRDEActiveConnection="off" VRDEClients=0 vcpenabled="off" vcpscreens=0 vcpfile="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\dspace-dev.webm" vcpwidth=1024 vcpheight=768 vcprate=512 vcpfps=25 GuestMemoryBalloon=0 GuestOSType="Linux26_64" GuestAdditionsRunLevel=2 GuestAdditionsVersion="4.3.18 r96516" GuestAdditionsFacility_VirtualBox Base Driver=50,1438017665511 GuestAdditionsFacility_VirtualBox System Service=50,1438017669139 GuestAdditionsFacility_Seamless Mode=0,1438017665511 GuestAdditionsFacility_Graphics Mode=0,1438017665511 DEBUG subprocess: Waiting for process to exit. Remaining to timeout: 32000 DEBUG subprocess: Exit status: 0 DEBUG virtualbox_4_3: - [1, "tcp2231", 2231, 22] DEBUG virtualbox_4_3: - [1, "tcp8080", 8080, 8080] INFO guest: Autodetecting host type for [#] DEBUG guest: Trying: mint DEBUG ssh: Re-using SSH connection. INFO ssh: Execute: cat /etc/issue | grep 'Linux Mint' (sudo=false) DEBUG ssh: Exit status: 1 DEBUG guest: Trying: fedora DEBUG ssh: Re-using SSH connection. INFO ssh: Execute: grep 'Fedora release [12][67890]' /etc/redhat-release (sudo=false) DEBUG ssh: stderr: grep: /etc/redhat-release DEBUG ssh: stderr: : No such file or directory DEBUG ssh: Exit status: 2 DEBUG guest: Trying: pld DEBUG ssh: Re-using SSH connection. INFO ssh: Execute: cat /etc/pld-release (sudo=false) DEBUG ssh: stderr: cat: /etc/pld-release DEBUG ssh: stderr: : No such file or directory DEBUG ssh: Exit status: 1 DEBUG guest: Trying: ubuntu DEBUG ssh: Re-using SSH connection. INFO ssh: Execute: [ -x /usr/bin/lsb_release ] && /usr/bin/lsb_release -i 2>/dev/null | grep Ubuntu (sudo=false) DEBUG ssh: stdout: Distributor ID: Ubuntu DEBUG ssh: Exit status: 0 INFO guest: Detected: ubuntu! DEBUG guest: Searching for cap: rsync_command DEBUG guest: Checking in: ubuntu DEBUG guest: Checking in: debian DEBUG guest: Checking in: linux DEBUG guest: Found cap: rsync_command in linux DEBUG ssh: Checking whether SSH is ready... DEBUG ssh: Re-using SSH connection. INFO ssh: SSH is ready! DEBUG ssh: Re-using SSH connection. INFO ssh: Execute: (sudo=false) DEBUG ssh: Exit status: 0 DEBUG guest: Searching for cap: rsync_command DEBUG guest: Checking in: ubuntu DEBUG guest: Checking in: debian DEBUG guest: Checking in: linux DEBUG guest: Found cap: rsync_command in linux INFO guest: Execute capability: rsync_command [#](ubuntu) INFO interface: info: Rsyncing folder: /cygdrive/c/www/vagrant/dspace/dspace-src/ => /home/vagrant/dspace-src INFO interface: info: ==> vagrant-dspace: Rsyncing folder: /cygdrive/c/www/vagrant/dspace/dspace-src/ => /home/vagrant/dspace-src ==> vagrant-dspace: Rsyncing folder: /cygdrive/c/www/vagrant/dspace/dspace-src/ => /home/vagrant/dspace-src DEBUG ssh: Checking whether SSH is ready... DEBUG ssh: Re-using SSH connection. INFO ssh: SSH is ready! DEBUG ssh: Re-using SSH connection. INFO ssh: Execute: (sudo=false) DEBUG ssh: Exit status: 0 DEBUG guest: Searching for cap: rsync_pre DEBUG guest: Checking in: ubuntu DEBUG guest: Checking in: debian DEBUG guest: Checking in: linux DEBUG guest: Found cap: rsync_pre in linux DEBUG ssh: Checking whether SSH is ready... DEBUG ssh: Re-using SSH connection. INFO ssh: SSH is ready! DEBUG ssh: Re-using SSH connection. INFO ssh: Execute: (sudo=false) DEBUG ssh: Exit status: 0 DEBUG guest: Searching for cap: rsync_pre DEBUG guest: Checking in: ubuntu DEBUG guest: Checking in: debian DEBUG guest: Checking in: linux DEBUG guest: Found cap: rsync_pre in linux INFO guest: Execute capability: rsync_pre [#, {:type=>"rsync", :guestpath=>"/home/vagrant/dspace-src", :hostpath=>"C:/www/vagrant/dspace/dspace-src", :disabled=>false, :owner=>"vagrant", :group=>"vagrant"}](ubuntu) DEBUG ssh: Re-using SSH connection. INFO ssh: Execute: mkdir -p '/home/vagrant/dspace-src' (sudo=true) DEBUG ssh: Re-using SSH connection. INFO ssh: Execute: echo; printf $SSH_AUTH_SOCK (sudo=false) DEBUG ssh: stdout: /tmp/ssh-cGF3BrUwej/agent.3532 DEBUG ssh: Exit status: 0 INFO ssh: Setting SSH_AUTH_SOCK remotely: /tmp/ssh-cGF3BrUwej/agent.3532 DEBUG ssh: Exit status: 0 INFO subprocess: Starting process: ["C:\cygwin64\bin/rsync.EXE", "--verbose", "--archive", "--delete", "-z", "--copy-links", "--chmod=ugo=rwX", "--no-perms", "--no-owner", "--no-group", "--rsync-path", "sudo rsync", "-e", "ssh -p 2231 -o StrictHostKeyChecking=no -o UserKnownHostsFile=/dev/null -i 'C:/www/vagrant/dspace/.vagrant/machines/vagrant-dspace/virtualbox/private_key'", "--exclude", ".vagrant/", "/cygdrive/c/www/vagrant/dspace/dspace-src/", "vagrant@127.0.0.1:/home/vagrant/dspace-src"] DEBUG subprocess: Selecting on IO DEBUG subprocess: stderr: Warning: Permanently added '[127.0.0.1]:2231' (ECDSA) to the list of known hosts. DEBUG subprocess: stdout: sending incremental file list DEBUG subprocess: stdout: sent 600,262 bytes received 2,626 bytes 57,417.90 bytes/sec total size is 3,285,976,350 speedup is 5,450.39 DEBUG subprocess: Waiting for process to exit. Remaining to timeout: 31990 DEBUG subprocess: Exit status: 0 DEBUG ssh: Checking whether SSH is ready... DEBUG ssh: Re-using SSH connection. INFO ssh: SSH is ready! DEBUG ssh: Re-using SSH connection. INFO ssh: Execute: (sudo=false) DEBUG ssh: Exit status: 0 DEBUG guest: Searching for cap: rsync_post DEBUG guest: Checking in: ubuntu DEBUG guest: Checking in: debian DEBUG guest: Checking in: linux DEBUG guest: Found cap: rsync_post in linux DEBUG ssh: Checking whether SSH is ready... DEBUG ssh: Re-using SSH connection. INFO ssh: SSH is ready! DEBUG ssh: Re-using SSH connection. INFO ssh: Execute: (sudo=false) DEBUG ssh: Exit status: 0 DEBUG guest: Searching for cap: rsync_post DEBUG guest: Checking in: ubuntu DEBUG guest: Checking in: debian DEBUG guest: Checking in: linux DEBUG guest: Found cap: rsync_post in linux INFO guest: Execute capability: rsync_post [#, {:type=>"rsync", :guestpath=>"/home/vagrant/dspace-src", :hostpath=>"C:/www/vagrant/dspace/dspace-src", :disabled=>false, :owner=>"vagrant", :group=>"vagrant"}](ubuntu) DEBUG ssh: Re-using SSH connection. INFO ssh: Execute: find '/home/vagrant/dspace-src' '!' -type l -a '(' ! -user vagrant -or ! -group vagrant ')' -print0 | xargs -0 -r chown vagrant:vagrant (sudo=true) DEBUG ssh: Re-using SSH connection. INFO ssh: Execute: echo; printf $SSH_AUTH_SOCK (sudo=false) DEBUG ssh: stdout: /tmp/ssh-cGF3BrUwej/agent.3532 DEBUG ssh: Exit status: 0 INFO ssh: Setting SSH_AUTH_SOCK remotely: /tmp/ssh-cGF3BrUwej/agent.3532 DEBUG ssh: Exit status: 0 INFO subprocess: Starting process: ["C:\Program Files\Oracle\VirtualBox\VBoxManage.exe", "showvminfo", "2283a85f-d0c4-45bf-aac7-d8e08fd7718f", "--machinereadable"] DEBUG subprocess: Selecting on IO DEBUG subprocess: stdout: name="dspace-dev" groups="/" ostype="Ubuntu (32 bit)" UUID="2283a85f-d0c4-45bf-aac7-d8e08fd7718f" CfgFile="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\dspace-dev.vbox" SnapFldr="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\Snapshots" LogFldr="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\Logs" hardwareuuid="2283a85f-d0c4-45bf-aac7-d8e08fd7718f" memory=2048 pagefusion="off" vram=12 cpuexecutioncap=100 hpet="off" chipset="piix3" firmware="BIOS" cpus=2 pae="off" longmode="on" synthcpu="off" bootmenu="messageandmenu" boot1="disk" boot2="none" boot3="none" boot4="none" acpi="on" ioapic="on" biossystemtimeoffset=0 rtcuseutc="on" hwvirtex="on" nestedpaging="on" largepages="off" vtxvpid="on" vtxux="on" VMState="running" VMStateChangeTime="2015-07-27T17:20:44.980000000" monitorcount=1 accelerate3d="off" accelerate2dvideo="off" teleporterenabled="off" teleporterport=0 teleporteraddress="" teleporterpassword="" tracing-enabled="off" tracing-allow-vm-access="off" tracing-config="" autostart-enabled="off" autostart-delay=0 defaultfrontend="" storagecontrollername0="SATAController" storagecontrollertype0="IntelAhci" storagecontrollerinstance0="0" storagecontrollermaxportcount0="30" storagecontrollerportcount0="1" storagecontrollerbootable0="on" "SATAController-0-0"="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\box-disk1.vmdk" "SATAController-ImageUUID-0-0"="11a85771-9686-47d9-a082-452c7965d4c8" natnet1="nat" macaddress1="0800277C82C7" cableconnected1="on" nic1="nat" nictype1="82540EM" nicspeed1="0" mtu="0" sockSnd="64" sockRcv="64" tcpWndSnd="64" tcpWndRcv="64" Forwarding(0)="tcp2231,tcp,,2231,,22" Forwarding(1)="tcp8080,tcp,,8080,,8080" hostonlyadapter2="VirtualBox Host-Only Ethernet Adapter #3" macaddress2="080027F11675" cableconnected2="on" nic2="hostonly" nictype2="82540EM" nicspeed2="0" nic3="none" nic4="none" nic5="none" nic6="none" nic7="none" nic8="none" hidpointing="ps2mouse" hidkeyboard="ps2kbd" uart1="off" uart2="off" lpt1="off" lpt2="off" audio="none" clipboard="bidirectional" draganddrop="disabled" SessionType="headless" VideoMode="720,400,0"@0,0 vrde="off" usb="off" ehci="off" SharedFolderNameMachineMapping1="vagrant" SharedFolderPathMachineMapping1="C:\www\vagrant\dspace" SharedFolderNameMachineMapping2="vagrant-cache" SharedFolderPathMachineMapping2="C:\Users\flaviobb.vagrant.d\cache\dspace-trusty64" SharedFolderNameMachineMapping3="tmp_vagrant-puppet_manifests-5058f1af8388633f609cadb75a75dc9d" SharedFolderPathMachineMapping3="C:\www\vagrant\dspace" VRDEActiveConnection="off" VRDEClients=0 vcpenabled="off" vcpscreens=0 vcpfile="C:\Users\flaviobb\VirtualBox VMs\dspace-dev\dspace-dev.webm" vcpwidth=1024 vcpheight=768 vcprate=512 vcpfps=25 GuestMemoryBalloon=0 GuestOSType="Linux26_64" GuestAdditionsRunLevel=2 GuestAdditionsVersion="4.3.18 r96516" GuestAdditionsFacility_VirtualBox Base Driver=50,1438017665511 GuestAdditionsFacility_VirtualBox System Service=50,1438017669139 GuestAdditionsFacility_Seamless Mode=0,1438017665511 GuestAdditionsFacility_Graphics Mode=0,1438017665511 DEBUG subprocess: Waiting for process to exit. Remaining to timeout: 31999 DEBUG subprocess: Exit status: 0 INFO interface: info: Watching: C:/www/vagrant/dspace/dspace-src INFO interface: info: ==> vagrant-dspace: Watching: C:/www/vagrant/dspace/dspace-src ==> vagrant-dspace: Watching: C:/www/vagrant/dspace/dspace-src INFO rsync-auto: Listening to paths: ["C:/www/vagrant/dspace/dspace-src"] INFO rsync-auto: Ignoring 0 paths: D, [2015-07-27T14:46:33.098901 #3548] DEBUG -- : Adapter: considering TCP ... D, [2015-07-27T14:46:33.099864 #3548] DEBUG -- : Adapter: considering polling ... D, [2015-07-27T14:46:33.099864 #3548] DEBUG -- : Adapter: considering optimized backend... INFO rsync-auto: Listening via: Listen::Adapter::Windows # > @branch=:services> INFO environment: Running hook: environment_unload INFO host: Autodetecting host type for [#] DEBUG host: Trying: arch DEBUG host: Trying: darwin DEBUG host: Trying: freebsd DEBUG host: Trying: gentoo DEBUG host: Trying: redhat DEBUG host: Trying: slackware DEBUG host: Trying: suse DEBUG host: Trying: bsd DEBUG host: Trying: linux DEBUG host: Trying: null DEBUG host: Trying: windows INFO host: Detected: windows! INFO runner: Preparing hooks for middleware sequence... INFO runner: 5 hooks defined. INFO runner: Running action: #Vagrant::Action::Builder:0x390c420 INFO warden: Calling IN action: #VagrantPlugins::Triggers::Action::Trigger:0x3cdcc38 INFO warden: Calling IN action: #VagrantPlugins::Triggers::Action::Trigger:0x4353ed0 INFO warden: Calling IN action: #VagrantPlugins::Triggers::Action::Trigger:0x437b2a8 INFO warden: Calling OUT action: #VagrantPlugins::Triggers::Action::Trigger:0x437b2a8 INFO warden: Calling OUT action: #VagrantPlugins::Triggers::Action::Trigger:0x4353ed0 INFO warden: Calling OUT action: #VagrantPlugins::Triggers::Action::Trigger:0x3cdcc38 C:/Users/flaviobb/.vagrant.d/gems/gems/celluloid-0.17.0/lib/celluloid/calls.rb:49:in `check': wrong number of arguments (2 for 1) (ArgumentError) from C:/Users/flaviobb/.vagrant.d/gems/gems/celluloid-0.17.0/lib/celluloid/calls.rb:26:in`dispatch' from C:/Users/flaviobb/.vagrant.d/gems/gems/celluloid-0.17.0/lib/celluloid/call/sync.rb:16:in `dispatch' from C:/Users/flaviobb/.vagrant.d/gems/gems/celluloid-0.17.0/lib/celluloid/cell.rb:50:in`block in dispatch' from C:/Users/flaviobb/.vagrant.d/gems/gems/celluloid-0.17.0/lib/celluloid/cell.rb:76:in `block in task' from C:/Users/flaviobb/.vagrant.d/gems/gems/celluloid-0.17.0/lib/celluloid/actor.rb:363:in`block in task' from C:/Users/flaviobb/.vagrant.d/gems/gems/celluloid-0.17.0/lib/celluloid/task.rb:57:in `block in initialize' from C:/Users/flaviobb/.vagrant.d/gems/gems/celluloid-0.17.0/lib/celluloid/task/fibered.rb:14:in`block in create' from (celluloid):0:in `remote procedure call' from C:/Users/flaviobb/.vagrant.d/gems/gems/celluloid-0.17.0/lib/celluloid/call/sync.rb:45:in`value' from C:/Users/flaviobb/.vagrant.d/gems/gems/celluloid-0.17.0/lib/celluloid/proxy/sync.rb:40:in `method_missing' from C:/Users/flaviobb/.vagrant.d/gems/gems/listen-2.8.6/lib/listen/listener.rb:206:in`_init_actors' from C:/Users/flaviobb/.vagrant.d/gems/gems/listen-2.8.6/lib/listen/listener.rb:87:in `block in ' from C:/Users/flaviobb/.vagrant.d/gems/gems/celluloid-fsm-0.20.0/lib/celluloid/fsm.rb:176:in`instance_eval' from C:/Users/flaviobb/.vagrant.d/gems/gems/celluloid-fsm-0.20.0/lib/celluloid/fsm.rb:176:in `call' from C:/Users/flaviobb/.vagrant.d/gems/gems/celluloid-fsm-0.20.0/lib/celluloid/fsm.rb:129:in`transition_with_callbacks!' from C:/Users/flaviobb/.vagrant.d/gems/gems/celluloid-fsm-0.20.0/lib/celluloid/fsm.rb:97:in `transition' from C:/Users/flaviobb/.vagrant.d/gems/gems/listen-2.8.6/lib/listen/listener.rb:100:in`start' from C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/synced_folders/rsync/command/rsync_auto.rb:142:in `block in execute' from C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/lib/vagrant/util/busy.rb:19:in`busy' from C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/plugins/synced_folders/rsync/command/rsync_auto.rb:141:in `execute' from C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/lib/vagrant/cli.rb:42:in`execute' from C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/lib/vagrant/environment.rb:301:in `cli' from C:/HashiCorp/Vagrant/embedded/gems/gems/vagrant-1.7.2/bin/vagrant:174:in`
'
nfloersch commented 9 years ago

is this related to issue #5834 ?

nuncanada commented 9 years ago

No, rsync is working fine. It is just rsync-auto that isn't. Em 29/07/2015 12:38, "nfloersch" notifications@github.com escreveu:

is this related to issue #5834 https://github.com/mitchellh/vagrant/issues/5834 ?

— Reply to this email directly or view it on GitHub https://github.com/mitchellh/vagrant/issues/6041#issuecomment-125992560.

sethvargo commented 9 years ago

Hi @nuncanada

Can you please reproduce this issue with no Vagrant plugins installed? The stack trace is coming from a plugin from celluloid (which Vagrant does not use). Thanks!

nuncanada commented 9 years ago

Ok, I had both cygwin, MinGW and yet another MinGW installation through a Git for Windows installer. I updated Vagrant, and got rid of the Git for Windows MinGW installation and everything is working fine now... I guess it was not vagrant's fault...

nuncanada commented 9 years ago

Just noticed that the debug verbose output came from the cygwin shell. The try I got working was using MinGW after I got rid of the second installation. I have yet to try in the Cygwin shell... But anyways, MinGW seem a better fit than Cygwin for our needs..