builder: mozilla-central_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-032 starttime: 1447472871.09 results: success (0) buildid: 20151113183032 builduid: 61035669082c4419ac8a057b9b4ed553 revision: 202b199b9fcf37a687bef882f2513e191f079622 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-13 19:47:51.094758) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-13 19:47:51.095299) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-13 19:47:51.095640) ========= bash -c pwd in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'pwd'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=2dd9ebcff44b3efbe7b51203000001d7-1447472871.147031-1468704545 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006436 basedir: '/builds/slave/test' ========= master_lag: 0.01 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-13 19:47:51.114516) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-13 19:47:51.114863) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-13 19:47:51.124382) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-13 19:47:51.124687) ========= rm -rf properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=2dd9ebcff44b3efbe7b51203000001d7-1447472871.147031-1468704545 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004530 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-13 19:47:51.174590) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-13 19:47:51.174959) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-13 19:47:51.175389) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-13 19:47:51.175801) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=2dd9ebcff44b3efbe7b51203000001d7-1447472871.147031-1468704545 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-11-13 19:47:51-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 56.9M=0s 2015-11-13 19:47:52 (56.9 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.201068 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-13 19:47:51.392118) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-13 19:47:51.392509) ========= rm -rf scripts in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=2dd9ebcff44b3efbe7b51203000001d7-1447472871.147031-1468704545 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.018722 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-13 19:47:51.446020) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2015-11-13 19:47:51.446859) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 202b199b9fcf37a687bef882f2513e191f079622 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev 202b199b9fcf37a687bef882f2513e191f079622 --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=2dd9ebcff44b3efbe7b51203000001d7-1447472871.147031-1468704545 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-11-13 19:47:52,233 truncating revision to first 12 chars 2015-11-13 19:47:52,233 Setting DEBUG logging. 2015-11-13 19:47:52,233 attempt 1/10 2015-11-13 19:47:52,233 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/202b199b9fcf?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-13 19:47:53,216 unpacking tar archive at: mozilla-central-202b199b9fcf/testing/mozharness/ program finished with exit code 0 elapsedTime=1.282952 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2015-11-13 19:47:52.744405) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-13 19:47:52.744860) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-13 19:47:52.753721) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-13 19:47:52.754140) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-13 19:47:52.754706) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 3 secs) (at 2015-11-13 19:47:52.755085) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox-Non-PGO --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox-Non-PGO', '--system-bits', '64', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=2dd9ebcff44b3efbe7b51203000001d7-1447472871.147031-1468704545 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 19:47:53 INFO - MultiFileLogger online at 20151113 19:47:53 in /builds/slave/test 19:47:53 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox-Non-PGO --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 19:47:53 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 19:47:53 INFO - {'append_to_log': False, 19:47:53 INFO - 'base_work_dir': '/builds/slave/test', 19:47:53 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 19:47:53 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 19:47:53 INFO - 'branch': 'Firefox-Non-PGO', 19:47:53 INFO - 'buildbot_json_path': 'buildprops.json', 19:47:53 INFO - 'config_files': ('talos/linux_config.py',), 19:47:53 INFO - 'default_actions': ('clobber', 19:47:53 INFO - 'read-buildbot-config', 19:47:53 INFO - 'download-and-extract', 19:47:53 INFO - 'populate-webroot', 19:47:53 INFO - 'create-virtualenv', 19:47:53 INFO - 'install', 19:47:53 INFO - 'run-tests'), 19:47:53 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 19:47:53 INFO - 'download_minidump_stackwalk': True, 19:47:53 INFO - 'download_symbols': 'ondemand', 19:47:53 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 19:47:53 INFO - 'tooltool.py': '/tools/tooltool.py', 19:47:53 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 19:47:53 INFO - '/tools/misc-python/virtualenv.py')}, 19:47:53 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 19:47:53 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 19:47:53 INFO - 'installer_path': 'installer.exe', 19:47:53 INFO - 'log_level': 'info', 19:47:53 INFO - 'log_name': 'talos', 19:47:53 INFO - 'log_to_console': True, 19:47:53 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 19:47:53 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 19:47:53 INFO - 'opt_config_files': (), 19:47:53 INFO - 'pip_index': False, 19:47:53 INFO - 'sps_profile': False, 19:47:53 INFO - 'sps_profile_interval': 0, 19:47:53 INFO - 'suite': 'dromaeojs-e10s', 19:47:53 INFO - 'system_bits': '64', 19:47:53 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 19:47:53 INFO - 'title': 'talos-linux64-ix-032', 19:47:53 INFO - 'tooltool_cache': '/builds/tooltool_cache', 19:47:53 INFO - 'use_talos_json': True, 19:47:53 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 19:47:53 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 19:47:53 INFO - 'work_dir': 'build'} 19:47:53 INFO - ##### 19:47:53 INFO - ##### Running clobber step. 19:47:53 INFO - ##### 19:47:53 INFO - Running pre-action listener: _resource_record_pre_action 19:47:53 INFO - Running main action method: clobber 19:47:53 INFO - rmtree: /builds/slave/test/build 19:47:53 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 19:47:54 INFO - Running post-action listener: _resource_record_post_action 19:47:54 INFO - ##### 19:47:54 INFO - ##### Running read-buildbot-config step. 19:47:54 INFO - ##### 19:47:54 INFO - Running pre-action listener: _resource_record_pre_action 19:47:54 INFO - Running main action method: read_buildbot_config 19:47:54 INFO - Using buildbot properties: 19:47:54 INFO - { 19:47:54 INFO - "properties": { 19:47:54 INFO - "buildnumber": 94, 19:47:54 INFO - "product": "firefox", 19:47:54 INFO - "script_repo_revision": "production", 19:47:54 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-e10s", 19:47:54 INFO - "repository": "", 19:47:54 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs-e10s", 19:47:54 INFO - "buildid": "20151113183032", 19:47:54 INFO - "slavename": "talos-linux64-ix-032", 19:47:54 INFO - "pgo_build": "False", 19:47:54 INFO - "basedir": "/builds/slave/test", 19:47:54 INFO - "project": "", 19:47:54 INFO - "platform": "ubuntu64_hw", 19:47:54 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 19:47:54 INFO - "slavebuilddir": "test", 19:47:54 INFO - "scheduler": "tests-mozilla-central-linux64-talos", 19:47:54 INFO - "branch": "mozilla-central", 19:47:54 INFO - "repo_path": "mozilla-central", 19:47:54 INFO - "stage_platform": "linux64", 19:47:54 INFO - "builduid": "61035669082c4419ac8a057b9b4ed553", 19:47:54 INFO - "revision": "202b199b9fcf37a687bef882f2513e191f079622" 19:47:54 INFO - }, 19:47:54 INFO - "sourcestamp": { 19:47:54 INFO - "repository": "", 19:47:54 INFO - "hasPatch": false, 19:47:54 INFO - "project": "", 19:47:54 INFO - "branch": "mozilla-central-linux64-talos", 19:47:54 INFO - "changes": [ 19:47:54 INFO - { 19:47:54 INFO - "category": null, 19:47:54 INFO - "files": [ 19:47:54 INFO - { 19:47:54 INFO - "url": null, 19:47:54 INFO - "name": "https://queue.taskcluster.net/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2" 19:47:54 INFO - } 19:47:54 INFO - ], 19:47:54 INFO - "repository": "", 19:47:54 INFO - "rev": "202b199b9fcf37a687bef882f2513e191f079622", 19:47:54 INFO - "who": "philringnalda@gmail.com", 19:47:54 INFO - "when": 1447472602, 19:47:54 INFO - "number": 6661451, 19:47:54 INFO - "comments": "Bug 1223394 - disable permaorange webrtc tests on Mulet, a=verylargeorange", 19:47:54 INFO - "project": "", 19:47:54 INFO - "at": "Fri 13 Nov 2015 19:43:22", 19:47:54 INFO - "branch": "mozilla-central-linux64-talos", 19:47:54 INFO - "revlink": "", 19:47:54 INFO - "properties": [ 19:47:54 INFO - [ 19:47:54 INFO - "buildid", 19:47:54 INFO - "20151113183032", 19:47:54 INFO - "Change" 19:47:54 INFO - ], 19:47:54 INFO - [ 19:47:54 INFO - "builduid", 19:47:54 INFO - "61035669082c4419ac8a057b9b4ed553", 19:47:54 INFO - "Change" 19:47:54 INFO - ], 19:47:54 INFO - [ 19:47:54 INFO - "pgo_build", 19:47:54 INFO - "False", 19:47:54 INFO - "Change" 19:47:54 INFO - ] 19:47:54 INFO - ], 19:47:54 INFO - "revision": "202b199b9fcf37a687bef882f2513e191f079622" 19:47:54 INFO - } 19:47:54 INFO - ], 19:47:54 INFO - "revision": "202b199b9fcf37a687bef882f2513e191f079622" 19:47:54 INFO - } 19:47:54 INFO - } 19:47:54 INFO - Found installer url https://queue.taskcluster.net/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2. 19:47:54 INFO - Running post-action listener: _resource_record_post_action 19:47:54 INFO - ##### 19:47:54 INFO - ##### Running download-and-extract step. 19:47:54 INFO - ##### 19:47:54 INFO - Running pre-action listener: _resource_record_pre_action 19:47:54 INFO - Running main action method: download_and_extract 19:47:54 INFO - mkdir: /builds/slave/test/build/tests 19:47:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:47:54 INFO - https://queue.taskcluster.net/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 19:47:54 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/test_packages.json 19:47:54 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/test_packages.json 19:47:54 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 19:47:54 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 19:47:54 INFO - Downloaded 1302 bytes. 19:47:54 INFO - Reading from file /builds/slave/test/build/test_packages.json 19:47:54 INFO - Using the following test package requirements: 19:47:54 INFO - {u'common': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 19:47:54 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 19:47:54 INFO - u'firefox-45.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 19:47:54 INFO - u'jittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 19:47:54 INFO - u'jsshell-linux-x86_64.zip'], 19:47:54 INFO - u'mochitest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 19:47:54 INFO - u'firefox-45.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 19:47:54 INFO - u'mozbase': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 19:47:54 INFO - u'reftest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 19:47:54 INFO - u'firefox-45.0a1.en-US.linux-x86_64.reftest.tests.zip'], 19:47:54 INFO - u'talos': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 19:47:54 INFO - u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'], 19:47:54 INFO - u'web-platform': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 19:47:54 INFO - u'firefox-45.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 19:47:54 INFO - u'webapprt': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 19:47:54 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 19:47:54 INFO - u'firefox-45.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 19:47:54 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 19:47:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:47:54 INFO - https://queue.taskcluster.net/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 19:47:54 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 19:47:54 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 19:47:54 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 19:47:54 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 19:47:55 INFO - Downloaded 21256743 bytes. 19:47:55 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 19:47:55 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 19:47:55 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 19:47:56 INFO - Return code: 0 19:47:56 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 19:47:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:47:56 INFO - https://queue.taskcluster.net/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 19:47:56 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 19:47:56 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 19:47:56 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 19:47:56 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 19:47:57 INFO - Downloaded 21256743 bytes. 19:47:57 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 19:47:57 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 19:47:57 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 19:47:59 INFO - Return code: 0 19:47:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:47:59 INFO - https://queue.taskcluster.net/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 19:47:59 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 19:47:59 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 19:47:59 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 19:47:59 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 19:47:59 INFO - Downloaded 11131693 bytes. 19:47:59 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] in /builds/slave/test/build/tests 19:47:59 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 19:47:59 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] with output_timeout 1760 19:48:00 INFO - Return code: 0 19:48:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:48:00 INFO - https://queue.taskcluster.net/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 19:48:00 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 19:48:00 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 19:48:00 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 19:48:00 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 19:48:02 INFO - Downloaded 55615894 bytes. 19:48:02 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 19:48:02 INFO - mkdir: /builds/slave/test/properties 19:48:02 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 19:48:02 INFO - Writing to file /builds/slave/test/properties/build_url 19:48:02 INFO - Contents: 19:48:02 INFO - build_url:https://queue.taskcluster.net/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 19:48:02 INFO - Running post-action listener: _resource_record_post_action 19:48:02 INFO - Running post-action listener: set_extra_try_arguments 19:48:02 INFO - ##### 19:48:02 INFO - ##### Running populate-webroot step. 19:48:02 INFO - ##### 19:48:02 INFO - Running pre-action listener: _resource_record_pre_action 19:48:02 INFO - Running main action method: populate_webroot 19:48:02 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 19:48:02 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 19:48:02 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 19:48:02 INFO - '../fennec_ids.txt'], 19:48:02 INFO - 'tests': ['tcheck2']}, 19:48:02 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 19:48:02 INFO - '--tppagecycles', 19:48:02 INFO - '7'], 19:48:02 INFO - 'tests': ['tsvgm']}}, 19:48:02 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 19:48:02 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 19:48:02 INFO - 'tests': ['tresize', 'tcanvasmark']}, 19:48:02 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 19:48:02 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 19:48:02 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 19:48:02 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:48:02 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 19:48:02 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:48:02 INFO - 'talos_options': ['--e10s'], 19:48:02 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 19:48:02 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:48:02 INFO - 'tests': ['damp', 'tps']}, 19:48:02 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:48:02 INFO - 'talos_options': ['--e10s'], 19:48:02 INFO - 'tests': ['damp', 'tps']}, 19:48:02 INFO - 'g3': {'tests': ['dromaeo_dom']}, 19:48:02 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 19:48:02 INFO - 'other': {'tests': ['a11yr', 19:48:02 INFO - 'ts_paint', 19:48:02 INFO - 'tpaint', 19:48:02 INFO - 'sessionrestore', 19:48:02 INFO - 'sessionrestore_no_auto_restore']}, 19:48:02 INFO - 'other-e10s': {'talos_options': ['--e10s'], 19:48:02 INFO - 'tests': ['a11yr', 19:48:02 INFO - 'ts_paint', 19:48:02 INFO - 'tpaint', 19:48:02 INFO - 'sessionrestore', 19:48:02 INFO - 'sessionrestore_no_auto_restore']}, 19:48:02 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 19:48:02 INFO - 'tests': ['a11yr', 19:48:02 INFO - 'ts_paint', 19:48:02 INFO - 'tpaint', 19:48:02 INFO - 'sessionrestore', 19:48:02 INFO - 'sessionrestore_no_auto_restore']}, 19:48:02 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 19:48:02 INFO - 'tests': ['a11yr', 19:48:02 INFO - 'ts_paint', 19:48:02 INFO - 'tpaint', 19:48:02 INFO - 'sessionrestore', 19:48:02 INFO - 'sessionrestore_no_auto_restore']}, 19:48:02 INFO - 'other_l64': {'tests': ['a11yr', 19:48:02 INFO - 'ts_paint', 19:48:02 INFO - 'tpaint', 19:48:02 INFO - 'sessionrestore', 19:48:02 INFO - 'sessionrestore_no_auto_restore']}, 19:48:02 INFO - 'other_nol64': {'tests': ['a11yr', 19:48:02 INFO - 'ts_paint', 19:48:02 INFO - 'tpaint', 19:48:02 INFO - 'sessionrestore', 19:48:02 INFO - 'sessionrestore_no_auto_restore']}, 19:48:02 INFO - 'svgr': {'tests': ['tsvgx', 19:48:02 INFO - 'tsvgr_opacity', 19:48:02 INFO - 'tart', 19:48:02 INFO - 'tscrollx', 19:48:02 INFO - 'cart']}, 19:48:02 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 19:48:02 INFO - 'tests': ['tsvgx', 19:48:02 INFO - 'tsvgr_opacity', 19:48:02 INFO - 'tart', 19:48:02 INFO - 'tscrollx', 19:48:02 INFO - 'cart']}, 19:48:02 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:48:02 INFO - 'tests': ['tp5o']}, 19:48:02 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:48:02 INFO - 'talos_options': ['--e10s'], 19:48:02 INFO - 'tests': ['tp5o']}, 19:48:02 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:48:02 INFO - 'talos_options': ['--xperf_path', 19:48:02 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 19:48:02 INFO - 'tests': ['tp5n']}, 19:48:02 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:48:02 INFO - 'talos_options': ['--e10s', 19:48:02 INFO - '--xperf_path', 19:48:02 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 19:48:02 INFO - 'tests': ['tp5n']}}, 19:48:02 INFO - 'talos.zip': {'path': '', 19:48:02 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 19:48:02 INFO - Running post-action listener: _resource_record_post_action 19:48:02 INFO - ##### 19:48:02 INFO - ##### Running create-virtualenv step. 19:48:02 INFO - ##### 19:48:02 INFO - Running pre-action listener: _resource_record_pre_action 19:48:02 INFO - Running main action method: create_virtualenv 19:48:02 INFO - Creating virtualenv /builds/slave/test/build/venv 19:48:02 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 19:48:02 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 19:48:02 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 19:48:02 INFO - Using real prefix '/usr' 19:48:02 INFO - New python executable in /builds/slave/test/build/venv/bin/python 19:48:02 INFO - Installing distribute.............................................................................................................................................................................................done. 19:48:04 INFO - Installing pip.................done. 19:48:04 INFO - Return code: 0 19:48:04 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 19:48:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:48:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:48:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:48:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:48:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:48:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:48:04 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f3841e32c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x270b6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27bc9a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x284bac0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x284c9a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x284ce50>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1447472871.147031-1468704545', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:48:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 19:48:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 19:48:04 INFO - Using env: {'DISPLAY': ':0', 19:48:04 INFO - 'HOME': '/home/cltbld', 19:48:04 INFO - 'LANG': 'en_US.UTF-8', 19:48:04 INFO - 'LANGUAGE': 'en_US:en', 19:48:04 INFO - 'LOGNAME': 'cltbld', 19:48:04 INFO - 'MAIL': '/var/mail/cltbld', 19:48:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:48:04 INFO - 'MOZ_NO_REMOTE': '1', 19:48:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:48:04 INFO - 'NO_EM_RESTART': '1', 19:48:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:48:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:48:04 INFO - 'PWD': '/builds/slave/test', 19:48:04 INFO - 'SHELL': '/bin/bash', 19:48:04 INFO - 'SHLVL': '1', 19:48:04 INFO - 'TERM': 'linux', 19:48:04 INFO - 'TMOUT': '86400', 19:48:04 INFO - 'USER': 'cltbld', 19:48:04 INFO - 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1447472871.147031-1468704545', 19:48:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:48:04 INFO - '_': '/tools/buildbot/bin/python'} 19:48:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:48:05 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 19:48:05 INFO - Cleaning up... 19:48:05 INFO - Return code: 0 19:48:05 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 19:48:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:48:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:48:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:48:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:48:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:48:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:48:05 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f3841e32c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x270b6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27bc9a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x284bac0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x284c9a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x284ce50>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1447472871.147031-1468704545', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:48:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 19:48:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 19:48:05 INFO - Using env: {'DISPLAY': ':0', 19:48:05 INFO - 'HOME': '/home/cltbld', 19:48:05 INFO - 'LANG': 'en_US.UTF-8', 19:48:05 INFO - 'LANGUAGE': 'en_US:en', 19:48:05 INFO - 'LOGNAME': 'cltbld', 19:48:05 INFO - 'MAIL': '/var/mail/cltbld', 19:48:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:48:05 INFO - 'MOZ_NO_REMOTE': '1', 19:48:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:48:05 INFO - 'NO_EM_RESTART': '1', 19:48:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:48:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:48:05 INFO - 'PWD': '/builds/slave/test', 19:48:05 INFO - 'SHELL': '/bin/bash', 19:48:05 INFO - 'SHLVL': '1', 19:48:05 INFO - 'TERM': 'linux', 19:48:05 INFO - 'TMOUT': '86400', 19:48:05 INFO - 'USER': 'cltbld', 19:48:05 INFO - 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1447472871.147031-1468704545', 19:48:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:48:05 INFO - '_': '/tools/buildbot/bin/python'} 19:48:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:48:05 INFO - Downloading/unpacking psutil>=0.7.1 19:48:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:48:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:48:05 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:48:05 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:48:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:48:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:48:07 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 19:48:07 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 19:48:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 19:48:07 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 19:48:07 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 19:48:07 INFO - Installing collected packages: psutil 19:48:07 INFO - Running setup.py install for psutil 19:48:07 INFO - building 'psutil._psutil_linux' extension 19:48:07 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 19:48:07 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 19:48:07 INFO - building 'psutil._psutil_posix' extension 19:48:07 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 19:48:07 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 19:48:07 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 19:48:07 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 19:48:07 INFO - Successfully installed psutil 19:48:07 INFO - Cleaning up... 19:48:07 INFO - Return code: 0 19:48:07 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 19:48:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:48:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:48:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:48:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:48:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:48:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:48:07 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f3841e32c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x270b6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27bc9a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x284bac0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x284c9a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x284ce50>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1447472871.147031-1468704545', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:48:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 19:48:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 19:48:07 INFO - Using env: {'DISPLAY': ':0', 19:48:07 INFO - 'HOME': '/home/cltbld', 19:48:07 INFO - 'LANG': 'en_US.UTF-8', 19:48:07 INFO - 'LANGUAGE': 'en_US:en', 19:48:07 INFO - 'LOGNAME': 'cltbld', 19:48:07 INFO - 'MAIL': '/var/mail/cltbld', 19:48:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:48:07 INFO - 'MOZ_NO_REMOTE': '1', 19:48:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:48:07 INFO - 'NO_EM_RESTART': '1', 19:48:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:48:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:48:07 INFO - 'PWD': '/builds/slave/test', 19:48:07 INFO - 'SHELL': '/bin/bash', 19:48:07 INFO - 'SHLVL': '1', 19:48:07 INFO - 'TERM': 'linux', 19:48:07 INFO - 'TMOUT': '86400', 19:48:07 INFO - 'USER': 'cltbld', 19:48:07 INFO - 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1447472871.147031-1468704545', 19:48:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:48:07 INFO - '_': '/tools/buildbot/bin/python'} 19:48:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:48:07 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 19:48:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:48:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:48:07 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:48:07 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:48:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:48:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:48:09 INFO - Downloading mozsystemmonitor-0.0.tar.gz 19:48:09 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 19:48:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 19:48:09 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 19:48:09 INFO - Installing collected packages: mozsystemmonitor 19:48:09 INFO - Running setup.py install for mozsystemmonitor 19:48:09 INFO - Successfully installed mozsystemmonitor 19:48:09 INFO - Cleaning up... 19:48:09 INFO - Return code: 0 19:48:09 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 19:48:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:48:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:48:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:48:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:48:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:48:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:48:09 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f3841e32c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x270b6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27bc9a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x284bac0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x284c9a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x284ce50>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1447472871.147031-1468704545', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:48:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 19:48:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 19:48:09 INFO - Using env: {'DISPLAY': ':0', 19:48:09 INFO - 'HOME': '/home/cltbld', 19:48:09 INFO - 'LANG': 'en_US.UTF-8', 19:48:09 INFO - 'LANGUAGE': 'en_US:en', 19:48:09 INFO - 'LOGNAME': 'cltbld', 19:48:09 INFO - 'MAIL': '/var/mail/cltbld', 19:48:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:48:09 INFO - 'MOZ_NO_REMOTE': '1', 19:48:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:48:09 INFO - 'NO_EM_RESTART': '1', 19:48:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:48:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:48:09 INFO - 'PWD': '/builds/slave/test', 19:48:09 INFO - 'SHELL': '/bin/bash', 19:48:09 INFO - 'SHLVL': '1', 19:48:09 INFO - 'TERM': 'linux', 19:48:09 INFO - 'TMOUT': '86400', 19:48:09 INFO - 'USER': 'cltbld', 19:48:09 INFO - 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1447472871.147031-1468704545', 19:48:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:48:09 INFO - '_': '/tools/buildbot/bin/python'} 19:48:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:48:09 INFO - Downloading/unpacking blobuploader==1.2.4 19:48:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:48:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:48:09 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:48:09 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:48:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:48:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:48:11 INFO - Downloading blobuploader-1.2.4.tar.gz 19:48:11 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 19:48:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 19:48:11 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 19:48:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:48:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:48:11 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:48:11 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:48:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:48:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:48:11 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 19:48:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 19:48:12 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 19:48:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:48:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:48:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:48:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:48:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:48:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:48:12 INFO - Downloading docopt-0.6.1.tar.gz 19:48:12 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 19:48:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 19:48:12 INFO - Installing collected packages: blobuploader, requests, docopt 19:48:12 INFO - Running setup.py install for blobuploader 19:48:12 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 19:48:12 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 19:48:12 INFO - Running setup.py install for requests 19:48:12 INFO - Running setup.py install for docopt 19:48:12 INFO - Successfully installed blobuploader requests docopt 19:48:12 INFO - Cleaning up... 19:48:12 INFO - Return code: 0 19:48:12 INFO - Installing None into virtualenv /builds/slave/test/build/venv 19:48:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:48:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:48:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:48:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:48:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:48:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:48:12 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f3841e32c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x270b6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27bc9a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x284bac0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x284c9a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x284ce50>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1447472871.147031-1468704545', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:48:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 19:48:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 19:48:12 INFO - Using env: {'DISPLAY': ':0', 19:48:12 INFO - 'HOME': '/home/cltbld', 19:48:12 INFO - 'LANG': 'en_US.UTF-8', 19:48:12 INFO - 'LANGUAGE': 'en_US:en', 19:48:12 INFO - 'LOGNAME': 'cltbld', 19:48:12 INFO - 'MAIL': '/var/mail/cltbld', 19:48:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:48:12 INFO - 'MOZ_NO_REMOTE': '1', 19:48:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:48:12 INFO - 'NO_EM_RESTART': '1', 19:48:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:48:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:48:12 INFO - 'PWD': '/builds/slave/test', 19:48:12 INFO - 'SHELL': '/bin/bash', 19:48:12 INFO - 'SHLVL': '1', 19:48:12 INFO - 'TERM': 'linux', 19:48:12 INFO - 'TMOUT': '86400', 19:48:12 INFO - 'USER': 'cltbld', 19:48:12 INFO - 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1447472871.147031-1468704545', 19:48:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:48:12 INFO - '_': '/tools/buildbot/bin/python'} 19:48:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:48:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 19:48:13 INFO - Running setup.py (path:/tmp/pip-G608Sh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 19:48:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 19:48:13 INFO - Running setup.py (path:/tmp/pip-fDKDWh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 19:48:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 19:48:13 INFO - Running setup.py (path:/tmp/pip-HJqzZJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 19:48:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 19:48:13 INFO - Running setup.py (path:/tmp/pip-_mEIFU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 19:48:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 19:48:13 INFO - Running setup.py (path:/tmp/pip-ZxuUK1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 19:48:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 19:48:13 INFO - Running setup.py (path:/tmp/pip-eWHwi9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 19:48:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 19:48:13 INFO - Running setup.py (path:/tmp/pip-ptzYoR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 19:48:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 19:48:13 INFO - Running setup.py (path:/tmp/pip-pTMMaO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 19:48:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 19:48:13 INFO - Running setup.py (path:/tmp/pip-W6K_S5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 19:48:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 19:48:13 INFO - Running setup.py (path:/tmp/pip-FhVfPH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 19:48:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 19:48:13 INFO - Running setup.py (path:/tmp/pip-zWeshy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 19:48:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 19:48:13 INFO - Running setup.py (path:/tmp/pip-_DLkoC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 19:48:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 19:48:14 INFO - Running setup.py (path:/tmp/pip-ROHiDo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 19:48:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 19:48:14 INFO - Running setup.py (path:/tmp/pip-20INlY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 19:48:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 19:48:14 INFO - Running setup.py (path:/tmp/pip-ybhTm2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 19:48:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 19:48:14 INFO - Running setup.py (path:/tmp/pip-qXm_xB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 19:48:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 19:48:14 INFO - Running setup.py (path:/tmp/pip-KGqcxI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 19:48:14 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 19:48:14 INFO - Running setup.py install for manifestparser 19:48:14 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 19:48:14 INFO - Running setup.py install for mozcrash 19:48:14 INFO - Running setup.py install for mozdebug 19:48:14 INFO - Running setup.py install for mozdevice 19:48:14 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 19:48:14 INFO - Installing dm script to /builds/slave/test/build/venv/bin 19:48:14 INFO - Running setup.py install for mozfile 19:48:14 INFO - Running setup.py install for mozhttpd 19:48:14 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 19:48:14 INFO - Running setup.py install for mozinfo 19:48:15 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 19:48:15 INFO - Running setup.py install for mozInstall 19:48:15 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 19:48:15 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 19:48:15 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 19:48:15 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 19:48:15 INFO - Running setup.py install for mozleak 19:48:15 INFO - Running setup.py install for mozlog 19:48:15 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 19:48:15 INFO - Running setup.py install for moznetwork 19:48:15 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 19:48:15 INFO - Running setup.py install for mozprocess 19:48:15 INFO - Running setup.py install for mozprofile 19:48:15 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 19:48:15 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 19:48:15 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 19:48:15 INFO - Running setup.py install for mozrunner 19:48:15 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 19:48:15 INFO - Running setup.py install for mozscreenshot 19:48:15 INFO - Running setup.py install for moztest 19:48:16 INFO - Running setup.py install for mozversion 19:48:16 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 19:48:16 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 19:48:16 INFO - Cleaning up... 19:48:16 INFO - Return code: 0 19:48:16 INFO - Installing None into virtualenv /builds/slave/test/build/venv 19:48:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:48:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:48:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:48:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:48:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:48:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:48:16 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f3841e32c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x270b6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27bc9a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x284bac0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x284c9a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x284ce50>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1447472871.147031-1468704545', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:48:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 19:48:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 19:48:16 INFO - Using env: {'DISPLAY': ':0', 19:48:16 INFO - 'HOME': '/home/cltbld', 19:48:16 INFO - 'LANG': 'en_US.UTF-8', 19:48:16 INFO - 'LANGUAGE': 'en_US:en', 19:48:16 INFO - 'LOGNAME': 'cltbld', 19:48:16 INFO - 'MAIL': '/var/mail/cltbld', 19:48:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:48:16 INFO - 'MOZ_NO_REMOTE': '1', 19:48:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:48:16 INFO - 'NO_EM_RESTART': '1', 19:48:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:48:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:48:16 INFO - 'PWD': '/builds/slave/test', 19:48:16 INFO - 'SHELL': '/bin/bash', 19:48:16 INFO - 'SHLVL': '1', 19:48:16 INFO - 'TERM': 'linux', 19:48:16 INFO - 'TMOUT': '86400', 19:48:16 INFO - 'USER': 'cltbld', 19:48:16 INFO - 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1447472871.147031-1468704545', 19:48:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:48:16 INFO - '_': '/tools/buildbot/bin/python'} 19:48:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:48:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 19:48:16 INFO - Running setup.py (path:/tmp/pip-mLEWM1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 19:48:16 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 19:48:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 19:48:16 INFO - Running setup.py (path:/tmp/pip-BUgdWs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 19:48:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 19:48:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 19:48:16 INFO - Running setup.py (path:/tmp/pip-q5kBgC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 19:48:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 19:48:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 19:48:16 INFO - Running setup.py (path:/tmp/pip-2LvNpt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 19:48:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 19:48:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 19:48:16 INFO - Running setup.py (path:/tmp/pip-kLNdnG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 19:48:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 19:48:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 19:48:16 INFO - Running setup.py (path:/tmp/pip-hSoNqS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 19:48:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 19:48:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 19:48:16 INFO - Running setup.py (path:/tmp/pip-lSzknS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 19:48:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 19:48:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 19:48:16 INFO - Running setup.py (path:/tmp/pip-Yt9Egg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 19:48:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 19:48:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 19:48:16 INFO - Running setup.py (path:/tmp/pip-hZfc98-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 19:48:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 19:48:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 19:48:17 INFO - Running setup.py (path:/tmp/pip-oOpAuz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 19:48:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.0 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 19:48:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 19:48:17 INFO - Running setup.py (path:/tmp/pip-4NJvTE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 19:48:17 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 19:48:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 19:48:17 INFO - Running setup.py (path:/tmp/pip-ops97c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 19:48:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 19:48:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 19:48:17 INFO - Running setup.py (path:/tmp/pip-8C5gLG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 19:48:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.27 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 19:48:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 19:48:17 INFO - Running setup.py (path:/tmp/pip-ATNDUy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 19:48:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 19:48:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 19:48:17 INFO - Running setup.py (path:/tmp/pip-u3TYOP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 19:48:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 19:48:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 19:48:17 INFO - Running setup.py (path:/tmp/pip-WPfQ4A-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 19:48:17 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 19:48:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 19:48:17 INFO - Running setup.py (path:/tmp/pip-SjH7qY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 19:48:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 19:48:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 19:48:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 19:48:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 19:48:17 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 19:48:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 19:48:17 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 19:48:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:48:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:48:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:48:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:48:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:48:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:48:19 INFO - Downloading blessings-1.5.1.tar.gz 19:48:19 INFO - Storing download in cache at /builds/slave/test/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 19:48:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 19:48:19 INFO - Installing collected packages: blessings 19:48:19 INFO - Running setup.py install for blessings 19:48:19 INFO - Successfully installed blessings 19:48:19 INFO - Cleaning up... 19:48:19 INFO - Return code: 0 19:48:19 INFO - Done creating virtualenv /builds/slave/test/build/venv. 19:48:19 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 19:48:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 19:48:19 INFO - Reading from file tmpfile_stdout 19:48:19 INFO - Current package versions: 19:48:19 INFO - argparse == 1.2.1 19:48:19 INFO - blessings == 1.5.1 19:48:19 INFO - blobuploader == 1.2.4 19:48:19 INFO - docopt == 0.6.1 19:48:19 INFO - manifestparser == 1.1 19:48:19 INFO - mozInstall == 1.12 19:48:19 INFO - mozcrash == 0.16 19:48:19 INFO - mozdebug == 0.1 19:48:19 INFO - mozdevice == 0.47 19:48:19 INFO - mozfile == 1.2 19:48:19 INFO - mozhttpd == 0.7 19:48:19 INFO - mozinfo == 0.9 19:48:19 INFO - mozleak == 0.1 19:48:19 INFO - mozlog == 3.0 19:48:19 INFO - moznetwork == 0.27 19:48:19 INFO - mozprocess == 0.22 19:48:19 INFO - mozprofile == 0.27 19:48:19 INFO - mozrunner == 6.11 19:48:19 INFO - mozscreenshot == 0.1 19:48:19 INFO - mozsystemmonitor == 0.0 19:48:19 INFO - moztest == 0.7 19:48:19 INFO - mozversion == 1.4 19:48:19 INFO - psutil == 3.1.1 19:48:19 INFO - requests == 1.2.3 19:48:19 INFO - wsgiref == 0.1.2 19:48:19 INFO - Installing None into virtualenv /builds/slave/test/build/venv 19:48:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:48:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:48:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:48:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:48:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:48:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:48:19 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f3841e32c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x270b6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27bc9a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x284bac0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x284c9a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x284ce50>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1447472871.147031-1468704545', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:48:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 19:48:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 19:48:19 INFO - Using env: {'DISPLAY': ':0', 19:48:19 INFO - 'HOME': '/home/cltbld', 19:48:19 INFO - 'LANG': 'en_US.UTF-8', 19:48:19 INFO - 'LANGUAGE': 'en_US:en', 19:48:19 INFO - 'LOGNAME': 'cltbld', 19:48:19 INFO - 'MAIL': '/var/mail/cltbld', 19:48:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:48:19 INFO - 'MOZ_NO_REMOTE': '1', 19:48:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:48:19 INFO - 'NO_EM_RESTART': '1', 19:48:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:48:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:48:19 INFO - 'PWD': '/builds/slave/test', 19:48:19 INFO - 'SHELL': '/bin/bash', 19:48:19 INFO - 'SHLVL': '1', 19:48:19 INFO - 'TERM': 'linux', 19:48:19 INFO - 'TMOUT': '86400', 19:48:19 INFO - 'USER': 'cltbld', 19:48:19 INFO - 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1447472871.147031-1468704545', 19:48:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:48:19 INFO - '_': '/tools/buildbot/bin/python'} 19:48:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:48:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 19:48:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 19:48:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 19:48:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 19:48:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 19:48:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 19:48:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 19:48:19 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 19:48:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 19:48:19 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 19:48:19 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.0->mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 19:48:19 INFO - Cleaning up... 19:48:19 INFO - Return code: 0 19:48:19 INFO - Running post-action listener: _resource_record_post_action 19:48:19 INFO - Running post-action listener: _start_resource_monitoring 19:48:19 INFO - Starting resource monitoring. 19:48:19 INFO - ##### 19:48:19 INFO - ##### Running install step. 19:48:19 INFO - ##### 19:48:19 INFO - Running pre-action listener: _resource_record_pre_action 19:48:19 INFO - Running main action method: install 19:48:19 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 19:48:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 19:48:20 INFO - Reading from file tmpfile_stdout 19:48:20 INFO - Detecting whether we're running mozinstall >=1.0... 19:48:20 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 19:48:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 19:48:20 INFO - Reading from file tmpfile_stdout 19:48:20 INFO - Output received: 19:48:20 INFO - Usage: mozinstall [options] installer 19:48:20 INFO - Options: 19:48:20 INFO - -h, --help show this help message and exit 19:48:20 INFO - -d DEST, --destination=DEST 19:48:20 INFO - Directory to install application into. [default: 19:48:20 INFO - "/builds/slave/test"] 19:48:20 INFO - --app=APP Application being installed. [default: firefox] 19:48:20 INFO - mkdir: /builds/slave/test/build/application 19:48:20 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 19:48:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 19:48:34 INFO - Reading from file tmpfile_stdout 19:48:34 INFO - Output received: 19:48:34 INFO - /builds/slave/test/build/application/firefox/firefox 19:48:34 INFO - Running post-action listener: _resource_record_post_action 19:48:34 INFO - ##### 19:48:34 INFO - ##### Running run-tests step. 19:48:34 INFO - ##### 19:48:34 INFO - Running pre-action listener: _resource_record_pre_action 19:48:34 INFO - Running main action method: run_tests 19:48:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 19:48:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 19:48:34 INFO - Python 2.7.3 19:48:34 INFO - Return code: 0 19:48:34 INFO - grabbing minidump binary from tooltool 19:48:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:48:34 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x284bac0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x284c9a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x284ce50>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 19:48:34 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 19:48:34 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 19:48:34 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 19:48:34 INFO - Return code: 0 19:48:34 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 19:48:34 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 19:48:34 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 19:48:34 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 19:48:34 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 19:48:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-032', '--webServer', 'localhost'] in /builds/slave/test/build 19:48:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --debug --branchName Firefox-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-032 --webServer localhost 19:48:34 INFO - Using env: {'DISPLAY': ':0', 19:48:34 INFO - 'HOME': '/home/cltbld', 19:48:34 INFO - 'LANG': 'en_US.UTF-8', 19:48:34 INFO - 'LANGUAGE': 'en_US:en', 19:48:34 INFO - 'LOGNAME': 'cltbld', 19:48:34 INFO - 'MAIL': '/var/mail/cltbld', 19:48:34 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 19:48:34 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 19:48:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:48:34 INFO - 'MOZ_NO_REMOTE': '1', 19:48:34 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 19:48:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:48:34 INFO - 'NO_EM_RESTART': '1', 19:48:34 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:48:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:48:34 INFO - 'PWD': '/builds/slave/test', 19:48:34 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 19:48:34 INFO - 'SHELL': '/bin/bash', 19:48:34 INFO - 'SHLVL': '1', 19:48:34 INFO - 'TERM': 'linux', 19:48:34 INFO - 'TMOUT': '86400', 19:48:34 INFO - 'USER': 'cltbld', 19:48:34 INFO - 'XDG_SESSION_COOKIE': '2dd9ebcff44b3efbe7b51203000001d7-1447472871.147031-1468704545', 19:48:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:48:34 INFO - '_': '/tools/buildbot/bin/python'} 19:48:34 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-032', '--webServer', 'localhost'] with output_timeout 3600 19:48:34 INFO - mozversion INFO | application_buildid: 20151113183032 19:48:34 INFO - mozversion INFO | application_changeset: 202b199b9fcf37a687bef882f2513e191f079622 19:48:34 INFO - mozversion INFO | application_display_name: Nightly 19:48:34 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 19:48:34 INFO - mozversion INFO | application_name: Firefox 19:48:34 INFO - mozversion INFO | application_remotingname: firefox 19:48:34 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/mozilla-central 19:48:34 INFO - mozversion INFO | application_vendor: Mozilla 19:48:34 INFO - mozversion INFO | application_version: 45.0a1 19:48:34 INFO - mozversion INFO | platform_buildid: 20151113183032 19:48:34 INFO - mozversion INFO | platform_changeset: 202b199b9fcf37a687bef882f2513e191f079622 19:48:34 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/mozilla-central 19:48:34 INFO - mozversion INFO | platform_version: 45.0a1 19:48:34 INFO - 2015-11-13 19:48:34,709 DEBUG : using testdate: 1447472914 19:48:34 INFO - 2015-11-13 19:48:34,709 DEBUG : actual date: 1447472914 19:48:34 INFO - 2015-11-13 19:48:34,717 INFO : starting webserver on 'localhost:41402' 19:48:34 INFO - 2015-11-13 19:48:34,717 INFO : Starting test suite talos-linux64-ix-032.e 19:48:34 INFO - 2015-11-13 19:48:34,717 INFO : Starting test dromaeo_css 19:48:34 INFO - 2015-11-13 19:48:34,717 DEBUG : operating with platform_type : linux_ 19:48:34 INFO - 2015-11-13 19:48:34,718 INFO : Initialising browser for dromaeo_css test... 19:48:34 INFO - 2015-11-13 19:48:34,725 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpaetP1N/profile http://localhost:41402/getInfo.html 19:48:41 INFO - 2015-11-13 19:48:41,897 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 19:48:41 INFO - 2015-11-13 19:48:41,898 DEBUG : BROWSER_OUTPUT: colorDepth:24 19:48:41 INFO - 2015-11-13 19:48:41,898 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 19:48:41 INFO - 2015-11-13 19:48:41,898 DEBUG : BROWSER_OUTPUT: __metrics 19:48:43 INFO - 2015-11-13 19:48:43,128 INFO : Browser initialized. 19:48:43 INFO - 2015-11-13 19:48:43,128 INFO : Running cycle 1/1 for dromaeo_css test... 19:48:43 INFO - 2015-11-13 19:48:43,129 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpaetP1N/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 19:48:55 INFO - 2015-11-13 19:48:55,028 DEBUG : BROWSER_OUTPUT: RSS: Main: 140627968 19:48:55 INFO - 2015-11-13 19:48:55,029 DEBUG : BROWSER_OUTPUT: 19:49:44 INFO - 2015-11-13 19:49:44,714 DEBUG : BROWSER_OUTPUT: 1447472984709 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 19:51:56 INFO - 2015-11-13 19:51:56,088 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41402/tests/dromaeo/cssquery-dojo.html (next: http://localhost:41402/tests/dromaeo/cssquery-ext.html) 19:51:57 INFO - 2015-11-13 19:51:57,052 DEBUG : BROWSER_OUTPUT: RSS: Main: 142303232 19:51:57 INFO - 2015-11-13 19:51:57,053 DEBUG : BROWSER_OUTPUT: 19:54:58 INFO - 2015-11-13 19:54:58,979 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41402/tests/dromaeo/cssquery-ext.html (next: http://localhost:41402/tests/dromaeo/cssquery-jquery.html) 19:54:59 INFO - 2015-11-13 19:54:59,582 DEBUG : BROWSER_OUTPUT: RSS: Main: 141467648 19:54:59 INFO - 2015-11-13 19:54:59,583 DEBUG : BROWSER_OUTPUT: 19:58:01 INFO - 2015-11-13 19:58:01,314 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41402/tests/dromaeo/cssquery-jquery.html (next: http://localhost:41402/tests/dromaeo/cssquery-mootools.html) 19:58:01 INFO - 2015-11-13 19:58:01,916 DEBUG : BROWSER_OUTPUT: RSS: Main: 141176832 19:58:01 INFO - 2015-11-13 19:58:01,916 DEBUG : BROWSER_OUTPUT: 20:01:03 INFO - 2015-11-13 20:01:03,626 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41402/tests/dromaeo/cssquery-mootools.html (next: http://localhost:41402/tests/dromaeo/cssquery-prototype.html) 20:01:04 INFO - 2015-11-13 20:01:04,233 DEBUG : BROWSER_OUTPUT: RSS: Main: 140021760 20:01:04 INFO - 2015-11-13 20:01:04,233 DEBUG : BROWSER_OUTPUT: 20:04:06 INFO - 2015-11-13 20:04:06,851 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41402/tests/dromaeo/cssquery-prototype.html (next: http://localhost:41402/tests/dromaeo/cssquery-yui.html) 20:04:07 INFO - 2015-11-13 20:04:07,458 DEBUG : BROWSER_OUTPUT: RSS: Main: 141119488 20:04:07 INFO - 2015-11-13 20:04:07,459 DEBUG : BROWSER_OUTPUT: 20:07:09 INFO - 2015-11-13 20:07:09,726 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41402/tests/dromaeo/cssquery-yui.html (next: http://localhost:41402/tests/dromaeo/cssquery-dojo.html) 20:07:09 INFO - 2015-11-13 20:07:09,984 DEBUG : BROWSER_OUTPUT: RSS: Main: 143331328 20:07:09 INFO - 2015-11-13 20:07:09,984 DEBUG : BROWSER_OUTPUT: 20:07:09 INFO - 2015-11-13 20:07:09,984 DEBUG : BROWSER_OUTPUT: __start_tp_report 20:07:09 INFO - 2015-11-13 20:07:09,984 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 20:07:09 INFO - 2015-11-13 20:07:09,984 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 20:07:09 INFO - 2015-11-13 20:07:09,984 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 20:07:09 INFO - 2015-11-13 20:07:09,984 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2671.5324818156823;2698.17705599792;2726.38656302332;2733.3303340681537;2764.3641962348665;4516.819327226907;4758.500357462464;4766.78549465274;4785.808567657294;4804.783784729687;4604.746738929358;4638.489766125724;4657.5575320344515;4674.883127921795;4770.0459908018365;4261.403403523509;4354.259775838099;4406.581374769392;4419.801108950105;4463.241248987663;4170.687198460112;4369.956300437003;4429.60133587977;4471.4187155669715;4484.013517026249;4238.258304796679;4302.22559939214;4320.027993701424;4337.327714204303;4371.453568303962;4384.145091707119;4396.362527433536;4408.030233348658;4417.072414792898;4446.777661116931;4136.31750761124;4237.724547904377;4248.34150706641;4399.868003959887;4434.2905135178535;4595.563421474954;4652.255639097762;4653.7440440775745;4681.672282940195;4723.645726570521;5041.495850414965;5041.621878359101;5046.44489106198;5057.5195356441445;5104.412992505835;4837.0567739290855;4912.8771780705765;4942.629302802268;5063.3417655704525;5077.543021128116;4700.670953033289;4718.929216061693;4723.126221649006;4733.502982186889;4776.641751868624;5168.250603662448;5202.3497062867145;5213.504717051874;5230.947690523046;5245.895082098336;4760.857174284777;4844.660873738804;4860.68405553645;4931.211006238985;4992.90014199714;5052.7726252318735;5058.342415485963;5066.797328106908;5097.311862898461;5112.36095488064;4771.6898401603785;5005.824796132118;5007.8247261346405;5015.297858299841;5025.120603894304;4870.4155501340065;4893.168161412568;4919.950800492021;4927.408710954708;4961.03259864323;4134.958650413518;4153.792310384469;4174.019105510202;4182.53992060873;4201.390798334285;3596.5144705464427;3677.9632203678157;3696.334659761269;3698.9075273118387;3739.121306493026;4268.957310426856;4347.065380943112;4355.760433176206;4362.803673834622;4375.343698445195;5047;5101.795928162832;5117.104506711311;5125.4874512549195;5177.948220517822;4157.376393540993;4223.66210703143;4269.615734583902;4401.449818772653;4402.84590039347;4448.666350023761;4458.308962110878;4466.486354069324;4467.352233926127;4489.708168969007;4730.597899178609;4773.809047638056;4774.880627984328;4785.976070119627;4818.566329030334;4838.854834354975;4941.234108713155;4949.505049495022;4951.702897826142;5009.749512524432;4676.088162808356;4715.174844402147;4760.357351757469;4761.333413322069;4775.594074503567;4941.234108713155;4948.554630083309;4964.478729733326;4974.0797952378925;4993.725345106054;4864.978354545444;4986.252062190555;5064.18972964324;5111.7188554628365;5154.690718556899;4755.167845627071;4837.032593481247;4859.3682821233015;4860.149473842134;4881.170201065756;4957.578605818546;4957.975210123926;4965.8013679452415;4967.652264341461;4985.3020577118505;4618.722876627413;4656.022235330483;4707.505711900201;4869.889031050436;4895.681780684244;4890.657653964188;4930.063287975417;4936.4569897311985;4952.504749525018;4955.380577427822;4823.1800593898415;4842.4189097308545;4846.273059041031;4867.464578896389;4871.87820304481 20:07:09 INFO - 2015-11-13 20:07:09,985 DEBUG : BROWSER_OUTPUT: |1;ext.html;558.9469000444959;565.9925332907426;586.8210195890255;590.592491181085;600.3006497430495;27347.5897861532;36684;36946.44580331294;37035;37049;40919;41108.79445602768;41442.17115657693;41481;41514.79242603783;7750.108737495204;7895.526268423884;7904.960475197616;7908.288254057134;7928.960355198216;7890.723824666138;7952.562609056499;7958.920410795905;7970.920290797076;7979.281864632182;7948.205179482064;8002.399820013493;8043.678252869879;8053.073896501889;8068.435209535335;7955.124936257007;7960.562169080698;7966.5618390988475;8025.478343907656;8025.799355016113;7809.453338266324;7911.2088791121005;7913.762587122395;7919.762407127795;7951.443398962075;36854.63145368539;37312.626873731184;37532.81233593842;37692;37793.62206377929;2608.6608740863758;2827.3073097091346;2828.6605607327047;2879.9712002879915;3009.5184770436626;27589.172324830288;27931.58102628462;28088.438231235465;28146.577801333;28823;2862.3845873137166;2896.218021134303;2904.4626744052416;2955.0248418022;2964.985175074111;208260;210102.94948525314;210204;211025;211243;37989.62010379861;38671.22657546889;38804.22391552153;38851.6114838848;52014;36847.631523684955;37231.81384093062;37255.59793829879;37323;37335;12773;12879.935600321938;12933.741325173443;12986.675333116747;13009.089363744448;10047.799044019079;10168.593256269814;10169.644062457779;10172.338797978107;10187.286889917783;13345.73308533824;13385.598432047054;13405.597832065054;13410.932945335211;13500.5274815381;5660.349059858169;5668.121441176624;5751.59738818287;5763;5768;806.4919100966354;833.7457075591882;839.3117643532368;907.7458311672742;908.3777612335572;27052;28898.422031559672;31134.41789325227;31157.8442107788;31436.842815785774;895.8477058899872;910.0808183734476;916.7662246127195;919.9034101419254;973.9530005244391;13745.931270343584;14105.294735263196;14201.715965680629;14258.215798130996;14371.425142994372;309851;314821;314883;318569;318712;45934.08131837344;46063.539364605924;46173.30740038835;46242.07515849664;46503.5349646506;1133.9546418143182;1174.371711134556;1185.6206014075412;1187.7446349035;1192.4395534099133;25513.61729574021;26094.34764130912;26196.345091372867;26333.210003699918;26456.338591535365;39771.40342894917;40094.1981160381;40332.59667403406;40340.79829600833;40360.59639403568;248113;248393.09641421572;249625;251025;251137;24705.752942470346;25251.494970100863;29209;29282.267943301587;29931;33625;34700.82649586736;35030.29939401147;35128.648713512535;35149.8242508796;38063.80968095142;38851.41722874215;39399.121516854575;39931.40102898401;40321.59678403296;34076.65923340735;34267.82866085654;34291.14272143217;34517.30965380628;34872.82563587267;33923.66076339304;35115.64884351124;35117.122071948404;35145.297094058486;35145.47281790724;28735.5689664651;30945.8452707735;31268.061958141294;31306;31407.21481962969;24310.51378972446;24367.390815229763;24581.13966011181;24800.627990579796;25101.24696259115 20:07:09 INFO - 2015-11-13 20:07:09,985 DEBUG : BROWSER_OUTPUT: |2;jquery.html;336.9191394065425;337.43648107660204;340.05803923132913;340.6219096802549;342.6761710183877;12848.421821018053;13242.867571324285;15216.543503694893;15289.311980960856;16088.919555402206;15272.923635381836;15307.158106304149;15782.053076815399;15907.681846363095;15911.44309949152;4481.170983368071;4604.217283061871;4622.722636641795;4627.514111018329;4858.611311095104;4607.14767767964;6482.222133344006;6752.594844309333;6763.222229443603;6779.966100169492;6650.833729156786;6655.46756259498;6668.433183179435;6677.1987361516685;6827.829304267383;6798.762043328485;6827.351401616888;6830.6926188321395;6832.145981752281;6844.965775171142;5993.460588547052;6197.473214776749;6203.379662033805;6212.1303017577575;6503.967480162616;19551;19740.80259197404;19790.208391664317;20267.189312427487;20282.69575956362;1819.299569665675;1832.3220408448826;1833.8257865502756;1870.1023508715757;1889.1687657430687;12824.615261542169;13220.272884991322;13432;13446.260455674934;14054.227017514033;1801.4145402744161;1876.2870109358494;1909.5130741660787;1918.1080797429263;1929.5079754662472;46663.76668116638;47554.76222618899;60677.393226067616;63016.36983630151;63019.6849015752;14603.794059524274;15877.920610396874;15945.20273986296;15948.68102637964;15971.201439927958;22865.170786337054;22958.540829183323;23089.42276443069;23178.53642927166;23210.419739506648;8461.492310461268;8498.362622803192;8547.145285471403;8555.529445880537;8592.527410992456;7219.241979592067;7231.276872312832;7234.529755565872;7240;7256.7097316106765;2915.6355455568055;2994.925126871802;7753.945204520694;7817.335526480199;7890.921090789134;1025.0620682075967;1033.493588141805;1035.9792804143874;1036.2953191829477;1090.0189829153667;401.50213734969014;402.9576894426043;427.3034953026547;429.6798884830821;448.1619371774737;9256.72229833106;9711.514424278757;9767.804643907082;9931.304808663324;10054.396736195851;378.48903979627835;381.73278704906676;385.7936004237719;386.33357458384626;386.97678139311734;5342.691040695055;5368.677879327252;5377.623566350396;5406.162044882971;5461.825707472913;326650;333547;492389;497627;503017;64581.67709161424;65922.67038664776;66622.66688666526;67387.66306168537;68229.65885170542;453.2724976412876;461.3679259414623;461.9030003699261;462.70849364899897;462.8680825964584;10029.097381235724;10035.996400359905;10063.094321511098;10096.242781791248;10147.391156530632;33294.5005824908;33394.49908251427;33400.66599333975;34356.14109647279;34517.82741086279;38982.80508597439;39393.40909886297;39602.207955841295;39766.80116599399;42077.36883946804;6007.189029480965;6281.905771413341;6284.591501552567;6285.811425657238;6292.779752708816;10011.849822252527;10487;10489.055984961085;10618.946905265733;10633.255672102878;9038.683646072355;9073.410228335137;9319.487428191243;9558.713238602853;9573.904260957579;9091.454512729257;9423.29325300619;9544.904550954401;9625.759356016155;9704.70885873425;9440.433573985583;9497.382670126419;9506.334556581249;9703.320767546204;9888.604455821687;6047.485963693135;6080.361562035922;6100.572959892942;6124.693765311806;6149.046897730859;9816.16562592159;9851.655192068243;9855.802883942424;9919.40483570988;10135.189184865045 20:07:09 INFO - 2015-11-13 20:07:09,985 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1457.2640816387736;1686.5193419875334;1734.848787503496;1756.0605076284191;1771.0878897367866;6354.332795056522;6453.386928241809;7088.787336379911;7505.362044226241;7543.547387156767;7036.683349249283;7214.206437291894;7290;7337.523061001045;7346.59593722345;2140.154638917623;2165.7076294700173;2169.5877783221135;2174.6629272462715;2183.094015983365;2179.7711240319777;2216.3683350245183;2228.0419419649543;2230.9776902231015;2238.29493709481;2118.9152433902627;2119.0993827623274;2142.453674313048;2156.2668692644497;2164.1667957836266;2163.935081947536;2170.3814412892407;2173.7609562549274;2175.6192666283337;2194.714687090676;2157;2192.6272533669153;2211.6461366181334;2215.8670479771104;2216.645336746129;7242.963785181093;7316.963415182943;7319.304666056716;7352.963235183844;7366.189719130892;3757.7933213673236;4367.213901497729;4480.910381792379;4495;4505.639548836118;2428.2229686500327;2834.1780883543747;2872.8132671376293;2899.130260921736;2906.622139121922;900.342749792655;903.5843511984496;936.765808547863;945.8723072385209;949.9382540134869;9465.52672366379;9501.049895010512;9509.381890177185;9620.037996200394;9624.855627165598;4199.538050814408;4254.106637606075;4278.935815962763;4295.119500502389;4315.719478233905;8448.831023379498;8453.619587118594;8475;8512.021117571434;8588.355873309527;4513.796879140381;4534.977325113353;4544.954550454453;4547.045120524727;4581.725096494221;4090.590940905945;4096.426500289962;4097.221527909687;4122.628963393309;4125.731827431207;3536.451849963208;3576.9821150894077;3582.158192824684;3583.623719509414;3621.203335266237;1155.8381826544291;1156.7166044319197;1165.2600598619767;1174.3717111345388;1177.5113327968797;1157.4212893553224;1172.2263306218026;1183.585744989247;1190.4166958190597;1190.5951976327917;6913.340798208394;6937.514373993772;6945.37491625746;6970.128733908262;6970.372666460043;415.5864914410181;418.1678459864847;419.3772248211404;424.6878544269959;433.6400787346495;5292.364916210079;5333.466653334713;5387.111126664135;5389.461053894579;5422.0511410503;7401.666924988388;7571.242875712494;8299.460535065202;8613.698520551876;8627.266682331947;8498.490090594583;8567.871481927776;8588.785280368042;8603.5698215089;8699.608517616722;6773.593584384953;6801.897971530431;6836.623985680835;6857.5199736018;6883.380495755406;6668.733250670113;6676.265610782712;6680.131582894192;6682.63245521501;6713.429358504386;7681.193474685301;7894.723684671009;7914.24814642608;7932.6430310635005;7973.561454120079;8011.399145064027;8019.879701804594;8144.877826832484;8153.592320384076;8241.011078670597;6448.516361272829;6455.193100862392;6484.967575162094;6580.638064906476;6586;7214.422846172189;7215.639218038972;7239.927600724136;7265.09186351706;7281.708731650675;6767.120274364301;6778.356056174655;6822.795316140524;6824.761133360507;6898.965505172643;6538.084668146368;6580.967095164494;6601.075849380994;6630.171228596426;6633.2040155181685;6727.730890764315;6801.625910574768;6827.078344423439;6852.486063545154;6874.8625027500175;6219.067139929047;6268;6293.087502312048;6304.905426418516;6305.085762564494;6266.530010249158;6292.2134733158355;6293.96853015732;6327.272363678236;6337.04944258365 20:07:09 INFO - 2015-11-13 20:07:09,985 DEBUG : BROWSER_OUTPUT: |4;prototype.html;281.90837977657264;288.3253187541153;293.2829232526472;296.1913974848663;296.68847709904594;5412.07994640911;5433.456654334569;5478;5545.057340252157;5568.777248910049;5386.407495175537;5423.403425623188;5453.754581043852;5467.6719396836215;5469.781208751645;4150.3359462486005;4150.64719498843;4162.895927601804;4170.895727606819;4174.874753757392;4044.211378781139;4070.5929407059352;4124.154548317588;4125.463689720332;4130.297849365615;4051.7163798534116;4077.2864748669012;4079.102597428576;4082.755034697928;4084.6323830855217;4066.8169932353117;4069.470968774055;4094;4099.85650502234;4101.507819061717;3572.8570857165682;3572.8928132156075;3576.6065732769375;3579.427291633326;3579.7315201359743;5137.743112844343;5177.068127737006;5229.895402091975;5248.973755131238;5274.077036518594;4761.547652972962;4795.064962332347;4799.0401919616215;4799.832005879813;4807.399075115611;5702.54379649627;5729.828105156852;5739.655620662732;5743.0811070228565;5752.5110365618975;3954.9604503955165;3975.1056012397266;3985.422113793513;3985.5815139410233;3987.342088555385;5746.511546518509;5999.6700181490005;6007.729652165619;6013.218281623404;6023.427774361428;4033.5361433434946;4069.7558146511305;4071.4528479177725;4073.348264277701;4079.530853951774;4119.752814831119;4119.814608342572;4124.8143833527565;4133.379993001074;4136.91726165475;4723.645726570452;4753.215719406328;4757.595604373598;4759.595434388116;4760.904781904343;5523.6685798852195;5715.514181294553;5739;5751.884962300731;5765.308163020464;1470.8235011798438;1483.5326872035275;1490.9179995100158;1491.4854375240525;1493.2981498695597;1012.584840215508;1014.974625634365;1018.8930162332997;1025.876894772632;1029.9330543514648;4969.776360063805;4970.179920313108;4979.90040199194;5000.424951130666;5011.57401620859;5862.794802181988;5880.647161170344;5882.617629854046;5910.763569457259;5911.674857882772;4973.403191617029;4977.104121258136;4985.9501404985485;4988.0772057168815;4994.150994330972;3107.151245009216;3172.0325300783484;3179.1257404213566;3192.409404260219;3199.45609246424;5557.833265002057;5559.082751345983;5563.805266815642;5585.357683866326;5598.328200615871;6020.518358531307;6063.423974722395;6144.354842741537;6152.323244443108;6161.84595385119;5558.416366281483;5565.582581306418;5577.107662773937;5606.579506536945;5624.156376543551;5905.291365036223;5942.168096466412;5943.851403714942;5950.988331983486;5965.313988891333;5699.059655156852;5836.445537673914;5839.766409343579;5844.240248767633;5846.9183201107935;5620.04459241938;5629.324481062299;5630.549556035426;5633.549316054624;5636.900804343114;3937.5865534118507;4005.9599404006754;4008.118213992917;4014.799260037045;4017.015831121394;5927.377625349276;5932.6737029462065;5933.317668468181;5945.791897283574;5951.375105613848;5547.833564993057;5681.204631351697;5686.744096515584;5703.116017017369;5721.799737009184;5691;5716.657000579979;5729.169270455677;5734.885302293847;5742.885142297214;5559.24950131727;5596.1605759136455;5597.076482380362;5607.186957891165;5617.915731263953;5615.803446879339;5737.483626473638;5743.942560574341;5757.769689212385;5770.942290577041;5569.220309156641;5572.944270557243;5572.972135139461;5615.213870058276;5617.988762022876 20:07:09 INFO - 2015-11-13 20:07:09,985 DEBUG : BROWSER_OUTPUT: |5;yui.html;703.5005146346098;707.38104158861;765.230942902383;783.1307248953663;806.2421323955485;11452.484638191281;11466.541338346467;11486.195966282374;11526.135539834515;11594.246373985685;11115.666530004093;11286.661400157987;11358.091352691785;11359.1480638952;11360.715982100452;618.913352130702;619.5848781316529;791.0902462168494;792.8850316704074;807.7374853172713;799.0890384961149;805.122416565943;805.1465446626595;805.5448671500584;807.8667019941703;829.4898637338054;834.4492634860993;842.1957031035378;844.9112843151473;845.6321500147425;827.9006519217702;830.4726498673325;833.8499070167368;837.9329653627725;838.8532006898769;618.060547967092;624.0857144283647;624.1199908129515;625.9843503912393;626.8746250749869;12025;12030.578929737418;12030.939845300805;12068.275903445821;12156.331401772899;10908;11468.31190128595;11681.88318116825;11742;12176.26942383451;9388.389754665994;9418.764530886714;9422.952885235598;9429.76425589359;9437.433753974783;2820.858957052139;2837.092130518235;2856.5286727690113;2876.5109931311727;2926.283060650133;36684.63315366839;36777.448338274946;36816.81591592025;36890;36940.63059369426;6628.072069910217;6669.166354205724;6701.6314102723845;6740.157480314961;6802.693878775467;9802;9814.803703925882;9927.702168934944;10006.249531285182;10069.54687039085;5641.915371269434;5706.486416222477;5748.367679555246;5869.735861886225;5990.311114221833;3564.322778672044;3565.180008598037;3569.5002699622073;3597.2625611749527;3598.460230965376;2487.676602041759;2499.562576549097;2513.32140322112;2517.811164162695;2519.2694118705735;382.21073483256987;384.3293452924664;387.567861834053;389.38865980410486;389.795357437342;455.91793477173763;550.3615805665409;590.7459792289271;598.7455331484102;611.5963464113753;7805.141434442206;7955.801104972306;8056.476329038594;8096.797580060428;8187.631556579968;437.97591132487383;510.9616778741609;546.8250159948858;621.9378062193834;631.5042691487253;3461.5326930864517;3876.9224615508097;3931.253061918226;4033.8705162554534;4065.79671016448;56291;56858;57026;57200.71399642975;57282.713586432634;44770.32844507335;44885.77557112259;45062.77468612636;46100.76949615298;46129.308060379124;40008.399874001916;41156.1768764629;41205.58794412077;41953.580464194965;43942.34086488641;7986.840263194587;8050.5572193529915;8199.754007379788;8280.296174824967;8410.789730256793;32371;32474.83762581172;32838.507422389164;33285;33487.16282092967;39129.80435097806;39243.80378098205;42908.35637465503;43444.13111737811;43890.56109438865;6763.932360676527;6819.283975182534;6828.624425656637;7021.929780702332;7056.470764692771;11500.712482188012;11522.72772405012;11533.769324613628;11731.765364692488;11794.46924888365;9943.30396872212;10021.09810117093;10349.84475232857;10376.377417354983;10609.522571484147;10584.682459526226;10669.51987160564;10892.400917949271;11231.045361144394;11292.491837867152;10647.041766241075;10726.570937162738;10741.140708743438;10795.946020269848;10857.945710271399;9357.20463760588;9479.05209479074;9664.855027174457;9752.9024709752;9926.205903527556;8629.22336989674;8965.820683586162;8982.191602755784;8995;9210.171084602418 20:07:09 INFO - 2015-11-13 20:07:09,985 DEBUG : BROWSER_OUTPUT: __end_tp_report 20:07:09 INFO - 2015-11-13 20:07:09,985 DEBUG : BROWSER_OUTPUT: __start_cc_report 20:07:09 INFO - 2015-11-13 20:07:09,985 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,310 20:07:09 INFO - 2015-11-13 20:07:09,985 DEBUG : BROWSER_OUTPUT: __end_cc_report 20:07:09 INFO - 2015-11-13 20:07:09,985 DEBUG : BROWSER_OUTPUT: __startTimestamp1447474029977__endTimestamp 20:07:09 INFO - 2015-11-13 20:07:09,985 DEBUG : BROWSER_OUTPUT: 20:07:09 INFO - 2015-11-13 20:07:09,985 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 20:07:09 INFO - 2015-11-13 20:07:09,985 DEBUG : BROWSER_OUTPUT: Number of tests: 6 20:07:09 INFO - 2015-11-13 20:07:09,986 DEBUG : BROWSER_OUTPUT: 20:07:09 INFO - 2015-11-13 20:07:09,986 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4642.92 Median:4771.69 stddev:479.96 (10.1%) stddev-sans-first:455.84 20:07:09 INFO - 2015-11-13 20:07:09,987 DEBUG : BROWSER_OUTPUT: Values: 2671.5 2698.2 2726.4 2733.3 2764.4 4516.8 4758.5 4766.8 4785.8 4804.8 4604.7 4638.5 4657.6 4674.9 4770.0 4261.4 4354.3 4406.6 4419.8 4463.2 4170.7 4370.0 4429.6 4471.4 4484.0 4238.3 4302.2 4320.0 4337.3 4371.5 4384.1 4396.4 4408.0 4417.1 4446.8 4136.3 4237.7 4248.3 4399.9 4434.3 4595.6 4652.3 4653.7 4681.7 4723.6 5041.5 5041.6 5046.4 5057.5 5104.4 4837.1 4912.9 4942.6 5063.3 5077.5 4700.7 4718.9 4723.1 4733.5 4776.6 5168.3 5202.3 5213.5 5230.9 5245.9 4760.9 4844.7 4860.7 4931.2 4992.9 5052.8 5058.3 5066.8 5097.3 5112.4 4771.7 5005.8 5007.8 5015.3 5025.1 4870.4 4893.2 4920.0 4927.4 4961.0 4135.0 4153.8 4174.0 4182.5 4201.4 3596.5 3678.0 3696.3 3698.9 3739.1 4269.0 4347.1 4355.8 4362.8 4375.3 5047.0 5101.8 5117.1 5125.5 5177.9 4157.4 4223.7 4269.6 4401.4 4402.8 4448.7 4458.3 4466.5 4467.4 4489.7 4730.6 4773.8 4774.9 4786.0 4818.6 4838.9 4941.2 4949.5 4951.7 5009.7 4676.1 4715.2 4760.4 4761.3 4775.6 4941.2 4948.6 4964.5 4974.1 4993.7 4865.0 4986.3 5064.2 5111.7 5154.7 4755.2 4837.0 4859.4 4860.1 4881.2 4957.6 4958.0 4965.8 4967.7 4985.3 4618.7 4656.0 4707.5 4869.9 4895.7 4890.7 4930.1 4936.5 4952.5 4955.4 4823.2 4842.4 4846.3 4867.5 4871.9 20:07:09 INFO - 2015-11-13 20:07:09,987 DEBUG : BROWSER_OUTPUT: 20:07:09 INFO - 2015-11-13 20:07:09,987 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:40824.11 Median:35116.39 stddev:68513.52 (195.1%) stddev-sans-first:68639.02 20:07:09 INFO - 2015-11-13 20:07:09,987 DEBUG : BROWSER_OUTPUT: Values: 558.9 566.0 586.8 590.6 600.3 27347.6 36684.0 36946.4 37035.0 37049.0 40919.0 41108.8 41442.2 41481.0 41514.8 7750.1 7895.5 7905.0 7908.3 7929.0 7890.7 7952.6 7958.9 7970.9 7979.3 7948.2 8002.4 8043.7 8053.1 8068.4 7955.1 7960.6 7966.6 8025.5 8025.8 7809.5 7911.2 7913.8 7919.8 7951.4 36854.6 37312.6 37532.8 37692.0 37793.6 2608.7 2827.3 2828.7 2880.0 3009.5 27589.2 27931.6 28088.4 28146.6 28823.0 2862.4 2896.2 2904.5 2955.0 2965.0 208260.0 210102.9 210204.0 211025.0 211243.0 37989.6 38671.2 38804.2 38851.6 52014.0 36847.6 37231.8 37255.6 37323.0 37335.0 12773.0 12879.9 12933.7 12986.7 13009.1 10047.8 10168.6 10169.6 10172.3 10187.3 13345.7 13385.6 13405.6 13410.9 13500.5 5660.3 5668.1 5751.6 5763.0 5768.0 806.5 833.7 839.3 907.7 908.4 27052.0 28898.4 31134.4 31157.8 31436.8 895.8 910.1 916.8 919.9 974.0 13745.9 14105.3 14201.7 14258.2 14371.4 309851.0 314821.0 314883.0 318569.0 318712.0 45934.1 46063.5 46173.3 46242.1 46503.5 1134.0 1174.4 1185.6 1187.7 1192.4 25513.6 26094.3 26196.3 26333.2 26456.3 39771.4 40094.2 40332.6 40340.8 40360.6 248113.0 248393.1 249625.0 251025.0 251137.0 24705.8 25251.5 29209.0 29282.3 29931.0 33625.0 34700.8 35030.3 35128.6 35149.8 38063.8 38851.4 39399.1 39931.4 40321.6 34076.7 34267.8 34291.1 34517.3 34872.8 33923.7 35115.6 35117.1 35145.3 35145.5 28735.6 30945.8 31268.1 31306.0 31407.2 24310.5 24367.4 24581.1 24800.6 25101.2 20:07:09 INFO - 2015-11-13 20:07:09,987 DEBUG : BROWSER_OUTPUT: 20:07:09 INFO - 2015-11-13 20:07:09,987 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:24287.63 Median:461.64 stddev:71752.86 (15543.2%) stddev-sans-first:71931.61 20:07:09 INFO - 2015-11-13 20:07:09,988 DEBUG : BROWSER_OUTPUT: Values: 336.9 337.4 340.1 340.6 342.7 12848.4 13242.9 15216.5 15289.3 16088.9 15272.9 15307.2 15782.1 15907.7 15911.4 4481.2 4604.2 4622.7 4627.5 4858.6 4607.1 6482.2 6752.6 6763.2 6780.0 6650.8 6655.5 6668.4 6677.2 6827.8 6798.8 6827.4 6830.7 6832.1 6845.0 5993.5 6197.5 6203.4 6212.1 6504.0 19551.0 19740.8 19790.2 20267.2 20282.7 1819.3 1832.3 1833.8 1870.1 1889.2 12824.6 13220.3 13432.0 13446.3 14054.2 1801.4 1876.3 1909.5 1918.1 1929.5 46663.8 47554.8 60677.4 63016.4 63019.7 14603.8 15877.9 15945.2 15948.7 15971.2 22865.2 22958.5 23089.4 23178.5 23210.4 8461.5 8498.4 8547.1 8555.5 8592.5 7219.2 7231.3 7234.5 7240.0 7256.7 2915.6 2994.9 7753.9 7817.3 7890.9 1025.1 1033.5 1036.0 1036.3 1090.0 401.5 403.0 427.3 429.7 448.2 9256.7 9711.5 9767.8 9931.3 10054.4 378.5 381.7 385.8 386.3 387.0 5342.7 5368.7 5377.6 5406.2 5461.8 326650.0 333547.0 492389.0 497627.0 503017.0 64581.7 65922.7 66622.7 67387.7 68229.7 453.3 461.4 461.9 462.7 462.9 10029.1 10036.0 10063.1 10096.2 10147.4 33294.5 33394.5 33400.7 34356.1 34517.8 38982.8 39393.4 39602.2 39766.8 42077.4 6007.2 6281.9 6284.6 6285.8 6292.8 10011.8 10487.0 10489.1 10618.9 10633.3 9038.7 9073.4 9319.5 9558.7 9573.9 9091.5 9423.3 9544.9 9625.8 9704.7 9440.4 9497.4 9506.3 9703.3 9888.6 6047.5 6080.4 6100.6 6124.7 6149.0 9816.2 9851.7 9855.8 9919.4 10135.2 20:07:09 INFO - 2015-11-13 20:07:09,988 DEBUG : BROWSER_OUTPUT: 20:07:09 INFO - 2015-11-13 20:07:09,988 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5126.69 Median:6401.42 stddev:2612.57 (40.8%) stddev-sans-first:2605.34 20:07:09 INFO - 2015-11-13 20:07:09,989 DEBUG : BROWSER_OUTPUT: Values: 1457.3 1686.5 1734.8 1756.1 1771.1 6354.3 6453.4 7088.8 7505.4 7543.5 7036.7 7214.2 7290.0 7337.5 7346.6 2140.2 2165.7 2169.6 2174.7 2183.1 2179.8 2216.4 2228.0 2231.0 2238.3 2118.9 2119.1 2142.5 2156.3 2164.2 2163.9 2170.4 2173.8 2175.6 2194.7 2157.0 2192.6 2211.6 2215.9 2216.6 7243.0 7317.0 7319.3 7353.0 7366.2 3757.8 4367.2 4480.9 4495.0 4505.6 2428.2 2834.2 2872.8 2899.1 2906.6 900.3 903.6 936.8 945.9 949.9 9465.5 9501.0 9509.4 9620.0 9624.9 4199.5 4254.1 4278.9 4295.1 4315.7 8448.8 8453.6 8475.0 8512.0 8588.4 4513.8 4535.0 4545.0 4547.0 4581.7 4090.6 4096.4 4097.2 4122.6 4125.7 3536.5 3577.0 3582.2 3583.6 3621.2 1155.8 1156.7 1165.3 1174.4 1177.5 1157.4 1172.2 1183.6 1190.4 1190.6 6913.3 6937.5 6945.4 6970.1 6970.4 415.6 418.2 419.4 424.7 433.6 5292.4 5333.5 5387.1 5389.5 5422.1 7401.7 7571.2 8299.5 8613.7 8627.3 8498.5 8567.9 8588.8 8603.6 8699.6 6773.6 6801.9 6836.6 6857.5 6883.4 6668.7 6676.3 6680.1 6682.6 6713.4 7681.2 7894.7 7914.2 7932.6 7973.6 8011.4 8019.9 8144.9 8153.6 8241.0 6448.5 6455.2 6485.0 6580.6 6586.0 7214.4 7215.6 7239.9 7265.1 7281.7 6767.1 6778.4 6822.8 6824.8 6899.0 6538.1 6581.0 6601.1 6630.2 6633.2 6727.7 6801.6 6827.1 6852.5 6874.9 6219.1 6268.0 6293.1 6304.9 6305.1 6266.5 6292.2 6294.0 6327.3 6337.0 20:07:09 INFO - 2015-11-13 20:07:09,990 DEBUG : BROWSER_OUTPUT: 20:07:09 INFO - 2015-11-13 20:07:09,990 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:4721.13 Median:5399.24 stddev:1399.47 (25.9%) stddev-sans-first:1363.15 20:07:09 INFO - 2015-11-13 20:07:09,991 DEBUG : BROWSER_OUTPUT: Values: 281.9 288.3 293.3 296.2 296.7 5412.1 5433.5 5478.0 5545.1 5568.8 5386.4 5423.4 5453.8 5467.7 5469.8 4150.3 4150.6 4162.9 4170.9 4174.9 4044.2 4070.6 4124.2 4125.5 4130.3 4051.7 4077.3 4079.1 4082.8 4084.6 4066.8 4069.5 4094.0 4099.9 4101.5 3572.9 3572.9 3576.6 3579.4 3579.7 5137.7 5177.1 5229.9 5249.0 5274.1 4761.5 4795.1 4799.0 4799.8 4807.4 5702.5 5729.8 5739.7 5743.1 5752.5 3955.0 3975.1 3985.4 3985.6 3987.3 5746.5 5999.7 6007.7 6013.2 6023.4 4033.5 4069.8 4071.5 4073.3 4079.5 4119.8 4119.8 4124.8 4133.4 4136.9 4723.6 4753.2 4757.6 4759.6 4760.9 5523.7 5715.5 5739.0 5751.9 5765.3 1470.8 1483.5 1490.9 1491.5 1493.3 1012.6 1015.0 1018.9 1025.9 1029.9 4969.8 4970.2 4979.9 5000.4 5011.6 5862.8 5880.6 5882.6 5910.8 5911.7 4973.4 4977.1 4986.0 4988.1 4994.2 3107.2 3172.0 3179.1 3192.4 3199.5 5557.8 5559.1 5563.8 5585.4 5598.3 6020.5 6063.4 6144.4 6152.3 6161.8 5558.4 5565.6 5577.1 5606.6 5624.2 5905.3 5942.2 5943.9 5951.0 5965.3 5699.1 5836.4 5839.8 5844.2 5846.9 5620.0 5629.3 5630.5 5633.5 5636.9 3937.6 4006.0 4008.1 4014.8 4017.0 5927.4 5932.7 5933.3 5945.8 5951.4 5547.8 5681.2 5686.7 5703.1 5721.8 5691.0 5716.7 5729.2 5734.9 5742.9 5559.2 5596.2 5597.1 5607.2 5617.9 5615.8 5737.5 5743.9 5757.8 5770.9 5569.2 5572.9 5573.0 5615.2 5618.0 20:07:09 INFO - 2015-11-13 20:07:09,991 DEBUG : BROWSER_OUTPUT: 20:07:09 INFO - 2015-11-13 20:07:09,991 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:12163.24 Median:23278.34 stddev:14547.15 (62.5%) stddev-sans-first:14562.50 20:07:09 INFO - 2015-11-13 20:07:09,991 DEBUG : BROWSER_OUTPUT: Values: 703.5 707.4 765.2 783.1 806.2 11452.5 11466.5 11486.2 11526.1 11594.2 11115.7 11286.7 11358.1 11359.1 11360.7 618.9 619.6 791.1 792.9 807.7 799.1 805.1 805.1 805.5 807.9 829.5 834.4 842.2 844.9 845.6 827.9 830.5 833.8 837.9 838.9 618.1 624.1 624.1 626.0 626.9 12025.0 12030.6 12030.9 12068.3 12156.3 10908.0 11468.3 11681.9 11742.0 12176.3 9388.4 9418.8 9423.0 9429.8 9437.4 2820.9 2837.1 2856.5 2876.5 2926.3 36684.6 36777.4 36816.8 36890.0 36940.6 6628.1 6669.2 6701.6 6740.2 6802.7 9802.0 9814.8 9927.7 10006.2 10069.5 5641.9 5706.5 5748.4 5869.7 5990.3 3564.3 3565.2 3569.5 3597.3 3598.5 2487.7 2499.6 2513.3 2517.8 2519.3 382.2 384.3 387.6 389.4 389.8 455.9 550.4 590.7 598.7 611.6 7805.1 7955.8 8056.5 8096.8 8187.6 438.0 511.0 546.8 621.9 631.5 3461.5 3876.9 3931.3 4033.9 4065.8 56291.0 56858.0 57026.0 57200.7 57282.7 44770.3 44885.8 45062.8 46100.8 46129.3 40008.4 41156.2 41205.6 41953.6 43942.3 7986.8 8050.6 8199.8 8280.3 8410.8 32371.0 32474.8 32838.5 33285.0 33487.2 39129.8 39243.8 42908.4 43444.1 43890.6 6763.9 6819.3 6828.6 7021.9 7056.5 11500.7 11522.7 11533.8 11731.8 11794.5 9943.3 10021.1 10349.8 10376.4 10609.5 10584.7 10669.5 10892.4 11231.0 11292.5 10647.0 10726.6 10741.1 10795.9 10857.9 9357.2 9479.1 9664.9 9752.9 9926.2 8629.2 8965.8 8982.2 8995.0 9210.2 20:07:09 INFO - 2015-11-13 20:07:09,991 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 20:07:09 INFO - 2015-11-13 20:07:09,991 DEBUG : BROWSER_OUTPUT: 20:07:10 INFO - 2015-11-13 20:07:10,780 INFO : Browser exited with error code: 0 20:07:10 INFO - 2015-11-13 20:07:10,799 INFO : Completed test dromaeo_css (00:18:36) 20:07:10 INFO - 2015-11-13 20:07:10,799 INFO : Starting test kraken 20:07:10 INFO - 2015-11-13 20:07:10,799 DEBUG : operating with platform_type : linux_ 20:07:10 INFO - 2015-11-13 20:07:10,799 INFO : Initialising browser for kraken test... 20:07:10 INFO - 2015-11-13 20:07:10,805 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpnUrnv3/profile http://localhost:41402/getInfo.html 20:07:16 INFO - 2015-11-13 20:07:16,360 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 20:07:16 INFO - 2015-11-13 20:07:16,360 DEBUG : BROWSER_OUTPUT: colorDepth:24 20:07:16 INFO - 2015-11-13 20:07:16,360 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 20:07:16 INFO - 2015-11-13 20:07:16,360 DEBUG : BROWSER_OUTPUT: __metrics 20:07:17 INFO - 2015-11-13 20:07:17,588 INFO : Browser initialized. 20:07:17 INFO - 2015-11-13 20:07:17,588 INFO : Running cycle 1/1 for kraken test... 20:07:17 INFO - 2015-11-13 20:07:17,589 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpnUrnv3/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 20:07:29 INFO - 2015-11-13 20:07:29,507 DEBUG : BROWSER_OUTPUT: RSS: Main: 140570624 20:07:29 INFO - 2015-11-13 20:07:29,507 DEBUG : BROWSER_OUTPUT: 20:07:32 INFO - 2015-11-13 20:07:32,095 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41402/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:41402/tests/kraken/driver.html?testName=audio-beat-detection) 20:07:32 INFO - 2015-11-13 20:07:32,717 DEBUG : BROWSER_OUTPUT: RSS: Main: 140656640 20:07:32 INFO - 2015-11-13 20:07:32,717 DEBUG : BROWSER_OUTPUT: 20:07:35 INFO - 2015-11-13 20:07:35,458 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41402/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:41402/tests/kraken/driver.html?testName=audio-dft) 20:07:36 INFO - 2015-11-13 20:07:36,048 DEBUG : BROWSER_OUTPUT: RSS: Main: 141316096 20:07:36 INFO - 2015-11-13 20:07:36,048 DEBUG : BROWSER_OUTPUT: 20:07:38 INFO - 2015-11-13 20:07:38,969 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41402/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:41402/tests/kraken/driver.html?testName=audio-fft) 20:07:39 INFO - 2015-11-13 20:07:39,550 DEBUG : BROWSER_OUTPUT: RSS: Main: 136409088 20:07:39 INFO - 2015-11-13 20:07:39,551 DEBUG : BROWSER_OUTPUT: 20:07:41 INFO - 2015-11-13 20:07:41,690 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41402/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:41402/tests/kraken/driver.html?testName=audio-oscillator) 20:07:42 INFO - 2015-11-13 20:07:42,276 DEBUG : BROWSER_OUTPUT: RSS: Main: 136175616 20:07:42 INFO - 2015-11-13 20:07:42,276 DEBUG : BROWSER_OUTPUT: 20:07:44 INFO - 2015-11-13 20:07:44,491 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41402/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:41402/tests/kraken/driver.html?testName=imaging-gaussian-blur) 20:07:45 INFO - 2015-11-13 20:07:45,076 DEBUG : BROWSER_OUTPUT: RSS: Main: 137043968 20:07:45 INFO - 2015-11-13 20:07:45,076 DEBUG : BROWSER_OUTPUT: 20:07:48 INFO - 2015-11-13 20:07:48,124 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41402/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:41402/tests/kraken/driver.html?testName=imaging-darkroom) 20:07:48 INFO - 2015-11-13 20:07:48,726 DEBUG : BROWSER_OUTPUT: RSS: Main: 137236480 20:07:48 INFO - 2015-11-13 20:07:48,726 DEBUG : BROWSER_OUTPUT: 20:07:52 INFO - 2015-11-13 20:07:52,193 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41402/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:41402/tests/kraken/driver.html?testName=imaging-desaturate) 20:07:52 INFO - 2015-11-13 20:07:52,778 DEBUG : BROWSER_OUTPUT: RSS: Main: 135192576 20:07:52 INFO - 2015-11-13 20:07:52,779 DEBUG : BROWSER_OUTPUT: 20:07:55 INFO - 2015-11-13 20:07:55,702 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41402/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:41402/tests/kraken/driver.html?testName=json-parse-financial) 20:07:56 INFO - 2015-11-13 20:07:56,289 DEBUG : BROWSER_OUTPUT: RSS: Main: 135852032 20:07:56 INFO - 2015-11-13 20:07:56,290 DEBUG : BROWSER_OUTPUT: 20:07:58 INFO - 2015-11-13 20:07:58,085 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41402/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:41402/tests/kraken/driver.html?testName=json-stringify-tinderbox) 20:07:58 INFO - 2015-11-13 20:07:58,674 DEBUG : BROWSER_OUTPUT: RSS: Main: 136986624 20:07:58 INFO - 2015-11-13 20:07:58,674 DEBUG : BROWSER_OUTPUT: 20:08:00 INFO - 2015-11-13 20:08:00,566 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41402/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:41402/tests/kraken/driver.html?testName=stanford-crypto-aes) 20:08:01 INFO - 2015-11-13 20:08:01,188 DEBUG : BROWSER_OUTPUT: RSS: Main: 137162752 20:08:01 INFO - 2015-11-13 20:08:01,188 DEBUG : BROWSER_OUTPUT: 20:08:03 INFO - 2015-11-13 20:08:03,385 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41402/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:41402/tests/kraken/driver.html?testName=stanford-crypto-ccm) 20:08:03 INFO - 2015-11-13 20:08:03,974 DEBUG : BROWSER_OUTPUT: RSS: Main: 137842688 20:08:03 INFO - 2015-11-13 20:08:03,974 DEBUG : BROWSER_OUTPUT: 20:08:06 INFO - 2015-11-13 20:08:06,535 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41402/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:41402/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 20:08:07 INFO - 2015-11-13 20:08:07,137 DEBUG : BROWSER_OUTPUT: RSS: Main: 137035776 20:08:07 INFO - 2015-11-13 20:08:07,137 DEBUG : BROWSER_OUTPUT: 20:08:09 INFO - 2015-11-13 20:08:09,698 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41402/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:41402/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 20:08:10 INFO - 2015-11-13 20:08:10,285 DEBUG : BROWSER_OUTPUT: RSS: Main: 137162752 20:08:10 INFO - 2015-11-13 20:08:10,286 DEBUG : BROWSER_OUTPUT: 20:08:12 INFO - 2015-11-13 20:08:12,054 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41402/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:41402/tests/kraken/driver.html?testName=ai-astar) 20:08:12 INFO - 2015-11-13 20:08:12,305 DEBUG : BROWSER_OUTPUT: RSS: Main: 138465280 20:08:12 INFO - 2015-11-13 20:08:12,305 DEBUG : BROWSER_OUTPUT: 20:08:12 INFO - 2015-11-13 20:08:12,305 DEBUG : BROWSER_OUTPUT: __start_tp_report 20:08:12 INFO - 2015-11-13 20:08:12,305 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 20:08:12 INFO - 2015-11-13 20:08:12,305 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 20:08:12 INFO - 2015-11-13 20:08:12,306 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 20:08:12 INFO - 2015-11-13 20:08:12,306 DEBUG : BROWSER_OUTPUT: |0;ai-astar;113;107;112;111;113;122;112;113;113;110 20:08:12 INFO - 2015-11-13 20:08:12,306 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;157;132;156;176;135;163;157;135;169;135 20:08:12 INFO - 2015-11-13 20:08:12,306 DEBUG : BROWSER_OUTPUT: |2;audio-dft;164;163;163;165;163;167;171;165;164;163 20:08:12 INFO - 2015-11-13 20:08:12,306 DEBUG : BROWSER_OUTPUT: |3;audio-fft;74;73;73;73;75;143;74;73;76;75 20:08:12 INFO - 2015-11-13 20:08:12,307 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;92;91;124;91;92;92;129;91;92;132 20:08:12 INFO - 2015-11-13 20:08:12,307 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;109;110;110;110;111;111;110;110;110;111 20:08:12 INFO - 2015-11-13 20:08:12,308 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;148;149;148;148;148;148;149;148;148;149 20:08:12 INFO - 2015-11-13 20:08:12,308 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;96;98;99;97;96;95;95;96;96;96 20:08:12 INFO - 2015-11-13 20:08:12,308 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;73;74;75;75;74;74;84;73;74;74 20:08:12 INFO - 2015-11-13 20:08:12,308 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;66;67;66;67;67;67;67;68;67;68 20:08:12 INFO - 2015-11-13 20:08:12,309 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;84;86;85;85;86;83;95;88;86;97 20:08:12 INFO - 2015-11-13 20:08:12,309 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;127;122;132;124;120;133;124;122;122;125 20:08:12 INFO - 2015-11-13 20:08:12,309 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;137;139;148;148;139;143;144;144;147;147 20:08:12 INFO - 2015-11-13 20:08:12,309 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;71;69;69;72;73;68;69;73;73;69 20:08:12 INFO - 2015-11-13 20:08:12,309 DEBUG : BROWSER_OUTPUT: __end_tp_report 20:08:12 INFO - 2015-11-13 20:08:12,309 DEBUG : BROWSER_OUTPUT: __start_cc_report 20:08:12 INFO - 2015-11-13 20:08:12,309 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,771 20:08:12 INFO - 2015-11-13 20:08:12,310 DEBUG : BROWSER_OUTPUT: __end_cc_report 20:08:12 INFO - 2015-11-13 20:08:12,310 DEBUG : BROWSER_OUTPUT: __startTimestamp1447474092304__endTimestamp 20:08:12 INFO - 2015-11-13 20:08:12,310 DEBUG : BROWSER_OUTPUT: 20:08:12 INFO - 2015-11-13 20:08:12,313 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 20:08:12 INFO - 2015-11-13 20:08:12,313 DEBUG : BROWSER_OUTPUT: Number of tests: 14 20:08:12 INFO - 2015-11-13 20:08:12,314 DEBUG : BROWSER_OUTPUT: 20:08:12 INFO - 2015-11-13 20:08:12,314 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:112.60 Median:113.00 stddev:3.81 (3.4%) stddev-sans-first:4.03 20:08:12 INFO - 2015-11-13 20:08:12,314 DEBUG : BROWSER_OUTPUT: Values: 113.0 107.0 112.0 111.0 113.0 122.0 112.0 113.0 113.0 110.0 20:08:12 INFO - 2015-11-13 20:08:12,315 DEBUG : BROWSER_OUTPUT: 20:08:12 INFO - 2015-11-13 20:08:12,315 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:151.50 Median:157.00 stddev:16.04 (10.2%) stddev-sans-first:16.89 20:08:12 INFO - 2015-11-13 20:08:12,315 DEBUG : BROWSER_OUTPUT: Values: 157.0 132.0 156.0 176.0 135.0 163.0 157.0 135.0 169.0 135.0 20:08:12 INFO - 2015-11-13 20:08:12,315 DEBUG : BROWSER_OUTPUT: 20:08:12 INFO - 2015-11-13 20:08:12,316 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:164.80 Median:164.50 stddev:2.53 (1.5%) stddev-sans-first:2.67 20:08:12 INFO - 2015-11-13 20:08:12,316 DEBUG : BROWSER_OUTPUT: Values: 164.0 163.0 163.0 165.0 163.0 167.0 171.0 165.0 164.0 163.0 20:08:12 INFO - 2015-11-13 20:08:12,316 DEBUG : BROWSER_OUTPUT: 20:08:12 INFO - 2015-11-13 20:08:12,316 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:80.90 Median:74.00 stddev:21.85 (29.5%) stddev-sans-first:23.03 20:08:12 INFO - 2015-11-13 20:08:12,316 DEBUG : BROWSER_OUTPUT: Values: 74.0 73.0 73.0 73.0 75.0 143.0 74.0 73.0 76.0 75.0 20:08:12 INFO - 2015-11-13 20:08:12,316 DEBUG : BROWSER_OUTPUT: 20:08:12 INFO - 2015-11-13 20:08:12,316 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:102.60 Median:91.50 stddev:17.86 (19.5%) stddev-sans-first:18.53 20:08:12 INFO - 2015-11-13 20:08:12,316 DEBUG : BROWSER_OUTPUT: Values: 92.0 91.0 124.0 91.0 92.0 92.0 129.0 91.0 92.0 132.0 20:08:12 INFO - 2015-11-13 20:08:12,316 DEBUG : BROWSER_OUTPUT: 20:08:12 INFO - 2015-11-13 20:08:12,316 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:110.20 Median:110.00 stddev:0.63 (0.6%) stddev-sans-first:0.50 20:08:12 INFO - 2015-11-13 20:08:12,317 DEBUG : BROWSER_OUTPUT: Values: 109.0 110.0 110.0 110.0 111.0 111.0 110.0 110.0 110.0 111.0 20:08:12 INFO - 2015-11-13 20:08:12,317 DEBUG : BROWSER_OUTPUT: 20:08:12 INFO - 2015-11-13 20:08:12,317 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:148.30 Median:148.00 stddev:0.48 (0.3%) stddev-sans-first:0.50 20:08:12 INFO - 2015-11-13 20:08:12,317 DEBUG : BROWSER_OUTPUT: Values: 148.0 149.0 148.0 148.0 148.0 148.0 149.0 148.0 148.0 149.0 20:08:12 INFO - 2015-11-13 20:08:12,317 DEBUG : BROWSER_OUTPUT: 20:08:12 INFO - 2015-11-13 20:08:12,317 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:96.40 Median:96.00 stddev:1.26 (1.3%) stddev-sans-first:1.33 20:08:12 INFO - 2015-11-13 20:08:12,317 DEBUG : BROWSER_OUTPUT: Values: 96.0 98.0 99.0 97.0 96.0 95.0 95.0 96.0 96.0 96.0 20:08:12 INFO - 2015-11-13 20:08:12,317 DEBUG : BROWSER_OUTPUT: 20:08:12 INFO - 2015-11-13 20:08:12,317 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:75.00 Median:74.00 stddev:3.23 (4.4%) stddev-sans-first:3.35 20:08:12 INFO - 2015-11-13 20:08:12,318 DEBUG : BROWSER_OUTPUT: Values: 73.0 74.0 75.0 75.0 74.0 74.0 84.0 73.0 74.0 74.0 20:08:12 INFO - 2015-11-13 20:08:12,318 DEBUG : BROWSER_OUTPUT: 20:08:12 INFO - 2015-11-13 20:08:12,318 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:67.00 Median:67.00 stddev:0.67 (1.0%) stddev-sans-first:0.60 20:08:12 INFO - 2015-11-13 20:08:12,318 DEBUG : BROWSER_OUTPUT: Values: 66.0 67.0 66.0 67.0 67.0 67.0 67.0 68.0 67.0 68.0 20:08:12 INFO - 2015-11-13 20:08:12,318 DEBUG : BROWSER_OUTPUT: 20:08:12 INFO - 2015-11-13 20:08:12,319 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:87.50 Median:86.00 stddev:4.70 (5.5%) stddev-sans-first:4.81 20:08:12 INFO - 2015-11-13 20:08:12,319 DEBUG : BROWSER_OUTPUT: Values: 84.0 86.0 85.0 85.0 86.0 83.0 95.0 88.0 86.0 97.0 20:08:12 INFO - 2015-11-13 20:08:12,319 DEBUG : BROWSER_OUTPUT: 20:08:12 INFO - 2015-11-13 20:08:12,319 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:125.10 Median:124.50 stddev:4.36 (3.5%) stddev-sans-first:4.57 20:08:12 INFO - 2015-11-13 20:08:12,320 DEBUG : BROWSER_OUTPUT: Values: 127.0 122.0 132.0 124.0 120.0 133.0 124.0 122.0 122.0 125.0 20:08:12 INFO - 2015-11-13 20:08:12,320 DEBUG : BROWSER_OUTPUT: 20:08:12 INFO - 2015-11-13 20:08:12,320 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:143.60 Median:145.50 stddev:4.06 (2.8%) stddev-sans-first:3.54 20:08:12 INFO - 2015-11-13 20:08:12,320 DEBUG : BROWSER_OUTPUT: Values: 137.0 139.0 148.0 148.0 139.0 143.0 144.0 144.0 147.0 147.0 20:08:12 INFO - 2015-11-13 20:08:12,320 DEBUG : BROWSER_OUTPUT: 20:08:12 INFO - 2015-11-13 20:08:12,320 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:70.60 Median:71.50 stddev:2.01 (2.8%) stddev-sans-first:2.13 20:08:12 INFO - 2015-11-13 20:08:12,320 DEBUG : BROWSER_OUTPUT: Values: 71.0 69.0 69.0 72.0 73.0 68.0 69.0 73.0 73.0 69.0 20:08:12 INFO - 2015-11-13 20:08:12,320 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 20:08:12 INFO - 2015-11-13 20:08:12,320 DEBUG : BROWSER_OUTPUT: 20:08:13 INFO - 2015-11-13 20:08:13,268 INFO : Browser exited with error code: 0 20:08:13 INFO - 2015-11-13 20:08:13,326 INFO : Completed test kraken (00:01:02) 20:08:13 INFO - 2015-11-13 20:08:13,326 INFO : Starting test v8_7 20:08:13 INFO - 2015-11-13 20:08:13,326 DEBUG : operating with platform_type : linux_ 20:08:13 INFO - 2015-11-13 20:08:13,326 INFO : Initialising browser for v8_7 test... 20:08:13 INFO - 2015-11-13 20:08:13,332 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpga4DZ4/profile http://localhost:41402/getInfo.html 20:08:19 INFO - 2015-11-13 20:08:19,183 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 20:08:19 INFO - 2015-11-13 20:08:19,184 DEBUG : BROWSER_OUTPUT: colorDepth:24 20:08:19 INFO - 2015-11-13 20:08:19,184 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 20:08:19 INFO - 2015-11-13 20:08:19,184 DEBUG : BROWSER_OUTPUT: __metrics 20:08:20 INFO - 2015-11-13 20:08:20,632 INFO : Browser initialized. 20:08:20 INFO - 2015-11-13 20:08:20,632 INFO : Running cycle 1/1 for v8_7 test... 20:08:20 INFO - 2015-11-13 20:08:20,633 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpga4DZ4/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 20:08:32 INFO - 2015-11-13 20:08:32,583 DEBUG : BROWSER_OUTPUT: RSS: Main: 138362880 20:08:32 INFO - 2015-11-13 20:08:32,583 DEBUG : BROWSER_OUTPUT: 20:08:54 INFO - 2015-11-13 20:08:54,066 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41402/tests/v8_7/run.html (next: http://localhost:41402/tests/v8_7/run.html) 20:08:54 INFO - 2015-11-13 20:08:54,324 DEBUG : BROWSER_OUTPUT: RSS: Main: 137482240 20:08:54 INFO - 2015-11-13 20:08:54,325 DEBUG : BROWSER_OUTPUT: 20:08:54 INFO - 2015-11-13 20:08:54,325 DEBUG : BROWSER_OUTPUT: __start_tp_report 20:08:54 INFO - 2015-11-13 20:08:54,325 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 20:08:54 INFO - 2015-11-13 20:08:54,325 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 20:08:54 INFO - 2015-11-13 20:08:54,325 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 20:08:54 INFO - 2015-11-13 20:08:54,325 DEBUG : BROWSER_OUTPUT: |0;Richards;162.73393002441009 20:08:54 INFO - 2015-11-13 20:08:54,326 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;190.8761213972132 20:08:54 INFO - 2015-11-13 20:08:54,326 DEBUG : BROWSER_OUTPUT: |2;Encrypt;280.3476310625175 20:08:54 INFO - 2015-11-13 20:08:54,326 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5060.606060606061 20:08:54 INFO - 2015-11-13 20:08:54,326 DEBUG : BROWSER_OUTPUT: |4;RayTrace;1075.187969924812 20:08:54 INFO - 2015-11-13 20:08:54,326 DEBUG : BROWSER_OUTPUT: |5;Earley;722.0216606498195 20:08:54 INFO - 2015-11-13 20:08:54,327 DEBUG : BROWSER_OUTPUT: |6;Boyer;12207.317073170732 20:08:54 INFO - 2015-11-13 20:08:54,327 DEBUG : BROWSER_OUTPUT: |7;RegExp;25525 20:08:54 INFO - 2015-11-13 20:08:54,327 DEBUG : BROWSER_OUTPUT: |8;Splay;599.7617629541394 20:08:54 INFO - 2015-11-13 20:08:54,328 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4835.748792270531 20:08:54 INFO - 2015-11-13 20:08:54,328 DEBUG : BROWSER_OUTPUT: __end_tp_report 20:08:54 INFO - 2015-11-13 20:08:54,328 DEBUG : BROWSER_OUTPUT: __startTimestamp1447474134317__endTimestamp 20:08:54 INFO - 2015-11-13 20:08:54,328 DEBUG : BROWSER_OUTPUT: 20:08:54 INFO - 2015-11-13 20:08:54,328 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 20:08:54 INFO - 2015-11-13 20:08:54,329 DEBUG : BROWSER_OUTPUT: Number of tests: 10 20:08:54 INFO - 2015-11-13 20:08:54,329 DEBUG : BROWSER_OUTPUT: 20:08:54 INFO - 2015-11-13 20:08:54,329 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:162.73 Median:162.73 stddev:0.00 (0.0%) 20:08:54 INFO - 2015-11-13 20:08:54,329 DEBUG : BROWSER_OUTPUT: Values: 162.7 20:08:54 INFO - 2015-11-13 20:08:54,329 DEBUG : BROWSER_OUTPUT: 20:08:54 INFO - 2015-11-13 20:08:54,330 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:190.88 Median:190.88 stddev:0.00 (0.0%) 20:08:54 INFO - 2015-11-13 20:08:54,330 DEBUG : BROWSER_OUTPUT: Values: 190.9 20:08:54 INFO - 2015-11-13 20:08:54,330 DEBUG : BROWSER_OUTPUT: 20:08:54 INFO - 2015-11-13 20:08:54,330 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:280.35 Median:280.35 stddev:0.00 (0.0%) 20:08:54 INFO - 2015-11-13 20:08:54,330 DEBUG : BROWSER_OUTPUT: Values: 280.3 20:08:54 INFO - 2015-11-13 20:08:54,331 DEBUG : BROWSER_OUTPUT: 20:08:54 INFO - 2015-11-13 20:08:54,331 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5060.61 Median:5060.61 stddev:0.00 (0.0%) 20:08:54 INFO - 2015-11-13 20:08:54,331 DEBUG : BROWSER_OUTPUT: Values: 5060.6 20:08:54 INFO - 2015-11-13 20:08:54,331 DEBUG : BROWSER_OUTPUT: 20:08:54 INFO - 2015-11-13 20:08:54,331 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:1075.19 Median:1075.19 stddev:0.00 (0.0%) 20:08:54 INFO - 2015-11-13 20:08:54,332 DEBUG : BROWSER_OUTPUT: Values: 1075.2 20:08:54 INFO - 2015-11-13 20:08:54,332 DEBUG : BROWSER_OUTPUT: 20:08:54 INFO - 2015-11-13 20:08:54,332 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:722.02 Median:722.02 stddev:0.00 (0.0%) 20:08:54 INFO - 2015-11-13 20:08:54,332 DEBUG : BROWSER_OUTPUT: Values: 722.0 20:08:54 INFO - 2015-11-13 20:08:54,332 DEBUG : BROWSER_OUTPUT: 20:08:54 INFO - 2015-11-13 20:08:54,333 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:12207.32 Median:12207.32 stddev:0.00 (0.0%) 20:08:54 INFO - 2015-11-13 20:08:54,333 DEBUG : BROWSER_OUTPUT: Values: 12207.3 20:08:54 INFO - 2015-11-13 20:08:54,333 DEBUG : BROWSER_OUTPUT: 20:08:54 INFO - 2015-11-13 20:08:54,333 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:25525.00 Median:25525.00 stddev:0.00 (0.0%) 20:08:54 INFO - 2015-11-13 20:08:54,333 DEBUG : BROWSER_OUTPUT: Values: 25525.0 20:08:54 INFO - 2015-11-13 20:08:54,333 DEBUG : BROWSER_OUTPUT: 20:08:54 INFO - 2015-11-13 20:08:54,334 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:599.76 Median:599.76 stddev:0.00 (0.0%) 20:08:54 INFO - 2015-11-13 20:08:54,334 DEBUG : BROWSER_OUTPUT: Values: 599.8 20:08:54 INFO - 2015-11-13 20:08:54,334 DEBUG : BROWSER_OUTPUT: 20:08:54 INFO - 2015-11-13 20:08:54,334 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4835.75 Median:4835.75 stddev:0.00 (0.0%) 20:08:54 INFO - 2015-11-13 20:08:54,334 DEBUG : BROWSER_OUTPUT: Values: 4835.7 20:08:54 INFO - 2015-11-13 20:08:54,335 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 20:08:54 INFO - 2015-11-13 20:08:54,335 DEBUG : BROWSER_OUTPUT: 20:08:55 INFO - 2015-11-13 20:08:55,288 INFO : Browser exited with error code: 0 20:08:55 INFO - 2015-11-13 20:08:55,302 INFO : Completed test v8_7 (00:00:41) 20:08:55 INFO - 2015-11-13 20:08:55,317 INFO : Completed test suite (00:20:20) 20:08:55 INFO - 2015-11-13 20:08:55,317 DEBUG : Working with test: dromaeo_css 20:08:55 INFO - 2015-11-13 20:08:55,317 DEBUG : Generating results file: dromaeo_css 20:08:55 INFO - 2015-11-13 20:08:55,319 DEBUG : Working with test: kraken 20:08:55 INFO - 2015-11-13 20:08:55,319 DEBUG : Generating results file: kraken 20:08:55 INFO - 2015-11-13 20:08:55,319 INFO : javascript benchmark 20:08:55 INFO - 2015-11-13 20:08:55,319 DEBUG : Working with test: v8_7 20:08:55 INFO - 2015-11-13 20:08:55,319 DEBUG : Generating results file: v8_7 20:08:55 INFO - 2015-11-13 20:08:55,320 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 20:08:55 INFO - 2015-11-13 20:08:55,374 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,94,43]] 20:08:55 INFO - 2015-11-13 20:08:55,374 DEBUG : process_Request line: dromaeo_css 6157.98 graph.html#tests=[[72,94,43]] 20:08:55 INFO - 2015-11-13 20:08:55,374 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 20:08:55 INFO - 2015-11-13 20:08:55,420 DEBUG : process_Request line: kraken 1536.10 graph.html#tests=[[232,94,43]] 20:08:55 INFO - 2015-11-13 20:08:55,420 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 20:08:55 INFO - 2015-11-13 20:08:55,467 DEBUG : process_Request line: v8_7 21400.97 graph.html#tests=[[230,94,43]] 20:08:55 INFO - 2015-11-13 20:08:55,468 INFO : javascript benchmark 20:08:55 INFO - 2015-11-13 20:08:55,472 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [336.9191394065425, 337.43648107660204, 340.05803923132913, 340.6219096802549, 342.6761710183877, 12848.421821018053, 13242.867571324285, 15216.543503694893, 15289.311980960856, 16088.919555402206, 15272.923635381836, 15307.158106304149, 15782.053076815399, 15907.681846363095, 15911.44309949152, 4481.170983368071, 4604.217283061871, 4622.722636641795, 4627.514111018329, 4858.611311095104, 4607.14767767964, 6482.222133344006, 6752.594844309333, 6763.222229443603, 6779.966100169492, 6650.833729156786, 6655.46756259498, 6668.433183179435, 6677.1987361516685, 6827.829304267383, 6798.762043328485, 6827.351401616888, 6830.6926188321395, 6832.145981752281, 6844.965775171142, 5993.460588547052, 6197.473214776749, 6203.379662033805, 6212.1303017577575, 6503.967480162616, 19551.0, 19740.80259197404, 19790.208391664317, 20267.189312427487, 20282.69575956362, 1819.299569665675, 1832.3220408448826, 1833.8257865502756, 1870.1023508715757, 1889.1687657430687, 12824.615261542169, 13220.272884991322, 13432.0, 13446.260455674934, 14054.227017514033, 1801.4145402744161, 1876.2870109358494, 1909.5130741660787, 1918.1080797429263, 1929.5079754662472, 46663.76668116638, 47554.76222618899, 60677.393226067616, 63016.36983630151, 63019.6849015752, 14603.794059524274, 15877.920610396874, 15945.20273986296, 15948.68102637964, 15971.201439927958, 22865.170786337054, 22958.540829183323, 23089.42276443069, 23178.53642927166, 23210.419739506648, 8461.492310461268, 8498.362622803192, 8547.145285471403, 8555.529445880537, 8592.527410992456, 7219.241979592067, 7231.276872312832, 7234.529755565872, 7240.0, 7256.7097316106765, 2915.6355455568055, 2994.925126871802, 7753.945204520694, 7817.335526480199, 7890.921090789134, 1025.0620682075967, 1033.493588141805, 1035.9792804143874, 1036.2953191829477, 1090.0189829153667, 401.50213734969014, 402.9576894426043, 427.3034953026547, 429.6798884830821, 448.1619371774737, 9256.72229833106, 9711.514424278757, 9767.804643907082, 9931.304808663324, 10054.396736195851, 378.48903979627835, 381.73278704906676, 385.7936004237719, 386.33357458384626, 386.97678139311734, 5342.691040695055, 5368.677879327252, 5377.623566350396, 5406.162044882971, 5461.825707472913, 326650.0, 333547.0, 492389.0, 497627.0, 503017.0, 64581.67709161424, 65922.67038664776, 66622.66688666526, 67387.66306168537, 68229.65885170542, 453.2724976412876, 461.3679259414623, 461.9030003699261, 462.70849364899897, 462.8680825964584, 10029.097381235724, 10035.996400359905, 10063.094321511098, 10096.242781791248, 10147.391156530632, 33294.5005824908, 33394.49908251427, 33400.66599333975, 34356.14109647279, 34517.82741086279, 38982.80508597439, 39393.40909886297, 39602.207955841295, 39766.80116599399, 42077.36883946804, 6007.189029480965, 6281.905771413341, 6284.591501552567, 6285.811425657238, 6292.779752708816, 10011.849822252527, 10487.0, 10489.055984961085, 10618.946905265733, 10633.255672102878, 9038.683646072355, 9073.410228335137, 9319.487428191243, 9558.713238602853, 9573.904260957579, 9091.454512729257, 9423.29325300619, 9544.904550954401, 9625.759356016155, 9704.70885873425, 9440.433573985583, 9497.382670126419, 9506.334556581249, 9703.320767546204, 9888.604455821687, 6047.485963693135, 6080.361562035922, 6100.572959892942, 6124.693765311806, 6149.046897730859, 9816.16562592159, 9851.655192068243, 9855.802883942424, 9919.40483570988, 10135.189184865045], "dojo.html": [2671.5324818156823, 2698.17705599792, 2726.38656302332, 2733.3303340681537, 2764.3641962348665, 4516.819327226907, 4758.500357462464, 4766.78549465274, 4785.808567657294, 4804.783784729687, 4604.746738929358, 4638.489766125724, 4657.5575320344515, 4674.883127921795, 4770.0459908018365, 4261.403403523509, 4354.259775838099, 4406.581374769392, 4419.801108950105, 4463.241248987663, 4170.687198460112, 4369.956300437003, 4429.60133587977, 4471.4187155669715, 4484.013517026249, 4238.258304796679, 4302.22559939214, 4320.027993701424, 4337.327714204303, 4371.453568303962, 4384.145091707119, 4396.362527433536, 4408.030233348658, 4417.072414792898, 4446.777661116931, 4136.31750761124, 4237.724547904377, 4248.34150706641, 4399.868003959887, 4434.2905135178535, 4595.563421474954, 4652.255639097762, 4653.7440440775745, 4681.672282940195, 4723.645726570521, 5041.495850414965, 5041.621878359101, 5046.44489106198, 5057.5195356441445, 5104.412992505835, 4837.0567739290855, 4912.8771780705765, 4942.629302802268, 5063.3417655704525, 5077.543021128116, 4700.670953033289, 4718.929216061693, 4723.126221649006, 4733.502982186889, 4776.641751868624, 5168.250603662448, 5202.3497062867145, 5213.504717051874, 5230.947690523046, 5245.895082098336, 4760.857174284777, 4844.660873738804, 4860.68405553645, 4931.211006238985, 4992.90014199714, 5052.7726252318735, 5058.342415485963, 5066.797328106908, 5097.311862898461, 5112.36095488064, 4771.6898401603785, 5005.824796132118, 5007.8247261346405, 5015.297858299841, 5025.120603894304, 4870.4155501340065, 4893.168161412568, 4919.950800492021, 4927.408710954708, 4961.03259864323, 4134.958650413518, 4153.792310384469, 4174.019105510202, 4182.53992060873, 4201.390798334285, 3596.5144705464427, 3677.9632203678157, 3696.334659761269, 3698.9075273118387, 3739.121306493026, 4268.957310426856, 4347.065380943112, 4355.760433176206, 4362.803673834622, 4375.343698445195, 5047.0, 5101.795928162832, 5117.104506711311, 5125.4874512549195, 5177.948220517822, 4157.376393540993, 4223.66210703143, 4269.615734583902, 4401.449818772653, 4402.84590039347, 4448.666350023761, 4458.308962110878, 4466.486354069324, 4467.352233926127, 4489.708168969007, 4730.597899178609, 4773.809047638056, 4774.880627984328, 4785.976070119627, 4818.566329030334, 4838.854834354975, 4941.234108713155, 4949.505049495022, 4951.702897826142, 5009.749512524432, 4676.088162808356, 4715.174844402147, 4760.357351757469, 4761.333413322069, 4775.594074503567, 4941.234108713155, 4948.554630083309, 4964.478729733326, 4974.0797952378925, 4993.725345106054, 4864.978354545444, 4986.252062190555, 5064.18972964324, 5111.7188554628365, 5154.690718556899, 4755.167845627071, 4837.032593481247, 4859.3682821233015, 4860.149473842134, 4881.170201065756, 4957.578605818546, 4957.975210123926, 4965.8013679452415, 4967.652264341461, 4985.3020577118505, 4618.722876627413, 4656.022235330483, 4707.505711900201, 4869.889031050436, 4895.681780684244, 4890.657653964188, 4930.063287975417, 4936.4569897311985, 4952.504749525018, 4955.380577427822, 4823.1800593898415, 4842.4189097308545, 4846.273059041031, 4867.464578896389, 4871.87820304481], "mootools.html": [1457.2640816387736, 1686.5193419875334, 1734.848787503496, 1756.0605076284191, 1771.0878897367866, 6354.332795056522, 6453.386928241809, 7088.787336379911, 7505.362044226241, 7543.547387156767, 7036.683349249283, 7214.206437291894, 7290.0, 7337.523061001045, 7346.59593722345, 2140.154638917623, 2165.7076294700173, 2169.5877783221135, 2174.6629272462715, 2183.094015983365, 2179.7711240319777, 2216.3683350245183, 2228.0419419649543, 2230.9776902231015, 2238.29493709481, 2118.9152433902627, 2119.0993827623274, 2142.453674313048, 2156.2668692644497, 2164.1667957836266, 2163.935081947536, 2170.3814412892407, 2173.7609562549274, 2175.6192666283337, 2194.714687090676, 2157.0, 2192.6272533669153, 2211.6461366181334, 2215.8670479771104, 2216.645336746129, 7242.963785181093, 7316.963415182943, 7319.304666056716, 7352.963235183844, 7366.189719130892, 3757.7933213673236, 4367.213901497729, 4480.910381792379, 4495.0, 4505.639548836118, 2428.2229686500327, 2834.1780883543747, 2872.8132671376293, 2899.130260921736, 2906.622139121922, 900.342749792655, 903.5843511984496, 936.765808547863, 945.8723072385209, 949.9382540134869, 9465.52672366379, 9501.049895010512, 9509.381890177185, 9620.037996200394, 9624.855627165598, 4199.538050814408, 4254.106637606075, 4278.935815962763, 4295.119500502389, 4315.719478233905, 8448.831023379498, 8453.619587118594, 8475.0, 8512.021117571434, 8588.355873309527, 4513.796879140381, 4534.977325113353, 4544.954550454453, 4547.045120524727, 4581.725096494221, 4090.590940905945, 4096.426500289962, 4097.221527909687, 4122.628963393309, 4125.731827431207, 3536.451849963208, 3576.9821150894077, 3582.158192824684, 3583.623719509414, 3621.203335266237, 1155.8381826544291, 1156.7166044319197, 1165.2600598619767, 1174.3717111345388, 1177.5113327968797, 1157.4212893553224, 1172.2263306218026, 1183.585744989247, 1190.4166958190597, 1190.5951976327917, 6913.340798208394, 6937.514373993772, 6945.37491625746, 6970.128733908262, 6970.372666460043, 415.5864914410181, 418.1678459864847, 419.3772248211404, 424.6878544269959, 433.6400787346495, 5292.364916210079, 5333.466653334713, 5387.111126664135, 5389.461053894579, 5422.0511410503, 7401.666924988388, 7571.242875712494, 8299.460535065202, 8613.698520551876, 8627.266682331947, 8498.490090594583, 8567.871481927776, 8588.785280368042, 8603.5698215089, 8699.608517616722, 6773.593584384953, 6801.897971530431, 6836.623985680835, 6857.5199736018, 6883.380495755406, 6668.733250670113, 6676.265610782712, 6680.131582894192, 6682.63245521501, 6713.429358504386, 7681.193474685301, 7894.723684671009, 7914.24814642608, 7932.6430310635005, 7973.561454120079, 8011.399145064027, 8019.879701804594, 8144.877826832484, 8153.592320384076, 8241.011078670597, 6448.516361272829, 6455.193100862392, 6484.967575162094, 6580.638064906476, 6586.0, 7214.422846172189, 7215.639218038972, 7239.927600724136, 7265.09186351706, 7281.708731650675, 6767.120274364301, 6778.356056174655, 6822.795316140524, 6824.761133360507, 6898.965505172643, 6538.084668146368, 6580.967095164494, 6601.075849380994, 6630.171228596426, 6633.2040155181685, 6727.730890764315, 6801.625910574768, 6827.078344423439, 6852.486063545154, 6874.8625027500175, 6219.067139929047, 6268.0, 6293.087502312048, 6304.905426418516, 6305.085762564494, 6266.530010249158, 6292.2134733158355, 6293.96853015732, 6327.272363678236, 6337.04944258365], "ext.html": [558.9469000444959, 565.9925332907426, 586.8210195890255, 590.592491181085, 600.3006497430495, 27347.5897861532, 36684.0, 36946.44580331294, 37035.0, 37049.0, 40919.0, 41108.79445602768, 41442.17115657693, 41481.0, 41514.79242603783, 7750.108737495204, 7895.526268423884, 7904.960475197616, 7908.288254057134, 7928.960355198216, 7890.723824666138, 7952.562609056499, 7958.920410795905, 7970.920290797076, 7979.281864632182, 7948.205179482064, 8002.399820013493, 8043.678252869879, 8053.073896501889, 8068.435209535335, 7955.124936257007, 7960.562169080698, 7966.5618390988475, 8025.478343907656, 8025.799355016113, 7809.453338266324, 7911.2088791121005, 7913.762587122395, 7919.762407127795, 7951.443398962075, 36854.63145368539, 37312.626873731184, 37532.81233593842, 37692.0, 37793.62206377929, 2608.6608740863758, 2827.3073097091346, 2828.6605607327047, 2879.9712002879915, 3009.5184770436626, 27589.172324830288, 27931.58102628462, 28088.438231235465, 28146.577801333, 28823.0, 2862.3845873137166, 2896.218021134303, 2904.4626744052416, 2955.0248418022, 2964.985175074111, 208260.0, 210102.94948525314, 210204.0, 211025.0, 211243.0, 37989.62010379861, 38671.22657546889, 38804.22391552153, 38851.6114838848, 52014.0, 36847.631523684955, 37231.81384093062, 37255.59793829879, 37323.0, 37335.0, 12773.0, 12879.935600321938, 12933.741325173443, 12986.675333116747, 13009.089363744448, 10047.799044019079, 10168.593256269814, 10169.644062457779, 10172.338797978107, 10187.286889917783, 13345.73308533824, 13385.598432047054, 13405.597832065054, 13410.932945335211, 13500.5274815381, 5660.349059858169, 5668.121441176624, 5751.59738818287, 5763.0, 5768.0, 806.4919100966354, 833.7457075591882, 839.3117643532368, 907.7458311672742, 908.3777612335572, 27052.0, 28898.422031559672, 31134.41789325227, 31157.8442107788, 31436.842815785774, 895.8477058899872, 910.0808183734476, 916.7662246127195, 919.9034101419254, 973.9530005244391, 13745.931270343584, 14105.294735263196, 14201.715965680629, 14258.215798130996, 14371.425142994372, 309851.0, 314821.0, 314883.0, 318569.0, 318712.0, 45934.08131837344, 46063.539364605924, 46173.30740038835, 46242.07515849664, 46503.5349646506, 1133.9546418143182, 1174.371711134556, 1185.6206014075412, 1187.7446349035, 1192.4395534099133, 25513.61729574021, 26094.34764130912, 26196.345091372867, 26333.210003699918, 26456.338591535365, 39771.40342894917, 40094.1981160381, 40332.59667403406, 40340.79829600833, 40360.59639403568, 248113.0, 248393.09641421572, 249625.0, 251025.0, 251137.0, 24705.752942470346, 25251.494970100863, 29209.0, 29282.267943301587, 29931.0, 33625.0, 34700.82649586736, 35030.29939401147, 35128.648713512535, 35149.8242508796, 38063.80968095142, 38851.41722874215, 39399.121516854575, 39931.40102898401, 40321.59678403296, 34076.65923340735, 34267.82866085654, 34291.14272143217, 34517.30965380628, 34872.82563587267, 33923.66076339304, 35115.64884351124, 35117.122071948404, 35145.297094058486, 35145.47281790724, 28735.5689664651, 30945.8452707735, 31268.061958141294, 31306.0, 31407.21481962969, 24310.51378972446, 24367.390815229763, 24581.13966011181, 24800.627990579796, 25101.24696259115], "prototype.html": [281.90837977657264, 288.3253187541153, 293.2829232526472, 296.1913974848663, 296.68847709904594, 5412.07994640911, 5433.456654334569, 5478.0, 5545.057340252157, 5568.777248910049, 5386.407495175537, 5423.403425623188, 5453.754581043852, 5467.6719396836215, 5469.781208751645, 4150.3359462486005, 4150.64719498843, 4162.895927601804, 4170.895727606819, 4174.874753757392, 4044.211378781139, 4070.5929407059352, 4124.154548317588, 4125.463689720332, 4130.297849365615, 4051.7163798534116, 4077.2864748669012, 4079.102597428576, 4082.755034697928, 4084.6323830855217, 4066.8169932353117, 4069.470968774055, 4094.0, 4099.85650502234, 4101.507819061717, 3572.8570857165682, 3572.8928132156075, 3576.6065732769375, 3579.427291633326, 3579.7315201359743, 5137.743112844343, 5177.068127737006, 5229.895402091975, 5248.973755131238, 5274.077036518594, 4761.547652972962, 4795.064962332347, 4799.0401919616215, 4799.832005879813, 4807.399075115611, 5702.54379649627, 5729.828105156852, 5739.655620662732, 5743.0811070228565, 5752.5110365618975, 3954.9604503955165, 3975.1056012397266, 3985.422113793513, 3985.5815139410233, 3987.342088555385, 5746.511546518509, 5999.6700181490005, 6007.729652165619, 6013.218281623404, 6023.427774361428, 4033.5361433434946, 4069.7558146511305, 4071.4528479177725, 4073.348264277701, 4079.530853951774, 4119.752814831119, 4119.814608342572, 4124.8143833527565, 4133.379993001074, 4136.91726165475, 4723.645726570452, 4753.215719406328, 4757.595604373598, 4759.595434388116, 4760.904781904343, 5523.6685798852195, 5715.514181294553, 5739.0, 5751.884962300731, 5765.308163020464, 1470.8235011798438, 1483.5326872035275, 1490.9179995100158, 1491.4854375240525, 1493.2981498695597, 1012.584840215508, 1014.974625634365, 1018.8930162332997, 1025.876894772632, 1029.9330543514648, 4969.776360063805, 4970.179920313108, 4979.90040199194, 5000.424951130666, 5011.57401620859, 5862.794802181988, 5880.647161170344, 5882.617629854046, 5910.763569457259, 5911.674857882772, 4973.403191617029, 4977.104121258136, 4985.9501404985485, 4988.0772057168815, 4994.150994330972, 3107.151245009216, 3172.0325300783484, 3179.1257404213566, 3192.409404260219, 3199.45609246424, 5557.833265002057, 5559.082751345983, 5563.805266815642, 5585.357683866326, 5598.328200615871, 6020.518358531307, 6063.423974722395, 6144.354842741537, 6152.323244443108, 6161.84595385119, 5558.416366281483, 5565.582581306418, 5577.107662773937, 5606.579506536945, 5624.156376543551, 5905.291365036223, 5942.168096466412, 5943.851403714942, 5950.988331983486, 5965.313988891333, 5699.059655156852, 5836.445537673914, 5839.766409343579, 5844.240248767633, 5846.9183201107935, 5620.04459241938, 5629.324481062299, 5630.549556035426, 5633.549316054624, 5636.900804343114, 3937.5865534118507, 4005.9599404006754, 4008.118213992917, 4014.799260037045, 4017.015831121394, 5927.377625349276, 5932.6737029462065, 5933.317668468181, 5945.791897283574, 5951.375105613848, 5547.833564993057, 5681.204631351697, 5686.744096515584, 5703.116017017369, 5721.799737009184, 5691.0, 5716.657000579979, 5729.169270455677, 5734.885302293847, 5742.885142297214, 5559.24950131727, 5596.1605759136455, 5597.076482380362, 5607.186957891165, 5617.915731263953, 5615.803446879339, 5737.483626473638, 5743.942560574341, 5757.769689212385, 5770.942290577041, 5569.220309156641, 5572.944270557243, 5572.972135139461, 5615.213870058276, 5617.988762022876], "yui.html": [703.5005146346098, 707.38104158861, 765.230942902383, 783.1307248953663, 806.2421323955485, 11452.484638191281, 11466.541338346467, 11486.195966282374, 11526.135539834515, 11594.246373985685, 11115.666530004093, 11286.661400157987, 11358.091352691785, 11359.1480638952, 11360.715982100452, 618.913352130702, 619.5848781316529, 791.0902462168494, 792.8850316704074, 807.7374853172713, 799.0890384961149, 805.122416565943, 805.1465446626595, 805.5448671500584, 807.8667019941703, 829.4898637338054, 834.4492634860993, 842.1957031035378, 844.9112843151473, 845.6321500147425, 827.9006519217702, 830.4726498673325, 833.8499070167368, 837.9329653627725, 838.8532006898769, 618.060547967092, 624.0857144283647, 624.1199908129515, 625.9843503912393, 626.8746250749869, 12025.0, 12030.578929737418, 12030.939845300805, 12068.275903445821, 12156.331401772899, 10908.0, 11468.31190128595, 11681.88318116825, 11742.0, 12176.26942383451, 9388.389754665994, 9418.764530886714, 9422.952885235598, 9429.76425589359, 9437.433753974783, 2820.858957052139, 2837.092130518235, 2856.5286727690113, 2876.5109931311727, 2926.283060650133, 36684.63315366839, 36777.448338274946, 36816.81591592025, 36890.0, 36940.63059369426, 6628.072069910217, 6669.166354205724, 6701.6314102723845, 6740.157480314961, 6802.693878775467, 9802.0, 9814.803703925882, 9927.702168934944, 10006.249531285182, 10069.54687039085, 5641.915371269434, 5706.486416222477, 5748.367679555246, 5869.735861886225, 5990.311114221833, 3564.322778672044, 3565.180008598037, 3569.5002699622073, 3597.2625611749527, 3598.460230965376, 2487.676602041759, 2499.562576549097, 2513.32140322112, 2517.811164162695, 2519.2694118705735, 382.21073483256987, 384.3293452924664, 387.567861834053, 389.38865980410486, 389.795357437342, 455.91793477173763, 550.3615805665409, 590.7459792289271, 598.7455331484102, 611.5963464113753, 7805.141434442206, 7955.801104972306, 8056.476329038594, 8096.797580060428, 8187.631556579968, 437.97591132487383, 510.9616778741609, 546.8250159948858, 621.9378062193834, 631.5042691487253, 3461.5326930864517, 3876.9224615508097, 3931.253061918226, 4033.8705162554534, 4065.79671016448, 56291.0, 56858.0, 57026.0, 57200.71399642975, 57282.713586432634, 44770.32844507335, 44885.77557112259, 45062.77468612636, 46100.76949615298, 46129.308060379124, 40008.399874001916, 41156.1768764629, 41205.58794412077, 41953.580464194965, 43942.34086488641, 7986.840263194587, 8050.5572193529915, 8199.754007379788, 8280.296174824967, 8410.789730256793, 32371.0, 32474.83762581172, 32838.507422389164, 33285.0, 33487.16282092967, 39129.80435097806, 39243.80378098205, 42908.35637465503, 43444.13111737811, 43890.56109438865, 6763.932360676527, 6819.283975182534, 6828.624425656637, 7021.929780702332, 7056.470764692771, 11500.712482188012, 11522.72772405012, 11533.769324613628, 11731.765364692488, 11794.46924888365, 9943.30396872212, 10021.09810117093, 10349.84475232857, 10376.377417354983, 10609.522571484147, 10584.682459526226, 10669.51987160564, 10892.400917949271, 11231.045361144394, 11292.491837867152, 10647.041766241075, 10726.570937162738, 10741.140708743438, 10795.946020269848, 10857.945710271399, 9357.20463760588, 9479.05209479074, 9664.855027174457, 9752.9024709752, 9926.205903527556, 8629.22336989674, 8965.820683586162, 8982.191602755784, 8995.0, 9210.171084602418]}, "summary": {"lowerIsBetter": false, "suite": 6157.978992782404, "subtests": {"jquery.html": {"lowerIsBetter": false, "filtered": 7438.079445292175, "unit": "ms", "value": 7438.079445292175}, "dojo.html": {"lowerIsBetter": false, "filtered": 4613.541001685666, "unit": "ms", "value": 4613.541001685666}, "mootools.html": {"lowerIsBetter": false, "filtered": 4163.681296679534, "unit": "ms", "value": 4163.681296679534}, "ext.html": {"lowerIsBetter": false, "filtered": 16250.081270442734, "unit": "ms", "value": 16250.081270442734}, "prototype.html": {"lowerIsBetter": false, "filtered": 4268.671625470126, "unit": "ms", "value": 4268.671625470126}, "yui.html": {"lowerIsBetter": false, "filtered": 5501.32350421805, "unit": "ms", "value": 5501.32350421805}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04.e", "os": "linux", "name": "talos-linux64-ix-032.e"}, "testrun": {"date": 1447472914, "suite": "dromaeo_css", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151113183032", "branch": "Firefox-Non-PGO", "revision": "202b199b9fcf37a687bef882f2513e191f079622"}}, {"talos_counters": {}, "results": {"audio-dft": [164.0, 163.0, 163.0, 165.0, 163.0, 167.0, 171.0, 165.0, 164.0, 163.0], "ai-astar": [113.0, 107.0, 112.0, 111.0, 113.0, 122.0, 112.0, 113.0, 113.0, 110.0], "imaging-gaussian-blur": [109.0, 110.0, 110.0, 110.0, 111.0, 111.0, 110.0, 110.0, 110.0, 111.0], "audio-beat-detection": [157.0, 132.0, 156.0, 176.0, 135.0, 163.0, 157.0, 135.0, 169.0, 135.0], "json-stringify-tinderbox": [66.0, 67.0, 66.0, 67.0, 67.0, 67.0, 67.0, 68.0, 67.0, 68.0], "stanford-crypto-pbkdf2": [137.0, 139.0, 148.0, 148.0, 139.0, 143.0, 144.0, 144.0, 147.0, 147.0], "json-parse-financial": [73.0, 74.0, 75.0, 75.0, 74.0, 74.0, 84.0, 73.0, 74.0, 74.0], "stanford-crypto-sha256-iterative": [71.0, 69.0, 69.0, 72.0, 73.0, 68.0, 69.0, 73.0, 73.0, 69.0], "audio-fft": [74.0, 73.0, 73.0, 73.0, 75.0, 143.0, 74.0, 73.0, 76.0, 75.0], "imaging-darkroom": [148.0, 149.0, 148.0, 148.0, 148.0, 148.0, 149.0, 148.0, 148.0, 149.0], "stanford-crypto-ccm": [127.0, 122.0, 132.0, 124.0, 120.0, 133.0, 124.0, 122.0, 122.0, 125.0], "audio-oscillator": [92.0, 91.0, 124.0, 91.0, 92.0, 92.0, 129.0, 91.0, 92.0, 132.0], "stanford-crypto-aes": [84.0, 86.0, 85.0, 85.0, 86.0, 83.0, 95.0, 88.0, 86.0, 97.0], "imaging-desaturate": [96.0, 98.0, 99.0, 97.0, 96.0, 95.0, 95.0, 96.0, 96.0, 96.0]}, "summary": {"lowerIsBetter": true, "suite": 1536.1, "subtests": {"audio-fft": {"lowerIsBetter": true, "filtered": 80.9, "unit": "ms", "value": 80.9}, "stanford-crypto-pbkdf2": {"lowerIsBetter": true, "filtered": 143.6, "unit": "ms", "value": 143.6}, "audio-beat-detection": {"lowerIsBetter": true, "filtered": 151.5, "unit": "ms", "value": 151.5}, "stanford-crypto-ccm": {"lowerIsBetter": true, "filtered": 125.1, "unit": "ms", "value": 125.1}, "imaging-darkroom": {"lowerIsBetter": true, "filtered": 148.3, "unit": "ms", "value": 148.3}, "json-parse-financial": {"lowerIsBetter": true, "filtered": 75.0, "unit": "ms", "value": 75.0}, "audio-oscillator": {"lowerIsBetter": true, "filtered": 102.6, "unit": "ms", "value": 102.6}, "ai-astar": {"lowerIsBetter": true, "filtered": 112.6, "unit": "ms", "value": 112.6}, "audio-dft": {"lowerIsBetter": true, "filtered": 164.8, "unit": "ms", "value": 164.8}, "stanford-crypto-sha256-iterative": {"lowerIsBetter": true, "filtered": 70.6, "unit": "ms", "value": 70.6}, "json-stringify-tinderbox": {"lowerIsBetter": true, "filtered": 67.0, "unit": "ms", "value": 67.0}, "imaging-gaussian-blur": {"lowerIsBetter": true, "filtered": 110.2, "unit": "ms", "value": 110.2}, "stanford-crypto-aes": {"lowerIsBetter": true, "filtered": 87.5, "unit": "ms", "value": 87.5}, "imaging-desaturate": {"lowerIsBetter": true, "filtered": 96.4, "unit": "ms", "value": 96.4}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04.e", "os": "linux", "name": "talos-linux64-ix-032.e"}, "testrun": {"date": 1447472914, "suite": "kraken", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151113183032", "branch": "Firefox-Non-PGO", "revision": "202b199b9fcf37a687bef882f2513e191f079622"}}, {"talos_counters": {}, "results": {"DeltaBlue": [190.8761213972132], "Encrypt": [280.3476310625175], "NavierStokes": [4835.748792270531], "Decrypt": [5060.606060606061], "Splay": [599.7617629541394], "Richards": [162.73393002441009], "RegExp": [25525.0], "Earley": [722.0216606498195], "Boyer": [12207.317073170732], "RayTrace": [1075.187969924812]}, "summary": {"lowerIsBetter": false, "suite": 21400.972913759837, "subtests": {"DeltaBlue": {"lowerIsBetter": false, "filtered": 346.39220200000005, "unit": "score", "value": 346.39220200000005}, "Encrypt": {"lowerIsBetter": false, "filtered": 949.4676269999999, "unit": "score", "value": 949.4676269999999}, "NavierStokes": {"lowerIsBetter": false, "filtered": 306.881118881119, "unit": "score", "value": 306.881118881119}, "Decrypt": {"lowerIsBetter": false, "filtered": 52.59864071856286, "unit": "score", "value": 52.59864071856286}, "Splay": {"lowerIsBetter": false, "filtered": 135.87228301886793, "unit": "score", "value": 135.87228301886793}, "RegExp": {"lowerIsBetter": false, "filtered": 35.689911851126354, "unit": "score", "value": 35.689911851126354}, "Richards": {"lowerIsBetter": false, "filtered": 216.93078999999992, "unit": "score", "value": 216.93078999999992}, "Earley": {"lowerIsBetter": false, "filtered": 923.0512549999999, "unit": "score", "value": 923.0512549999999}, "Boyer": {"lowerIsBetter": false, "filtered": 54.595370629370635, "unit": "score", "value": 54.595370629370635}, "RayTrace": {"lowerIsBetter": false, "filtered": 688.2415174825175, "unit": "score", "value": 688.2415174825175}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04.e", "os": "linux", "name": "talos-linux64-ix-032.e"}, "testrun": {"date": 1447472914, "suite": "v8_7", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151113183032", "branch": "Firefox-Non-PGO", "revision": "202b199b9fcf37a687bef882f2513e191f079622"}}] 20:08:55 INFO - RETURN: dromaeo_css: 6157.98 20:08:55 INFO - RETURN: kraken: 1536.10 20:08:55 INFO - RETURN: v8_7: 21400.97 20:08:55 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,94,43]]", "result": "21400.97"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,94,43]]", "result": "1536.10"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,94,43]]", "result": "6157.98"}}} 20:08:55 INFO - Return code: 0 20:08:55 INFO - # TBPL SUCCESS # 20:08:55 INFO - Running post-action listener: _resource_record_post_action 20:08:55 INFO - Running post-run listener: _resource_record_post_run 20:08:56 INFO - Total resource usage - Wall time: 1235s; CPU: 13.0%; Read bytes: 4096; Write bytes: 509620224; Read time: 1136; Write time: 939012 20:08:56 INFO - install - Wall time: 15s; CPU: 18.0%; Read bytes: 0; Write bytes: 209784832; Read time: 0; Write time: 601188 20:08:56 INFO - run-tests - Wall time: 1221s; CPU: 13.0%; Read bytes: 4096; Write bytes: 273551360; Read time: 1136; Write time: 254472 20:08:56 INFO - Running post-run listener: _upload_blobber_files 20:08:56 INFO - Blob upload gear active. 20:08:56 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 20:08:56 INFO - Copying logs to upload dir... 20:08:56 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1263.203166 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 3 secs) (at 2015-11-13 20:08:55.974135) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-13 20:08:55.978217) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=2dd9ebcff44b3efbe7b51203000001d7-1447472871.147031-1468704545 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.010094 build_url: 'https://queue.taskcluster.net/v1/task/psBQjULQR5Sm5XOw_gCvRw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2' ========= master_lag: 0.04 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-13 20:08:56.030322) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-13 20:08:56.030646) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=2dd9ebcff44b3efbe7b51203000001d7-1447472871.147031-1468704545 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004475 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-13 20:08:56.081318) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-13 20:08:56.081625) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-13 20:08:56.081924) ========= ========= Total master_lag: 0.23 =========