builder: autoland_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-067 starttime: 1474415076.94 results: success (0) buildid: 20160920161620 builduid: cd0dcb67077e4cc992c95e923942241c revision: da03fe82ba9de1fdd59294fad5e74aa24bce3dd9 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-09-20 16:44:36.936889) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-09-20 16:44:36.937332) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-20 16:44:36.937664) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-20 16:44:36.954715) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 16:44:36.955423) ========= 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=e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-09-20 16:44:37-- 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% 38.0M=0s 2016-09-20 16:44:37 (38.0 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.069935 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 16:44:37.042033) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 16:44:37.042367) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', '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=e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.016349 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 16:44:37.093214) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 16:44:37.093925) ========= bash -c 'python archiver_client.py mozharness --repo integration/autoland --rev da03fe82ba9de1fdd59294fad5e74aa24bce3dd9 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/autoland --rev da03fe82ba9de1fdd59294fad5e74aa24bce3dd9 --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=e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-09-20 16:44:37,470 truncating revision to first 12 chars 2016-09-20 16:44:37,470 Setting DEBUG logging. 2016-09-20 16:44:37,470 attempt 1/10 2016-09-20 16:44:37,470 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/autoland/da03fe82ba9d?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-09-20 16:44:37,827 unpacking tar archive at: autoland-da03fe82ba9d/testing/mozharness/ program finished with exit code 0 elapsedTime=0.689821 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 16:44:37.797410) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-20 16:44:37.797746) ========= script_repo_revision: da03fe82ba9de1fdd59294fad5e74aa24bce3dd9 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-20 16:44:37.798161) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-20 16:44:37.798523) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-20 16:44:37.809106) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 34 secs) (at 2016-09-20 16:44:37.809437) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Autoland --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Autoland 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', '--add-option', '--webServer,localhost', '--branch-name', 'Autoland', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Autoland'] 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=e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 16:44:38 INFO - MultiFileLogger online at 20160920 16:44:38 in /builds/slave/test 16:44:38 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Autoland --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Autoland 16:44:38 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 16:44:38 INFO - {'append_to_log': False, 16:44:38 INFO - 'base_work_dir': '/builds/slave/test', 16:44:38 INFO - 'blob_upload_branch': 'Autoland', 16:44:38 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 16:44:38 INFO - 'branch': 'Autoland', 16:44:38 INFO - 'buildbot_json_path': 'buildprops.json', 16:44:38 INFO - 'config_files': ('talos/linux_config.py',), 16:44:38 INFO - 'default_actions': ('clobber', 16:44:38 INFO - 'read-buildbot-config', 16:44:38 INFO - 'download-and-extract', 16:44:38 INFO - 'populate-webroot', 16:44:38 INFO - 'create-virtualenv', 16:44:38 INFO - 'install', 16:44:38 INFO - 'run-tests'), 16:44:38 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 16:44:38 INFO - 'download_minidump_stackwalk': True, 16:44:38 INFO - 'download_symbols': 'ondemand', 16:44:38 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 16:44:38 INFO - 'tooltool.py': '/tools/tooltool.py', 16:44:38 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 16:44:38 INFO - '/tools/misc-python/virtualenv.py')}, 16:44:38 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 16:44:38 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 16:44:38 INFO - 'installer_path': 'installer.exe', 16:44:38 INFO - 'log_level': 'info', 16:44:38 INFO - 'log_name': 'talos', 16:44:38 INFO - 'log_to_console': True, 16:44:38 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 16:44:38 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 16:44:38 INFO - 'opt_config_files': (), 16:44:38 INFO - 'pip_index': False, 16:44:38 INFO - 'sps_profile': False, 16:44:38 INFO - 'sps_profile_interval': 0, 16:44:38 INFO - 'suite': 'dromaeojs', 16:44:38 INFO - 'system_bits': '32', 16:44:38 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 16:44:38 INFO - 'title': 'talos-linux64-ix-067', 16:44:38 INFO - 'tooltool_cache': '/builds/tooltool_cache', 16:44:38 INFO - 'use_talos_json': True, 16:44:38 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 16:44:38 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 16:44:38 INFO - 'work_dir': 'build'} 16:44:38 INFO - [mozharness: 2016-09-20 23:44:38.273254Z] Running clobber step. 16:44:38 INFO - Running pre-action listener: _resource_record_pre_action 16:44:38 INFO - Running main action method: clobber 16:44:38 INFO - rmtree: /builds/slave/test/build 16:44:38 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 16:44:38 INFO - Running post-action listener: _resource_record_post_action 16:44:38 INFO - [mozharness: 2016-09-20 23:44:38.735057Z] Finished clobber step (success) 16:44:38 INFO - [mozharness: 2016-09-20 23:44:38.735158Z] Running read-buildbot-config step. 16:44:38 INFO - Running pre-action listener: _resource_record_pre_action 16:44:38 INFO - Running main action method: read_buildbot_config 16:44:38 INFO - Using buildbot properties: 16:44:38 INFO - { 16:44:38 INFO - "project": "", 16:44:38 INFO - "product": "firefox", 16:44:38 INFO - "script_repo_revision": "production", 16:44:38 INFO - "builddir": "autoland_ubuntu64_hw_test-dromaeojs", 16:44:38 INFO - "repository": "", 16:44:38 INFO - "buildername": "Ubuntu HW 12.04 x64 autoland pgo talos dromaeojs", 16:44:38 INFO - "buildid": "20160920161620", 16:44:38 INFO - "stage_platform": "linux64-pgo", 16:44:38 INFO - "basedir": "/builds/slave/test", 16:44:38 INFO - "buildnumber": 226, 16:44:38 INFO - "platform": "ubuntu64_hw", 16:44:38 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 16:44:38 INFO - "slavebuilddir": "test", 16:44:38 INFO - "branch": "autoland", 16:44:38 INFO - "revision": "da03fe82ba9de1fdd59294fad5e74aa24bce3dd9", 16:44:38 INFO - "slavename": "talos-linux64-ix-067", 16:44:38 INFO - "builduid": "cd0dcb67077e4cc992c95e923942241c", 16:44:38 INFO - "repo_path": "integration/autoland" 16:44:38 INFO - } 16:44:38 INFO - Found installer url https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1474406203/firefox-51.0a1.en-US.linux-x86_64.tar.bz2. 16:44:38 INFO - Found a test packages url https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1474406203/firefox-51.0a1.en-US.linux-x86_64.test_packages.json. 16:44:38 INFO - Running post-action listener: _resource_record_post_action 16:44:38 INFO - [mozharness: 2016-09-20 23:44:38.737498Z] Finished read-buildbot-config step (success) 16:44:38 INFO - [mozharness: 2016-09-20 23:44:38.737585Z] Running download-and-extract step. 16:44:38 INFO - Running pre-action listener: _resource_record_pre_action 16:44:38 INFO - Running main action method: download_and_extract 16:44:38 INFO - mkdir: /builds/slave/test/build/tests 16:44:38 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:44:38 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1474406203/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 16:44:38 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1474406203/firefox-51.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 16:44:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1474406203/firefox-51.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 16:44:38 INFO - Downloaded 1361 bytes. 16:44:38 INFO - Reading from file /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 16:44:38 INFO - Using the following test package requirements: 16:44:38 INFO - {u'common': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 16:44:38 INFO - u'cppunittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 16:44:38 INFO - u'firefox-51.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 16:44:38 INFO - u'gtest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 16:44:38 INFO - u'firefox-51.0a1.en-US.linux-x86_64.gtest.tests.zip'], 16:44:38 INFO - u'jittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 16:44:38 INFO - u'jsshell-linux-x86_64.zip'], 16:44:38 INFO - u'mochitest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 16:44:38 INFO - u'firefox-51.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 16:44:38 INFO - u'mozbase': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 16:44:38 INFO - u'reftest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 16:44:38 INFO - u'firefox-51.0a1.en-US.linux-x86_64.reftest.tests.zip'], 16:44:38 INFO - u'talos': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 16:44:38 INFO - u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'], 16:44:38 INFO - u'web-platform': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 16:44:38 INFO - u'firefox-51.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 16:44:38 INFO - u'xpcshell': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 16:44:38 INFO - u'firefox-51.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 16:44:38 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 16:44:38 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:44:38 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1474406203/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 16:44:38 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1474406203/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 16:44:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1474406203/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 16:44:39 INFO - Downloaded 21906922 bytes. 16:44:39 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/tests 16:44:43 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 16:44:43 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:44:43 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1474406203/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 16:44:43 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1474406203/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 16:44:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1474406203/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 16:44:43 INFO - Downloaded 21906922 bytes. 16:44:43 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/tests 16:44:48 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:44:48 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1474406203/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 16:44:48 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1474406203/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 16:44:48 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1474406203/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 16:44:48 INFO - Downloaded 14413719 bytes. 16:44:48 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/tests 16:44:48 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:44:48 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1474406203/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 16:44:48 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1474406203/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 16:44:48 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1474406203/firefox-51.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 16:44:49 INFO - Downloaded 59600187 bytes. 16:44:49 INFO - Setting buildbot property build_url to https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1474406203/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 16:44:49 INFO - mkdir: /builds/slave/test/properties 16:44:49 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 16:44:49 INFO - Writing to file /builds/slave/test/properties/build_url 16:44:49 INFO - Contents: 16:44:49 INFO - build_url:https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1474406203/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 16:44:50 INFO - Running post-action listener: _resource_record_post_action 16:44:50 INFO - Running post-action listener: set_extra_try_arguments 16:44:50 INFO - [mozharness: 2016-09-20 23:44:50.029982Z] Finished download-and-extract step (success) 16:44:50 INFO - [mozharness: 2016-09-20 23:44:50.030208Z] Running populate-webroot step. 16:44:50 INFO - Running pre-action listener: _resource_record_pre_action 16:44:50 INFO - Running main action method: populate_webroot 16:44:50 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 16:44:50 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 16:44:50 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 16:44:50 INFO - '--tppagecycles', 16:44:50 INFO - '7'], 16:44:50 INFO - 'tests': ['tsvgm']}}, 16:44:50 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 16:44:50 INFO - 'tests': ['tresize', 'tcanvasmark']}, 16:44:50 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 16:44:50 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 16:44:50 INFO - 'tests': ['dromaeo_css', 'kraken']}, 16:44:50 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 16:44:50 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:44:50 INFO - 'talos_options': ['--disable-e10s'], 16:44:50 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:44:50 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:44:50 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:44:50 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:44:50 INFO - 'talos_options': ['--disable-e10s'], 16:44:50 INFO - 'tests': ['damp', 'tps']}, 16:44:50 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:44:50 INFO - 'tests': ['damp', 'tps']}, 16:44:50 INFO - 'g3': {'talos_options': ['--disable-e10s'], 16:44:50 INFO - 'tests': ['dromaeo_dom']}, 16:44:50 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 16:44:50 INFO - 'g4': {'talos_options': ['--disable-e10s'], 16:44:50 INFO - 'tests': ['basic_compositor_video']}, 16:44:50 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 16:44:50 INFO - 'other': {'talos_options': ['--disable-e10s'], 16:44:50 INFO - 'tests': ['a11yr', 16:44:50 INFO - 'ts_paint', 16:44:50 INFO - 'tpaint', 16:44:50 INFO - 'sessionrestore', 16:44:50 INFO - 'sessionrestore_no_auto_restore', 16:44:50 INFO - 'tabpaint']}, 16:44:50 INFO - 'other-e10s': {'tests': ['a11yr', 16:44:50 INFO - 'ts_paint', 16:44:50 INFO - 'tpaint', 16:44:50 INFO - 'sessionrestore', 16:44:50 INFO - 'sessionrestore_no_auto_restore', 16:44:50 INFO - 'tabpaint']}, 16:44:50 INFO - 'other-e10s_l64': {'tests': ['a11yr', 16:44:50 INFO - 'ts_paint', 16:44:50 INFO - 'tpaint', 16:44:50 INFO - 'sessionrestore', 16:44:50 INFO - 'sessionrestore_no_auto_restore', 16:44:50 INFO - 'tabpaint']}, 16:44:50 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 16:44:50 INFO - 'ts_paint', 16:44:50 INFO - 'tpaint', 16:44:50 INFO - 'sessionrestore', 16:44:50 INFO - 'sessionrestore_no_auto_restore', 16:44:50 INFO - 'tabpaint']}, 16:44:50 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 16:44:50 INFO - 'tests': ['a11yr', 16:44:50 INFO - 'ts_paint', 16:44:50 INFO - 'tpaint', 16:44:50 INFO - 'sessionrestore', 16:44:50 INFO - 'sessionrestore_no_auto_restore', 16:44:50 INFO - 'tabpaint']}, 16:44:50 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 16:44:50 INFO - 'tests': ['a11yr', 16:44:50 INFO - 'ts_paint', 16:44:50 INFO - 'tpaint', 16:44:50 INFO - 'sessionrestore', 16:44:50 INFO - 'sessionrestore_no_auto_restore', 16:44:50 INFO - 'tabpaint']}, 16:44:50 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 16:44:50 INFO - 'tests': ['tsvgx', 16:44:50 INFO - 'tsvgr_opacity', 16:44:50 INFO - 'tart', 16:44:50 INFO - 'tscrollx', 16:44:50 INFO - 'cart']}, 16:44:50 INFO - 'svgr-e10s': {'tests': ['tsvgx', 16:44:50 INFO - 'tsvgr_opacity', 16:44:50 INFO - 'tart', 16:44:50 INFO - 'tscrollx', 16:44:50 INFO - 'cart']}, 16:44:50 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:44:50 INFO - 'talos_options': ['--disable-e10s'], 16:44:50 INFO - 'tests': ['tp5o']}, 16:44:50 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:44:50 INFO - 'tests': ['tp5o']}, 16:44:50 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:44:50 INFO - 'talos_options': ['--disable-e10s', 16:44:50 INFO - '--xperf_path', 16:44:50 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:44:50 INFO - 'tests': ['tp5n']}, 16:44:50 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:44:50 INFO - 'talos_options': ['--xperf_path', 16:44:50 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:44:50 INFO - 'tests': ['tp5n']}}, 16:44:50 INFO - 'talos.zip': {'path': '', 16:44:50 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 16:44:50 INFO - Running post-action listener: _resource_record_post_action 16:44:50 INFO - [mozharness: 2016-09-20 23:44:50.051882Z] Finished populate-webroot step (success) 16:44:50 INFO - [mozharness: 2016-09-20 23:44:50.051971Z] Running create-virtualenv step. 16:44:50 INFO - Running pre-action listener: _resource_record_pre_action 16:44:50 INFO - Running main action method: create_virtualenv 16:44:50 INFO - Creating virtualenv /builds/slave/test/build/venv 16:44:50 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 16:44:50 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 16:44:50 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 16:44:50 INFO - Using real prefix '/usr' 16:44:50 INFO - New python executable in /builds/slave/test/build/venv/bin/python 16:44:50 INFO - Installing distribute.............................................................................................................................................................................................done. 16:44:52 INFO - Installing pip.................done. 16:44:52 INFO - Return code: 0 16:44:52 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 16:44:52 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:44:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:44:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:44:52 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:44:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:44:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:44:52 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x7f296466ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc3f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd0c850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd07370>, '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 0xd0a8f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd0ad80>, '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': 'e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775', '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 16:44:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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 16:44:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 16:44:52 INFO - Using env: {'DISPLAY': ':0', 16:44:52 INFO - 'HOME': '/home/cltbld', 16:44:52 INFO - 'LANG': 'en_US.UTF-8', 16:44:52 INFO - 'LANGUAGE': 'en_US:en', 16:44:52 INFO - 'LOGNAME': 'cltbld', 16:44:52 INFO - 'MAIL': '/var/mail/cltbld', 16:44:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:44:52 INFO - 'MOZ_NO_REMOTE': '1', 16:44:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:44:52 INFO - 'NO_EM_RESTART': '1', 16:44:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:44:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:44:52 INFO - 'PWD': '/builds/slave/test', 16:44:52 INFO - 'SHELL': '/bin/bash', 16:44:52 INFO - 'SHLVL': '1', 16:44:52 INFO - 'TERM': 'linux', 16:44:52 INFO - 'TMOUT': '86400', 16:44:52 INFO - 'USER': 'cltbld', 16:44:52 INFO - 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775', 16:44:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:44:52 INFO - '_': '/tools/buildbot/bin/python'} 16:44:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:44:52 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 16:44:52 INFO - Cleaning up... 16:44:52 INFO - Return code: 0 16:44:52 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 16:44:52 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:44:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:44:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:44:52 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:44:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:44:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:44:52 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f296466ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc3f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd0c850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd07370>, '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 0xd0a8f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd0ad80>, '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': 'e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775', '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 16:44:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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>=3.1.1'] in /builds/slave/test/build 16:44:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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>=3.1.1 16:44:52 INFO - Using env: {'DISPLAY': ':0', 16:44:52 INFO - 'HOME': '/home/cltbld', 16:44:52 INFO - 'LANG': 'en_US.UTF-8', 16:44:52 INFO - 'LANGUAGE': 'en_US:en', 16:44:52 INFO - 'LOGNAME': 'cltbld', 16:44:52 INFO - 'MAIL': '/var/mail/cltbld', 16:44:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:44:52 INFO - 'MOZ_NO_REMOTE': '1', 16:44:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:44:52 INFO - 'NO_EM_RESTART': '1', 16:44:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:44:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:44:52 INFO - 'PWD': '/builds/slave/test', 16:44:52 INFO - 'SHELL': '/bin/bash', 16:44:52 INFO - 'SHLVL': '1', 16:44:52 INFO - 'TERM': 'linux', 16:44:52 INFO - 'TMOUT': '86400', 16:44:52 INFO - 'USER': 'cltbld', 16:44:52 INFO - 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775', 16:44:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:44:52 INFO - '_': '/tools/buildbot/bin/python'} 16:44:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:44:53 INFO - Downloading/unpacking psutil>=3.1.1 16:44:53 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 16:44:53 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 16:44:53 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 16:44:53 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 16:44:53 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 16:44:53 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 16:44:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 16:44:55 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:44:55 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:44:55 INFO - Installing collected packages: psutil 16:44:55 INFO - Running setup.py install for psutil 16:44:55 INFO - building 'psutil._psutil_linux' extension 16:44:55 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 16:44:55 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 16:44:55 INFO - building 'psutil._psutil_posix' extension 16:44:55 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 16:44:55 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 16:44:55 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:44:55 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:44:55 INFO - Successfully installed psutil 16:44:55 INFO - Cleaning up... 16:44:55 INFO - Return code: 0 16:44:55 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 16:44:55 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:44:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:44:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:44:55 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:44:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:44:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:44:55 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f296466ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc3f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd0c850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd07370>, '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 0xd0a8f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd0ad80>, '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': 'e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775', '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 16:44:55 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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.3'] in /builds/slave/test/build 16:44:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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.3 16:44:55 INFO - Using env: {'DISPLAY': ':0', 16:44:55 INFO - 'HOME': '/home/cltbld', 16:44:55 INFO - 'LANG': 'en_US.UTF-8', 16:44:55 INFO - 'LANGUAGE': 'en_US:en', 16:44:55 INFO - 'LOGNAME': 'cltbld', 16:44:55 INFO - 'MAIL': '/var/mail/cltbld', 16:44:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:44:55 INFO - 'MOZ_NO_REMOTE': '1', 16:44:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:44:55 INFO - 'NO_EM_RESTART': '1', 16:44:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:44:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:44:55 INFO - 'PWD': '/builds/slave/test', 16:44:55 INFO - 'SHELL': '/bin/bash', 16:44:55 INFO - 'SHLVL': '1', 16:44:55 INFO - 'TERM': 'linux', 16:44:55 INFO - 'TMOUT': '86400', 16:44:55 INFO - 'USER': 'cltbld', 16:44:55 INFO - 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775', 16:44:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:44:55 INFO - '_': '/tools/buildbot/bin/python'} 16:44:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:44:55 INFO - Downloading/unpacking mozsystemmonitor==0.3 16:44:55 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 16:44:55 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 16:44:55 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 16:44:55 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 16:44:55 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 16:44:55 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 16:44:57 INFO - Downloading mozsystemmonitor-0.3.tar.gz 16:44:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 16:44:57 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 16:44:57 INFO - Installing collected packages: mozsystemmonitor 16:44:57 INFO - Running setup.py install for mozsystemmonitor 16:44:57 INFO - Successfully installed mozsystemmonitor 16:44:57 INFO - Cleaning up... 16:44:57 INFO - Return code: 0 16:44:57 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 16:44:57 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:44:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:44:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:44:57 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:44:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:44:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:44:57 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f296466ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc3f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd0c850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd07370>, '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 0xd0a8f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd0ad80>, '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': 'e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775', '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 16:44:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'jsonschema==2.5.1'] in /builds/slave/test/build 16:44:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 jsonschema==2.5.1 16:44:57 INFO - Using env: {'DISPLAY': ':0', 16:44:57 INFO - 'HOME': '/home/cltbld', 16:44:57 INFO - 'LANG': 'en_US.UTF-8', 16:44:57 INFO - 'LANGUAGE': 'en_US:en', 16:44:57 INFO - 'LOGNAME': 'cltbld', 16:44:57 INFO - 'MAIL': '/var/mail/cltbld', 16:44:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:44:57 INFO - 'MOZ_NO_REMOTE': '1', 16:44:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:44:57 INFO - 'NO_EM_RESTART': '1', 16:44:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:44:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:44:57 INFO - 'PWD': '/builds/slave/test', 16:44:57 INFO - 'SHELL': '/bin/bash', 16:44:57 INFO - 'SHLVL': '1', 16:44:57 INFO - 'TERM': 'linux', 16:44:57 INFO - 'TMOUT': '86400', 16:44:57 INFO - 'USER': 'cltbld', 16:44:57 INFO - 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775', 16:44:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:44:57 INFO - '_': '/tools/buildbot/bin/python'} 16:44:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:44:58 INFO - Downloading/unpacking jsonschema==2.5.1 16:44:58 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 16:44:58 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 16:44:58 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 16:44:58 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 16:44:58 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 16:44:58 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 16:45:00 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 16:45:00 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 16:45:00 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 16:45:00 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 16:45:00 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 16:45:00 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 16:45:00 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 16:45:00 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 16:45:00 INFO - Downloading functools32-3.2.3-2.tar.gz 16:45:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 16:45:00 INFO - warning: no files found matching '*.txt' 16:45:00 INFO - no previously-included directories found matching 'build' 16:45:00 INFO - no previously-included directories found matching 'dist' 16:45:00 INFO - no previously-included directories found matching '.git*' 16:45:00 INFO - Installing collected packages: jsonschema, functools32 16:45:00 INFO - Running setup.py install for functools32 16:45:00 INFO - warning: no files found matching '*.txt' 16:45:00 INFO - no previously-included directories found matching 'build' 16:45:00 INFO - no previously-included directories found matching 'dist' 16:45:00 INFO - no previously-included directories found matching '.git*' 16:45:00 INFO - Successfully installed jsonschema functools32 16:45:00 INFO - Cleaning up... 16:45:00 INFO - Return code: 0 16:45:00 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 16:45: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:45:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:45:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:45: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:45:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:45:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:45:00 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f296466ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc3f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd0c850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd07370>, '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 0xd0a8f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd0ad80>, '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': 'e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775', '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 16:45:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'functools32==3.2.3-2'] in /builds/slave/test/build 16:45:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 functools32==3.2.3-2 16:45:00 INFO - Using env: {'DISPLAY': ':0', 16:45:00 INFO - 'HOME': '/home/cltbld', 16:45:00 INFO - 'LANG': 'en_US.UTF-8', 16:45:00 INFO - 'LANGUAGE': 'en_US:en', 16:45:00 INFO - 'LOGNAME': 'cltbld', 16:45:00 INFO - 'MAIL': '/var/mail/cltbld', 16:45:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:45:00 INFO - 'MOZ_NO_REMOTE': '1', 16:45:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:45:00 INFO - 'NO_EM_RESTART': '1', 16:45:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:45:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:45:00 INFO - 'PWD': '/builds/slave/test', 16:45:00 INFO - 'SHELL': '/bin/bash', 16:45:00 INFO - 'SHLVL': '1', 16:45:00 INFO - 'TERM': 'linux', 16:45:00 INFO - 'TMOUT': '86400', 16:45:00 INFO - 'USER': 'cltbld', 16:45:00 INFO - 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775', 16:45:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:45:00 INFO - '_': '/tools/buildbot/bin/python'} 16:45:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:45:00 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 16:45:00 INFO - Cleaning up... 16:45:00 INFO - Return code: 0 16:45:00 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 16:45: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:45:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:45:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:45: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:45:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:45:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:45:00 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x7f296466ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc3f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd0c850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd07370>, '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 0xd0a8f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd0ad80>, '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': 'e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775', '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 16:45:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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 16:45:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 16:45:00 INFO - Using env: {'DISPLAY': ':0', 16:45:00 INFO - 'HOME': '/home/cltbld', 16:45:00 INFO - 'LANG': 'en_US.UTF-8', 16:45:00 INFO - 'LANGUAGE': 'en_US:en', 16:45:00 INFO - 'LOGNAME': 'cltbld', 16:45:00 INFO - 'MAIL': '/var/mail/cltbld', 16:45:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:45:00 INFO - 'MOZ_NO_REMOTE': '1', 16:45:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:45:00 INFO - 'NO_EM_RESTART': '1', 16:45:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:45:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:45:00 INFO - 'PWD': '/builds/slave/test', 16:45:00 INFO - 'SHELL': '/bin/bash', 16:45:00 INFO - 'SHLVL': '1', 16:45:00 INFO - 'TERM': 'linux', 16:45:00 INFO - 'TMOUT': '86400', 16:45:00 INFO - 'USER': 'cltbld', 16:45:00 INFO - 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775', 16:45:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:45:00 INFO - '_': '/tools/buildbot/bin/python'} 16:45:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:45:00 INFO - Downloading/unpacking blobuploader==1.2.4 16:45:00 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 16:45:00 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 16:45:00 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 16:45:00 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 16:45:00 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 16:45:00 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 16:45:02 INFO - Downloading blobuploader-1.2.4.tar.gz 16:45:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 16:45:02 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 16:45:02 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 16:45:02 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 16:45:02 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 16:45:02 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 16:45:02 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 16:45:02 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 16:45:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 16:45:03 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 16:45:03 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 16:45:03 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 16:45:03 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 16:45:03 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 16:45:03 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 16:45:03 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 16:45:03 INFO - Downloading docopt-0.6.1.tar.gz 16:45:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 16:45:03 INFO - Installing collected packages: blobuploader, requests, docopt 16:45:03 INFO - Running setup.py install for blobuploader 16:45:03 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 16:45:03 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 16:45:03 INFO - Running setup.py install for requests 16:45:04 INFO - Running setup.py install for docopt 16:45:04 INFO - Successfully installed blobuploader requests docopt 16:45:04 INFO - Cleaning up... 16:45:04 INFO - Return code: 0 16:45:04 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:45: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:45:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:45:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:45: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:45:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:45:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:45:04 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--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 0x7f296466ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc3f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd0c850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd07370>, '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 0xd0a8f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd0ad80>, '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': 'e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775', '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 16:45:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--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 16:45:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --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 16:45:04 INFO - Using env: {'DISPLAY': ':0', 16:45:04 INFO - 'HOME': '/home/cltbld', 16:45:04 INFO - 'LANG': 'en_US.UTF-8', 16:45:04 INFO - 'LANGUAGE': 'en_US:en', 16:45:04 INFO - 'LOGNAME': 'cltbld', 16:45:04 INFO - 'MAIL': '/var/mail/cltbld', 16:45:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:45:04 INFO - 'MOZ_NO_REMOTE': '1', 16:45:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:45:04 INFO - 'NO_EM_RESTART': '1', 16:45:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:45:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:45:04 INFO - 'PWD': '/builds/slave/test', 16:45:04 INFO - 'SHELL': '/bin/bash', 16:45:04 INFO - 'SHLVL': '1', 16:45:04 INFO - 'TERM': 'linux', 16:45:04 INFO - 'TMOUT': '86400', 16:45:04 INFO - 'USER': 'cltbld', 16:45:04 INFO - 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775', 16:45:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:45:04 INFO - '_': '/tools/buildbot/bin/python'} 16:45:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:45:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:45:04 INFO - Running setup.py (path:/tmp/pip-Ig4_eQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:45:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:45:04 INFO - Running setup.py (path:/tmp/pip-QvmWcR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:45:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:45:04 INFO - Running setup.py (path:/tmp/pip-9bywif-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:45:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:45:04 INFO - Running setup.py (path:/tmp/pip-v8p4Im-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:45:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:45:04 INFO - Running setup.py (path:/tmp/pip-nEDyUC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:45:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:45:04 INFO - Running setup.py (path:/tmp/pip-aaE1RK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:45:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:45:04 INFO - Running setup.py (path:/tmp/pip-MJZL1A-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:45:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:45:04 INFO - Running setup.py (path:/tmp/pip-AZ1zSu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:45:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:45:04 INFO - Running setup.py (path:/tmp/pip-35kD3y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:45:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:45:05 INFO - Running setup.py (path:/tmp/pip-9vsieu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:45:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:45:05 INFO - Running setup.py (path:/tmp/pip-v1mgNc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:45:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:45:05 INFO - Running setup.py (path:/tmp/pip-_e31XG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:45:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:45:05 INFO - Running setup.py (path:/tmp/pip-KvAskW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:45:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:45:05 INFO - Running setup.py (path:/tmp/pip-Csh05j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:45:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:45:05 INFO - Running setup.py (path:/tmp/pip-cFRUnT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:45:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:45:05 INFO - Running setup.py (path:/tmp/pip-ye7QSd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:45:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:45:05 INFO - Running setup.py (path:/tmp/pip-KxgJ1m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:45:05 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 16:45:05 INFO - Running setup.py install for manifestparser 16:45:05 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 16:45:05 INFO - Running setup.py install for mozcrash 16:45:05 INFO - Running setup.py install for mozdebug 16:45:05 INFO - Running setup.py install for mozdevice 16:45:06 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 16:45:06 INFO - Installing dm script to /builds/slave/test/build/venv/bin 16:45:06 INFO - Running setup.py install for mozfile 16:45:06 INFO - Running setup.py install for mozhttpd 16:45:06 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 16:45:06 INFO - Running setup.py install for mozinfo 16:45:06 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 16:45:06 INFO - Running setup.py install for mozInstall 16:45:06 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 16:45:06 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 16:45:06 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 16:45:06 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 16:45:06 INFO - Running setup.py install for mozleak 16:45:06 INFO - Running setup.py install for mozlog 16:45:06 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 16:45:06 INFO - Running setup.py install for moznetwork 16:45:06 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 16:45:06 INFO - Running setup.py install for mozprocess 16:45:06 INFO - Running setup.py install for mozprofile 16:45:06 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 16:45:06 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 16:45:06 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 16:45:06 INFO - Running setup.py install for mozrunner 16:45:07 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 16:45:07 INFO - Running setup.py install for mozscreenshot 16:45:07 INFO - Running setup.py install for moztest 16:45:07 INFO - Running setup.py install for mozversion 16:45:07 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 16:45:07 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 16:45:07 INFO - Cleaning up... 16:45:07 INFO - Return code: 0 16:45:07 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:45: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:45:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:45:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:45: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:45:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:45:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:45:07 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x7f296466ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc3f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd0c850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd07370>, '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 0xd0a8f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd0ad80>, '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': 'e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775', '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 16:45:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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 16:45:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 16:45:07 INFO - Using env: {'DISPLAY': ':0', 16:45:07 INFO - 'HOME': '/home/cltbld', 16:45:07 INFO - 'LANG': 'en_US.UTF-8', 16:45:07 INFO - 'LANGUAGE': 'en_US:en', 16:45:07 INFO - 'LOGNAME': 'cltbld', 16:45:07 INFO - 'MAIL': '/var/mail/cltbld', 16:45:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:45:07 INFO - 'MOZ_NO_REMOTE': '1', 16:45:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:45:07 INFO - 'NO_EM_RESTART': '1', 16:45:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:45:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:45:07 INFO - 'PWD': '/builds/slave/test', 16:45:07 INFO - 'SHELL': '/bin/bash', 16:45:07 INFO - 'SHLVL': '1', 16:45:07 INFO - 'TERM': 'linux', 16:45:07 INFO - 'TMOUT': '86400', 16:45:07 INFO - 'USER': 'cltbld', 16:45:07 INFO - 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775', 16:45:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:45:07 INFO - '_': '/tools/buildbot/bin/python'} 16:45:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:45:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:45:07 INFO - Running setup.py (path:/tmp/pip-vNYNX7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:45:07 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)) 16:45:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:45:07 INFO - Running setup.py (path:/tmp/pip-OIfFSa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:45:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 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)) 16:45:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:45:07 INFO - Running setup.py (path:/tmp/pip-g67Nf3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:45:07 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)) 16:45:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:45:07 INFO - Running setup.py (path:/tmp/pip-sCTg3u-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:45:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 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)) 16:45:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:45:07 INFO - Running setup.py (path:/tmp/pip-AEhRpZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:45:08 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)) 16:45:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:45:08 INFO - Running setup.py (path:/tmp/pip-OKHktX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:45:08 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)) 16:45:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:45:08 INFO - Running setup.py (path:/tmp/pip-_hwF8K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:45:08 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)) 16:45:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:45:08 INFO - Running setup.py (path:/tmp/pip-8QOv7Q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:45:08 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)) 16:45:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:45:08 INFO - Running setup.py (path:/tmp/pip-4qk1jU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:45:08 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)) 16:45:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:45:08 INFO - Running setup.py (path:/tmp/pip-EGxC55-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:45:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.3 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)) 16:45:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:45:08 INFO - Running setup.py (path:/tmp/pip-F7u1hW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:45:08 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)) 16:45:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:45:08 INFO - Running setup.py (path:/tmp/pip-6JfV0W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:45:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 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)) 16:45:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:45:08 INFO - Running setup.py (path:/tmp/pip-vGnHi4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:45:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 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)) 16:45:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:45:08 INFO - Running setup.py (path:/tmp/pip-5PacN_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:45:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 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)) 16:45:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:45:08 INFO - Running setup.py (path:/tmp/pip-sNcai8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:45:08 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)) 16:45:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:45:08 INFO - Running setup.py (path:/tmp/pip-A8m6dl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:45:08 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)) 16:45:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:45:08 INFO - Running setup.py (path:/tmp/pip-qceZCB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:45:08 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)) 16:45:08 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.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 16:45:08 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.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 16:45:08 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)) 16:45:08 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.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 16:45:08 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.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 16:45:08 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 16:45:08 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 16:45:08 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 16:45:08 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 16:45:08 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 16:45:08 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 16:45:08 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 16:45:10 INFO - Downloading blessings-1.6.tar.gz 16:45:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 16:45:10 INFO - Installing collected packages: blessings 16:45:10 INFO - Running setup.py install for blessings 16:45:10 INFO - Successfully installed blessings 16:45:10 INFO - Cleaning up... 16:45:11 INFO - Return code: 0 16:45:11 INFO - Done creating virtualenv /builds/slave/test/build/venv. 16:45:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:45:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:45:11 INFO - Reading from file tmpfile_stdout 16:45:11 INFO - Current package versions: 16:45:11 INFO - argparse == 1.2.1 16:45:11 INFO - blessings == 1.6 16:45:11 INFO - blobuploader == 1.2.4 16:45:11 INFO - docopt == 0.6.1 16:45:11 INFO - functools32 == 3.2.3-2 16:45:11 INFO - jsonschema == 2.5.1 16:45:11 INFO - manifestparser == 1.1 16:45:11 INFO - mozInstall == 1.12 16:45:11 INFO - mozcrash == 0.17 16:45:11 INFO - mozdebug == 0.1 16:45:11 INFO - mozdevice == 0.48 16:45:11 INFO - mozfile == 1.2 16:45:11 INFO - mozhttpd == 0.7 16:45:11 INFO - mozinfo == 0.9 16:45:11 INFO - mozleak == 0.1 16:45:11 INFO - mozlog == 3.3 16:45:11 INFO - moznetwork == 0.27 16:45:11 INFO - mozprocess == 0.23 16:45:11 INFO - mozprofile == 0.28 16:45:11 INFO - mozrunner == 6.12 16:45:11 INFO - mozscreenshot == 0.1 16:45:11 INFO - mozsystemmonitor == 0.3 16:45:11 INFO - moztest == 0.7 16:45:11 INFO - mozversion == 1.4 16:45:11 INFO - psutil == 3.1.1 16:45:11 INFO - requests == 1.2.3 16:45:11 INFO - wsgiref == 0.1.2 16:45:11 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:45:11 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:45:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:45:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:45:11 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:45:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:45:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:45:11 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x7f296466ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc3f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd0c850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd07370>, '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 0xd0a8f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd0ad80>, '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': 'e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775', '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 16:45:11 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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 16:45:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 16:45:11 INFO - Using env: {'DISPLAY': ':0', 16:45:11 INFO - 'HOME': '/home/cltbld', 16:45:11 INFO - 'LANG': 'en_US.UTF-8', 16:45:11 INFO - 'LANGUAGE': 'en_US:en', 16:45:11 INFO - 'LOGNAME': 'cltbld', 16:45:11 INFO - 'MAIL': '/var/mail/cltbld', 16:45:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:45:11 INFO - 'MOZ_NO_REMOTE': '1', 16:45:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:45:11 INFO - 'NO_EM_RESTART': '1', 16:45:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:45:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:45:11 INFO - 'PWD': '/builds/slave/test', 16:45:11 INFO - 'SHELL': '/bin/bash', 16:45:11 INFO - 'SHLVL': '1', 16:45:11 INFO - 'TERM': 'linux', 16:45:11 INFO - 'TMOUT': '86400', 16:45:11 INFO - 'USER': 'cltbld', 16:45:11 INFO - 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775', 16:45:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:45:11 INFO - '_': '/tools/buildbot/bin/python'} 16:45:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:45:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 16:45:11 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 2)) 16:45:11 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 3)) 16:45:11 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 4)) 16:45:11 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 5)) 16:45:11 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 6)) 16:45:11 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 7)) 16:45:11 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 8)) 16:45:11 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 9)) 16:45:11 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.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 16:45:11 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 4)) 16:45:11 INFO - Cleaning up... 16:45:11 INFO - Return code: 0 16:45:11 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 16:45:11 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:45:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:45:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:45:11 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:45:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:45:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:45:11 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f296466ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc3f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd0c850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd07370>, '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 0xd0a8f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd0ad80>, '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': 'e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775', '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 16:45:11 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'jsonschema'] in /builds/slave/test/build 16:45:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 jsonschema 16:45:11 INFO - Using env: {'DISPLAY': ':0', 16:45:11 INFO - 'HOME': '/home/cltbld', 16:45:11 INFO - 'LANG': 'en_US.UTF-8', 16:45:11 INFO - 'LANGUAGE': 'en_US:en', 16:45:11 INFO - 'LOGNAME': 'cltbld', 16:45:11 INFO - 'MAIL': '/var/mail/cltbld', 16:45:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:45:11 INFO - 'MOZ_NO_REMOTE': '1', 16:45:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:45:11 INFO - 'NO_EM_RESTART': '1', 16:45:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:45:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:45:11 INFO - 'PWD': '/builds/slave/test', 16:45:11 INFO - 'SHELL': '/bin/bash', 16:45:11 INFO - 'SHLVL': '1', 16:45:11 INFO - 'TERM': 'linux', 16:45:11 INFO - 'TMOUT': '86400', 16:45:11 INFO - 'USER': 'cltbld', 16:45:11 INFO - 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775', 16:45:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:45:11 INFO - '_': '/tools/buildbot/bin/python'} 16:45:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:45:11 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 16:45:11 INFO - Cleaning up... 16:45:11 INFO - Return code: 0 16:45:11 INFO - Running post-action listener: _resource_record_post_action 16:45:11 INFO - Running post-action listener: _start_resource_monitoring 16:45:11 INFO - Starting resource monitoring. 16:45:11 INFO - [mozharness: 2016-09-20 23:45:11.736470Z] Finished create-virtualenv step (success) 16:45:11 INFO - [mozharness: 2016-09-20 23:45:11.736926Z] Running install step. 16:45:11 INFO - Running pre-action listener: _resource_record_pre_action 16:45:11 INFO - Running main action method: install 16:45:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:45:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:45:11 INFO - Reading from file tmpfile_stdout 16:45:11 INFO - Detecting whether we're running mozinstall >=1.0... 16:45:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 16:45:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 16:45:12 INFO - Reading from file tmpfile_stdout 16:45:12 INFO - Output received: 16:45:12 INFO - Usage: mozinstall [options] installer 16:45:12 INFO - Options: 16:45:12 INFO - -h, --help show this help message and exit 16:45:12 INFO - -d DEST, --destination=DEST 16:45:12 INFO - Directory to install application into. [default: 16:45:12 INFO - "/builds/slave/test"] 16:45:12 INFO - --app=APP Application being installed. [default: firefox] 16:45:12 INFO - mkdir: /builds/slave/test/build/application 16:45:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 16:45:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 16:45:29 INFO - Reading from file tmpfile_stdout 16:45:29 INFO - Output received: 16:45:29 INFO - /builds/slave/test/build/application/firefox/firefox 16:45:29 INFO - Running post-action listener: _resource_record_post_action 16:45:29 INFO - [mozharness: 2016-09-20 23:45:29.006828Z] Finished install step (success) 16:45:29 INFO - [mozharness: 2016-09-20 23:45:29.007102Z] Running run-tests step. 16:45:29 INFO - Running pre-action listener: _resource_record_pre_action 16:45:29 INFO - Running main action method: run_tests 16:45:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 16:45:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 16:45:29 INFO - Python 2.7.3 16:45:29 INFO - Return code: 0 16:45:29 INFO - grabbing minidump binary from tooltool 16:45:29 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:45:29 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: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd07370>, '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 0xd0a8f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd0ad80>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 16:45:29 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 16:45:29 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 16:45:29 INFO - Calling ['/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'] with output_timeout 600 16:45:29 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 16:45:29 INFO - Return code: 0 16:45:29 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 16:45:29 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 16:45:29 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 16:45:29 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 16:45:29 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 16:45:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Autoland', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1474406203/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-067', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 16:45:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Autoland --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1474406203/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-067 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 16:45:29 INFO - Using env: {'DISPLAY': ':0', 16:45:29 INFO - 'HOME': '/home/cltbld', 16:45:29 INFO - 'LANG': 'en_US.UTF-8', 16:45:29 INFO - 'LANGUAGE': 'en_US:en', 16:45:29 INFO - 'LOGNAME': 'cltbld', 16:45:29 INFO - 'MAIL': '/var/mail/cltbld', 16:45:29 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 16:45:29 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 16:45:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:45:29 INFO - 'MOZ_NO_REMOTE': '1', 16:45:29 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 16:45:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:45:29 INFO - 'NO_EM_RESTART': '1', 16:45:29 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:45:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:45:29 INFO - 'PWD': '/builds/slave/test', 16:45:29 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 16:45:29 INFO - 'SHELL': '/bin/bash', 16:45:29 INFO - 'SHLVL': '1', 16:45:29 INFO - 'TERM': 'linux', 16:45:29 INFO - 'TMOUT': '86400', 16:45:29 INFO - 'USER': 'cltbld', 16:45:29 INFO - 'XDG_SESSION_COOKIE': 'e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775', 16:45:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:45:29 INFO - '_': '/tools/buildbot/bin/python'} 16:45:29 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Autoland', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1474406203/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-067', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 16:45:29 INFO - mozversion application_buildid: 20160920141643 16:45:29 INFO - mozversion application_changeset: da03fe82ba9de1fdd59294fad5e74aa24bce3dd9 16:45:29 INFO - mozversion application_display_name: Nightly 16:45:29 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 16:45:29 INFO - mozversion application_name: Firefox 16:45:29 INFO - mozversion application_remotingname: firefox 16:45:29 INFO - mozversion application_repository: https://hg.mozilla.org/integration/autoland 16:45:29 INFO - mozversion application_vendor: Mozilla 16:45:29 INFO - mozversion application_version: 51.0a1 16:45:29 INFO - mozversion platform_buildid: 20160920141643 16:45:29 INFO - mozversion platform_changeset: da03fe82ba9de1fdd59294fad5e74aa24bce3dd9 16:45:29 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/autoland 16:45:29 INFO - mozversion platform_version: 51.0a1 16:45:29 INFO - using testdate: 1474415129 16:45:29 INFO - actual date: 1474415129 16:45:29 INFO - starting webserver on 'localhost:58029' 16:45:29 INFO - SUITE-START | Running 2 tests 16:45:29 INFO - TEST-START | dromaeo_css 16:45:29 INFO - operating with platform_type : linux_ 16:45:29 INFO - Initialising browser for dromaeo_css test... 16:45:29 INFO - TEST-INFO | started process 10822 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpH0PQVa/profile http://localhost:58029/getInfo.html) 16:45:33 INFO - PROCESS | 10822 | __metrics Screen width/height:1600/1200 16:45:33 INFO - PROCESS | 10822 | colorDepth:24 16:45:33 INFO - PROCESS | 10822 | Browser inner width/height: 1024/697 16:45:33 INFO - PROCESS | 10822 | __metrics 16:45:33 INFO - PROCESS | 10822 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 16:45:33 INFO - PROCESS | 10822 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 155: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 16:45:34 INFO - TEST-INFO | 10822: exit 0 16:45:34 INFO - Browser initialized. 16:45:34 INFO - Running cycle 1/1 for dromaeo_css test... 16:45:34 INFO - TEST-INFO | started process 10903 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpH0PQVa/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:45:46 INFO - PROCESS | 10903 | RSS: Main: 155852800 16:45:46 INFO - PROCESS | 10903 | 16:46:37 INFO - PROCESS | 10903 | 1474415197226 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] 16:48:48 INFO - PROCESS | 10903 | Cycle 1(1): loaded http://localhost:58029/tests/dromaeo/cssquery-dojo.html (next: http://localhost:58029/tests/dromaeo/cssquery-ext.html) 16:48:49 INFO - PROCESS | 10903 | RSS: Main: 257409024 16:48:49 INFO - PROCESS | 10903 | 16:51:51 INFO - PROCESS | 10903 | Cycle 1(1): loaded http://localhost:58029/tests/dromaeo/cssquery-ext.html (next: http://localhost:58029/tests/dromaeo/cssquery-jquery.html) 16:51:52 INFO - PROCESS | 10903 | RSS: Main: 241872896 16:51:52 INFO - PROCESS | 10903 | 16:54:54 INFO - PROCESS | 10903 | Cycle 1(1): loaded http://localhost:58029/tests/dromaeo/cssquery-jquery.html (next: http://localhost:58029/tests/dromaeo/cssquery-mootools.html) 16:54:54 INFO - PROCESS | 10903 | RSS: Main: 183730176 16:54:54 INFO - PROCESS | 10903 | 16:57:56 INFO - PROCESS | 10903 | Cycle 1(1): loaded http://localhost:58029/tests/dromaeo/cssquery-mootools.html (next: http://localhost:58029/tests/dromaeo/cssquery-prototype.html) 16:57:57 INFO - PROCESS | 10903 | RSS: Main: 231608320 16:57:57 INFO - PROCESS | 10903 | 17:01:00 INFO - PROCESS | 10903 | Cycle 1(1): loaded http://localhost:58029/tests/dromaeo/cssquery-prototype.html (next: http://localhost:58029/tests/dromaeo/cssquery-yui.html) 17:01:00 INFO - PROCESS | 10903 | RSS: Main: 184852480 17:01:00 INFO - PROCESS | 10903 | 17:04:03 INFO - PROCESS | 10903 | Cycle 1(1): loaded http://localhost:58029/tests/dromaeo/cssquery-yui.html (next: http://localhost:58029/tests/dromaeo/cssquery-dojo.html) 17:04:03 INFO - PROCESS | 10903 | RSS: Main: 278011904 17:04:03 INFO - PROCESS | 10903 | 17:04:03 INFO - PROCESS | 10903 | __start_tp_report 17:04:03 INFO - PROCESS | 10903 | _x_x_mozilla_page_load 17:04:03 INFO - PROCESS | 10903 | _x_x_mozilla_page_load_details 17:04:03 INFO - PROCESS | 10903 | |i|pagename|runs| 17:04:03 INFO - PROCESS | 10903 | |0;dojo.html;2997.4454725875717;3004.774641901858;3016.7435767959723;3035.6509001464824;3037.043331350623;5170.974145129269;5215.139501982168;5249.396319423267;5379.757910894009;5433.320834895638;5271;5290.788368465257;5308.495692909168;5333.306670132877;5391.191321301816;4794.1610218211845;4798.304245884345;4886.60907127429;4899.681520701143;4961.429435614897;4874.8537543873745;4906.386701662293;4911.214205727067;4921.876953076166;4927.876803079916;4697.412823397075;4813.735244561548;4816.133096042711;4833.63747718919;4891.559759621633;4817.662763606549;4839.225723884197;4846.709197448165;4846.7576621169155;4945.802167913279;4863.9513604864205;4878.804847806119;4900.754962251909;4901.166801643729;4930.630202734809;5071.5689166420525;5309.4955979182305;5375.8118465853895;5439.809606663787;5467.043267428184;5780.8843823123725;5830.271216097988;5831.416858314177;5833.183354330397;5833.679147646878;5874.676892770896;5881.85295367615;5882.2353094097925;5892.086726557391;5892.823215303548;5109.693418394908;5210.088234558937;5211.400688920785;5239.502247286502;5265.684058956398;5745.6552606843725;5754.798582049608;5756.222909907193;5757.539396848242;5758.798442054508;5471.753771080232;5511.614187006871;5516.503514683698;5517.393086760453;5533.3083364579425;5363.302770639792;5584.46947539983;5694.402087780806;5698.715064246771;5786.681732504752;5710.114932185435;5715.057015592464;5715.857103572361;5718.714064296769;5719.170720245541;5673.659580425187;5717.371089180187;5733.369329373765;5737.340205876294;5740.68426236561;4233.111046680232;4289.442372491619;4294.162638285567;4362.411074504965;4363.934540981888;3811.5045044144085;3861.227754449121;3875.224955008953;3883.59222281662;3906.2968665640456;5314.5216930476445;5332.493413125747;5336.4129945705945;5339.0389729849;5384.676919384771;5516.420775818561;5611.691356975324;5692.772289108472;5694.857628559236;5696.772129114789;5284.180951952453;5320.122179840283;5357.276767636397;5375.838724838183;5410.08028635133;4933.28467372229;4942.728149951715;4942.802287908516;4945.604351651859;4947.307376967227;5687.573431992534;5877.23595932526;5912.881742365043;5915.112733089984;5917.46742793142;5728.684922329312;5749.8562535936935;5750.856228594319;5767.625104368202;5769.249997500298;5854.736536855767;5908.497777688945;5909.5863289569315;5912.113183022409;5926.4666180044005;5380.757865896122;5522.199281104297;5620.971895140498;5641.182028605911;5642.294713160855;5657.632253903483;5722.513586345207;5730.5129064030025;5754.079347304411;5762.394948530344;5545.473180047889;5589.972050139723;5600.131979543177;5603.439656034364;5604.243427137284;5386.542143917811;5464.972675136599;5582.134769110794;5582.162675598693;5592.888142237214;5456.918146227889;5522;5561.694106824001;5588.524975377139;5590.021746194318;5567;5574.386817450159;5576.470235327637;5610.410906854885;5614.2701448811395;5309.495597918191;5375;5453.481919217668;5459.590530710292;5462.071447853795 17:04:03 INFO - PROCESS | 10903 | |1;ext.html;556.330958152746;592.703648175912;600.4445887554011;606.8998615228487;608.358182117866;31900.99999999997;32330.67669323306;42230.57769422305;43224.13551728964;43550.12899742003;41742.16515669685;45160.77419612905;45233.7738311308;45287.54712452875;45336;8895.377323587336;9040.321975851804;9052.502112383816;9055.04921983192;9062.320325975577;8984.640614375417;9069.455832650063;9075.13786190311;9082;9082.909170908306;9027.774305642346;9035.909640903605;9145.314101442385;9145.771355716128;9147;8995.100489950952;9016.504092274923;9018.36871419001;9075.818483630323;9138.040505746934;8905.332100092453;8940.68707595231;8978.50618215998;8979.326550508738;9009.144131307516;42094.158116837796;42172;42314.576854231374;42563.14873702508;42576;3499.7840558773973;3619.6561326673923;3650.945235821465;3665.321915445651;4219.6202341789385;32373.190670233198;32855;32906.17734556631;32952.3409531808;32990.83504582486;4195.958040419588;4278.144371125756;4373.365861949999;4431.357453169305;4450.777461126963;347736;347830;350346.4965350339;350438;350660.2466987674;54117.45882541124;54583.454165457835;54596.45403545993;54607.18089228665;54682.726586366814;46539.30191047137;46773.95969261987;46841.531584684395;46915.530844691115;46971.76514117407;15086.849131508763;15294.923525382303;15305.38778448872;15324.310406031755;15328.310226039855;10623.628173013907;10625.256232063835;10629.574817007388;10632.893671063344;10661.307015043998;14192.85807141936;16120.355185792438;16150.75773863393;16165.67668646644;16230.837691623168;6048.455638992512;6074.54440916933;6113.510919126459;6119.143319935212;6146.801373732169;754.7735679296189;927.6104036304769;1066.8453074304182;1114.322943969337;1120.9831852522218;31739;32342.548118974366;32398.514022289684;32513.34973300521;32781.09561318262;1066.4134725900878;1066.4720963123305;1068.9091427228773;1136.170595465315;1199.9400029998465;16380.83619163817;16792.328306867832;17260.913695431693;17290.827091729174;17301.56746081358;492415;495056;495119;496083;496528;57864.71067644719;57944;57953.13070303949;57959;58036;1187.3706935324292;1338.6051114921122;1358.2665360705307;1359.2184493916038;1378.9241591712353;31413;32296.515552266264;32857.83571082225;33131.50302745413;33695;40980.79509602433;41253.38119928144;41308.1738365225;41333.173336533706;41362;402028;402194;404074;404110;406176;27414.45171096527;28356.291092722848;28471.572926406534;29570.852145739133;29658.258543536584;47052.7647361761;47277.52722472731;48023.279650804565;48055.75972120257;48888;39833;39938.60061399349;40228.79313620596;40929;42268;40045;40267.1946561073;40484.79757601193;40933.79533102315;41607.167856643304;40949.38575921423;41438;41671.58328416677;42304.78847605742;42478;34370.65629343774;36880.81559592185;37293.627063729014;37574.57056348935;38101.61898380981;27528.311792204553;27551.724482754915;27659.446811063262;27757;27764.722352777022 17:04:03 INFO - PROCESS | 10903 | |2;jquery.html;343.7215855157321;346.59621540904834;351.9507268982342;363.78718449706923;368.5264435200768;18857.245710171595;19922.800771992275;20046.899765501188;21199.99999999996;21240;18382.632347353046;19779.703304450446;19784.802151978474;19873.304434344802;20078.498037549067;5526.917096243559;5765.336986246593;5769.509591684712;5770.451807078321;5771.711414429283;5430.239766432683;5704.714764261791;5726.3987281335485;5726.942730572682;5733.397993210715;5690.800821971232;5693.373728889839;5697.287839020122;5698.515626171759;5702.743376548045;5477.424870388611;5575.526080283181;5628.409017053192;5634.183043458716;5637.887242255173;4927.753612319406;4986;4991.5258050485145;4994.675346102528;4996.300517927493;23756.643650345257;24062.87968560146;24194.427362221577;24285.271441856774;24472.755272447226;2331.8600883946847;2337.111897478947;2404.603240465321;2617.254082586454;2764.654418197725;14593.562193134223;14739.778903316459;14745.410183592643;15222.314995825214;15357;1902.5719213176924;1909.1981367825547;1942.2328180368675;1953.6971769375768;2030.137191693539;65003.67498162526;75438.62280688617;77154.6142269285;77767;77953.27163549249;10495.26533142688;10755.569777208824;10891.237613366988;11083.390413527171;11352.772944541062;15220.771688424682;15577.376904923904;15577.766333505006;15598.454054108279;15619.14094724801;7242.529235599774;7542.962285188539;7612;7939.2060793920145;7976.641051152712;6817.147856517935;6967.756128535579;6975.197852246955;7016.403605693471;7109.608971506616;4545.204589196877;4714.316424118552;4725.763711814396;4731.929021064618;4843.6367272454;1758.4636685810694;1763.089794921164;1823.917923693437;1830.3410772122024;1837.127364501851;951.9190868776093;953.7424895278236;1005.3214080495783;1006.9628282868657;1020.8877023527406;19000.429987100408;20267.493312667302;20724.792752072288;20738;21051.473713157295;989.4113002763344;1002.0230275481348;1032.83990981398;1052.321252791945;1079.7300674831292;10450.041165326003;10850.29473084247;10860.447001018672;12214.26714397139;12223.816642750366;447202;454618;455641;475582;502640;68375.31624683789;74407.62796185985;91727.54136229276;96558;97018.51490742501;1016.9949150254201;1082.3397727386289;1122.5397586989295;1122.618309774664;1123.8370436286693;18114.18486168099;18142.727859082388;18905.243790248787;18965;19154.425367239004;44675.77662111669;44992.32511512395;45678.54321456743;46333;46596.47649329029;60257.179425644965;60788;61203.38796611977;63007;63225;8595.398322117391;8613.440126391764;8638.481691098554;8713.25937295337;8813.559322034002;11469.655910322703;13761;13918.355512453007;14025.29873506341;14046.227457489527;11789.587364442203;11840.28958262507;12130.909669147946;12147.939260303641;12486.12597118193;12034.931092571689;12057.095717821023;12059;12297.32364719949;12588.370581471074;11729;11914.702132446759;12234.327112008568;12375;12504.624861254177;7427.368673662799;7890.48711833729;7922.049354077317;8503.362247831561;8636.17956294151;5617.831465056055;8634.877465929389;9051.773705657411;9908.702738917844;11135.387553684624 17:04:03 INFO - PROCESS | 10903 | |3;mootools.html;1467.8605532474419;1519.012641782841;1611.8549330560247;1714.9485515434542;1754.7543343931852;8569.400141990056;9216.354855160142;9229.723108306762;9243;9249.907500924988;7662.118856331524;8514.787130321745;8721.215090641841;8751.124887511261;8922.42004269722;2326.5114325991563;2337.742848286687;2338.286822519131;2356.2813341930705;2358.41039740065;2300.493891343902;2312.722473303206;2375.6674065630827;2377.6314671225987;2381.368937231635;2322.9419264518438;2329.767023297665;2332.300309907021;2373.4303767095944;2381.071382160959;2308.665243539694;2344.015513484332;2351.8236132290062;2355.764423557639;2358.740538540759;2318.9072437102495;2332.3702600297825;2334.2997100869843;2347.94130146746;2358.4929240213264;8713.520756358397;8801.603927823264;8828.955855220747;8836.469811811248;9117.908820911773;5039.395272567279;5086.821961231339;5186.196139598368;5190.506901844319;5225.686458812445;3351.748618853596;3437.9828100859586;3542.2738338640515;3544.61009288978;3554.893353199408;1031.3605564549953;1076.2304951959386;1088.504730347698;1092.0771947704177;1096.901278884896;12466.065045121652;12533.874661253452;12552.748945021049;12598.68503287416;12617.684557886127;4355.390245365651;4439.578240067189;4528.320751887243;4668.299755036772;4670.95329046712;10504.737381565523;10520;10541.209409294333;10553.208509361675;10579.153667706565;5148.2277658350795;5187.118189907725;5189.870253243624;5192.584593232532;5200.427952925175;4153.626173644387;4600.608948239437;4676.205045142334;4741.2176990796825;4750.263709125091;3673.2653469306247;3704.2221133561716;3806.7715937043313;3819.904502387407;3824.1778017726324;1193.8985186259092;1199.9160058795976;1207.4928530017414;1213.3084142038954;1215.3862299538675;869.1612593846968;952.2191802721702;968.3173362779364;994.22450488619;1008.5713571732131;6035.577509574376;6167.475764560063;6189.938100619026;6190.473809726223;6403.455706264926;439.8944253379166;446.7319608235033;448.53800585397096;456.50013235507066;463.6777439679458;4115.753054816661;4121.814518346681;4132.772697501667;4141.79291035447;4143.254214241466;10953.616623418302;11386.373749443694;11405.14461415397;11406.543738250377;11467.197296189186;11264.098872090377;11296.774064518664;11299.604513841976;11314.981651651391;11321;7919.604019798987;8303.086660467343;8313.12712165226;8492.830143397097;8507.106753790888;5368.1679339702405;5543.972280138573;5603.691796951207;5645.322561292671;5661.688607126647;9543.856842147512;9685.467299298607;9773;9877;9903.752406189902;10119.7470063249;10146.847797282899;10276.383416995004;10282.588696452058;10354.689359319233;6904.13698287714;7671.232876712284;7829.491083079582;7960.402969777174;8081.434299598972;9041.276697864287;9113.134252246025;9128.087191280818;9132.406393584395;9136.543172841199;7688.269614386624;7715.112762032214;7855.764327070197;7877.015373078365;8006.879896801669;7792.61036948139;7920.366370690446;7936.880946785918;7938.6030698466;7951.125376208728;7149.785506434815;7238.927610723826;7244.384227340524;7247.383972362408;7247.456440767069;5122.334096567422;5197.974010129925;5245.580353571629;5330.413654498079;5516.531094856982;5389.191621256843;5516;5660.179274005164;5663.150527420919;5738.741756620879 17:04:03 INFO - PROCESS | 10903 | |4;prototype.html;293.8339837991535;307.7307356063444;307.8276165347404;309.8187560277237;313.0748637775374;5020.7489625518765;5089.541941225289;5188.740562971855;5217.321748172737;5221.634485586011;5047.899042019158;5077.79688812448;5103.617228707843;5125.179971204608;5129.25625784262;4041.555428902818;4049.3521036634143;4054.331035379159;4064.451299074624;4091.672666186713;3808.16220431506;3832.8083595820235;4060.593940605945;4062.0860306430964;4087.1417002429525;3962.117993952864;3969.1466334738025;3981.6263389130704;3991.2017596480673;3995;4005.998500374906;4006.479157709494;4008.378701301303;4011.3581826907703;4014.739041962263;3557.5375201223933;3558.466230065485;3565.5186549815962;3571.5714114306447;3576.445650924111;4959.677620954626;4963.503649635044;4970.726610036447;4985.476524964863;4985.551300382983;4546.454425468932;4565.269556870918;4570.405847239871;4572.817087316504;4576.839810606612;5061.595072394236;5340.279062326575;5347.385050719139;5368.382635996872;5382.273393091921;3906.7851268180525;3910.237503686782;3922.7450215735885;3927.8036098194975;3943.98028009861;5554.222408862763;5574.86062848428;5589.854079913649;5597.188407680904;5620.803271885465;4015.0966032642423;4021.9597804021587;4030.3752918297123;4031.1053804711737;4032.697547683935;3824.2160357126722;4037.9394309085387;4055.6755459563165;4062.532808726975;4071.6131967463043;4575.519570445122;4595.287730401727;4611.746353950565;4617.1227466781875;4620.653450991189;5328.413874473805;5344.263114487807;5359.115745901882;5366.443731317952;5418.2685337479725;1328.7873940169527;1378.8827949624194;1397.3292819446722;1401.6215621782062;1407.1205496564646;883.4589230821938;888.1606881497053;901.6032945503957;902.7156445719577;906.1753804038293;4547.772101532568;4549.226631472658;4567.38340324052;4573.582189521193;4585.541445855454;4855.514448555116;4863.927041094386;4902.362692849907;4906.90186196274;4914.533119353656;4562.224421848294;4566.20091483989;4583.656225783013;4586.610138138229;4619.769011549409;2730.481208570365;2941.1470673504873;2941.4558306713325;2942.2791416102764;2947.204254851178;5670.036093864053;5675.3757086720425;5675.460831221028;5690.065377771578;5791.362950075489;5545.861353466195;5608.906263278622;5619.7471113799975;5702.201691763156;5739.7704091836695;5719.799807006735;5720.42795720433;5723.599348045597;5730.914036289459;5737.168110623936;5542.196381524737;5569.081101618188;5584.240964096297;5585.469380408855;5601.915971260353;5262.947370526245;5465.69938653362;5471.50756431923;5481.232627432083;5495.258140151029;5656.604037717485;5710.829884643808;5730.309558680283;5733.713314334183;5757.165211044291;3675.577308609544;3827.9808600956817;3829.3194763664987;3853.362321013502;3877.651011408987;5442.537384322377;5451.809186678447;5456.59075569326;5480.177973304037;5506.531944784738;5330.600204984564;5405.648632838853;5465.72671366438;5466.535344495763;5468.93355795616;5275.683458992473;5372.328458942632;5382.946170538401;5408.621396502207;5435.918461223164;5336.706481143575;5350.411454740053;5352.197170424468;5359.222912677717;5362.463753624606;5386.622936394571;5386.649867758583;5395.325584301962;5398.514133727984;5405.648632838853;5070;5293.570735901362;5311.203319502106;5316.787328506816;5329.147336426153 17:04:03 INFO - PROCESS | 10903 | |5;yui.html;685.6400389795357;706.0327351528405;751.6692655231701;808.4502538273975;848.1179573243827;14289.785653215211;14845.851541484595;14899.627509312273;14954.177520236382;14988.5503434897;15139.31873065712;15324.923375383136;15342.923285383586;15384.923075384608;15387.846121538782;653.993460065398;765.1086484245875;773.5668025905483;793.611130546034;798.6366203377478;792.7661339904713;795.0538858758089;798.3333916179968;800.6237068577759;802.3581135091932;858.3776761847673;860.1484530314974;860.7589874835024;861.2033868671485;861.7888617288774;683.3849535418113;812.6505602590884;849.6389034660244;849.6601359456267;849.8300339932039;623.9095331176954;624.0389799708444;624.2446639566131;624.6408315218767;624.7438550194444;15402;15413.3834646614;15444.613884652861;15485.535433937;15509.146996915166;14195.361208745631;14433.350499227456;14451.710965780625;14902.776458353024;15171.848281517154;13567.932160339134;13599.32003399836;13634.86365136346;13794;13855.792163117561;4475.10497900418;4597.586217240464;4600.401947746805;4695.812167513295;4723.669343145981;88409.41244694618;89495;90126.5493672534;90610;90783.54608226917;11890.702732431586;11905.642830715093;12054;12161.939190303992;12167.452464639113;22673;22714.318570442912;22799.31602051941;22886;22891.313260602208;7850.175731548219;7880;7884;8225.177482251847;8598.226159645661;4711.811527538928;4728.88177795551;4773.09311230865;4822.927656085161;4844.515548445127;3251.463508521115;3350.5476760637002;3361.159710072482;3361.562996810399;3385.9153521161675;565.1720229863188;566.0744682444151;582.1849410824794;587.6209844650263;589.584343038157;617.3301967365369;624.2727222785495;637.8947473666885;645.2257291250518;663.0617675988423;9421;9648.372855764354;9766;9835.459049752333;9894.751557756807;649.4155260265704;660.3825423229296;682.1405029662661;691.6921969723526;703.4723957032226;4377.693561450668;4747.216709243005;4805.951940480551;4815.470298267188;4872.589187568716;105572.47213763882;129454;130153;133163;135034.32482837522;112269;113757;114392.42803786094;115318;118559.40720296516;96020.51989740007;96731.51634241924;100404;100446.4977675107;100907;8701.582513204385;8763.912360876564;8836.734897953073;8892.066333035196;9249.583768730288;56345;57360;57476;58544;59911.700441497516;74721.25278747143;75942.6202868982;83905.17006465774;84396;86243;11672.057097290202;11758.998450548703;11835.775148046328;11884.405779711153;11921.046316294849;12947.028102462074;12980;12989.545365912149;13527.594172174457;13554.322283885964;11946.134663341645;11958.64124076279;12222.388880555758;12320.445579949102;12417.130800843854;12212.145149839425;12311;12436.96812989762;12555.686107847012;13086.541971030969;11530.192886497865;11711.648650540497;12101.394930253628;12393.256404615751;12420.875791242333;9669.806603868024;9993.550290237103;10032.64885728996;10344.069033786995;10354.482275886327;9170.816583668156;9303;9306.72079837606;9418.481983490974;9444.763880902758 17:04:03 INFO - PROCESS | 10903 | __end_tp_report 17:04:03 INFO - PROCESS | 10903 | __start_cc_report 17:04:03 INFO - PROCESS | 10903 | _x_x_mozilla_cycle_collect,1012 17:04:03 INFO - PROCESS | 10903 | __end_cc_report 17:04:03 INFO - PROCESS | 10903 | __startTimestamp1474416243818__endTimestamp 17:04:03 INFO - PROCESS | 10903 | 17:04:03 INFO - PROCESS | 10903 | ------- Summary: start ------- 17:04:03 INFO - PROCESS | 10903 | Number of tests: 6 17:04:03 INFO - PROCESS | 10903 | 17:04:03 INFO - PROCESS | 10903 | [#0] dojo.html Cycles:165 Average:5286.44 Median:5462.07 stddev:612.06 (11.2%) stddev-sans-first:587.00 17:04:03 INFO - PROCESS | 10903 | Values: 2997.4 3004.8 3016.7 3035.7 3037.0 5171.0 5215.1 5249.4 5379.8 5433.3 5271.0 5290.8 5308.5 5333.3 5391.2 4794.2 4798.3 4886.6 4899.7 4961.4 4874.9 4906.4 4911.2 4921.9 4927.9 4697.4 4813.7 4816.1 4833.6 4891.6 4817.7 4839.2 4846.7 4846.8 4945.8 4864.0 4878.8 4900.8 4901.2 4930.6 5071.6 5309.5 5375.8 5439.8 5467.0 5780.9 5830.3 5831.4 5833.2 5833.7 5874.7 5881.9 5882.2 5892.1 5892.8 5109.7 5210.1 5211.4 5239.5 5265.7 5745.7 5754.8 5756.2 5757.5 5758.8 5471.8 5511.6 5516.5 5517.4 5533.3 5363.3 5584.5 5694.4 5698.7 5786.7 5710.1 5715.1 5715.9 5718.7 5719.2 5673.7 5717.4 5733.4 5737.3 5740.7 4233.1 4289.4 4294.2 4362.4 4363.9 3811.5 3861.2 3875.2 3883.6 3906.3 5314.5 5332.5 5336.4 5339.0 5384.7 5516.4 5611.7 5692.8 5694.9 5696.8 5284.2 5320.1 5357.3 5375.8 5410.1 4933.3 4942.7 4942.8 4945.6 4947.3 5687.6 5877.2 5912.9 5915.1 5917.5 5728.7 5749.9 5750.9 5767.6 5769.2 5854.7 5908.5 5909.6 5912.1 5926.5 5380.8 5522.2 5621.0 5641.2 5642.3 5657.6 5722.5 5730.5 5754.1 5762.4 5545.5 5590.0 5600.1 5603.4 5604.2 5386.5 5465.0 5582.1 5582.2 5592.9 5456.9 5522.0 5561.7 5588.5 5590.0 5567.0 5574.4 5576.5 5610.4 5614.3 5309.5 5375.0 5453.5 5459.6 5462.1 17:04:03 INFO - PROCESS | 10903 | 17:04:03 INFO - PROCESS | 10903 | [#1] ext.html Cycles:180 Average:57174.24 Median:41320.67 stddev:111219.15 (269.2%) stddev-sans-first:111449.91 17:04:03 INFO - PROCESS | 10903 | Values: 556.3 592.7 600.4 606.9 608.4 31901.0 32330.7 42230.6 43224.1 43550.1 41742.2 45160.8 45233.8 45287.5 45336.0 8895.4 9040.3 9052.5 9055.0 9062.3 8984.6 9069.5 9075.1 9082.0 9082.9 9027.8 9035.9 9145.3 9145.8 9147.0 8995.1 9016.5 9018.4 9075.8 9138.0 8905.3 8940.7 8978.5 8979.3 9009.1 42094.2 42172.0 42314.6 42563.1 42576.0 3499.8 3619.7 3650.9 3665.3 4219.6 32373.2 32855.0 32906.2 32952.3 32990.8 4196.0 4278.1 4373.4 4431.4 4450.8 347736.0 347830.0 350346.5 350438.0 350660.2 54117.5 54583.5 54596.5 54607.2 54682.7 46539.3 46774.0 46841.5 46915.5 46971.8 15086.8 15294.9 15305.4 15324.3 15328.3 10623.6 10625.3 10629.6 10632.9 10661.3 14192.9 16120.4 16150.8 16165.7 16230.8 6048.5 6074.5 6113.5 6119.1 6146.8 754.8 927.6 1066.8 1114.3 1121.0 31739.0 32342.5 32398.5 32513.3 32781.1 1066.4 1066.5 1068.9 1136.2 1199.9 16380.8 16792.3 17260.9 17290.8 17301.6 492415.0 495056.0 495119.0 496083.0 496528.0 57864.7 57944.0 57953.1 57959.0 58036.0 1187.4 1338.6 1358.3 1359.2 1378.9 31413.0 32296.5 32857.8 33131.5 33695.0 40980.8 41253.4 41308.2 41333.2 41362.0 402028.0 402194.0 404074.0 404110.0 406176.0 27414.5 28356.3 28471.6 29570.9 29658.3 47052.8 47277.5 48023.3 48055.8 48888.0 39833.0 39938.6 40228.8 40929.0 42268.0 40045.0 40267.2 40484.8 40933.8 41607.2 40949.4 41438.0 41671.6 42304.8 42478.0 34370.7 36880.8 37293.6 37574.6 38101.6 27528.3 27551.7 27659.4 27757.0 27764.7 17:04:03 INFO - PROCESS | 10903 | 17:04:03 INFO - PROCESS | 10903 | [#2] jquery.html Cycles:180 Average:28407.49 Median:13545.00 stddev:77049.78 (568.8%) stddev-sans-first:77237.11 17:04:03 INFO - PROCESS | 10903 | Values: 343.7 346.6 352.0 363.8 368.5 18857.2 19922.8 20046.9 21200.0 21240.0 18382.6 19779.7 19784.8 19873.3 20078.5 5526.9 5765.3 5769.5 5770.5 5771.7 5430.2 5704.7 5726.4 5726.9 5733.4 5690.8 5693.4 5697.3 5698.5 5702.7 5477.4 5575.5 5628.4 5634.2 5637.9 4927.8 4986.0 4991.5 4994.7 4996.3 23756.6 24062.9 24194.4 24285.3 24472.8 2331.9 2337.1 2404.6 2617.3 2764.7 14593.6 14739.8 14745.4 15222.3 15357.0 1902.6 1909.2 1942.2 1953.7 2030.1 65003.7 75438.6 77154.6 77767.0 77953.3 10495.3 10755.6 10891.2 11083.4 11352.8 15220.8 15577.4 15577.8 15598.5 15619.1 7242.5 7543.0 7612.0 7939.2 7976.6 6817.1 6967.8 6975.2 7016.4 7109.6 4545.2 4714.3 4725.8 4731.9 4843.6 1758.5 1763.1 1823.9 1830.3 1837.1 951.9 953.7 1005.3 1007.0 1020.9 19000.4 20267.5 20724.8 20738.0 21051.5 989.4 1002.0 1032.8 1052.3 1079.7 10450.0 10850.3 10860.4 12214.3 12223.8 447202.0 454618.0 455641.0 475582.0 502640.0 68375.3 74407.6 91727.5 96558.0 97018.5 1017.0 1082.3 1122.5 1122.6 1123.8 18114.2 18142.7 18905.2 18965.0 19154.4 44675.8 44992.3 45678.5 46333.0 46596.5 60257.2 60788.0 61203.4 63007.0 63225.0 8595.4 8613.4 8638.5 8713.3 8813.6 11469.7 13761.0 13918.4 14025.3 14046.2 11789.6 11840.3 12130.9 12147.9 12486.1 12034.9 12057.1 12059.0 12297.3 12588.4 11729.0 11914.7 12234.3 12375.0 12504.6 7427.4 7890.5 7922.0 8503.4 8636.2 5617.8 8634.9 9051.8 9908.7 11135.4 17:04:03 INFO - PROCESS | 10903 | 17:04:03 INFO - PROCESS | 10903 | [#3] mootools.html Cycles:180 Average:5854.18 Median:2565.99 stddev:3397.42 (132.4%) stddev-sans-first:3390.96 17:04:03 INFO - PROCESS | 10903 | Values: 1467.9 1519.0 1611.9 1714.9 1754.8 8569.4 9216.4 9229.7 9243.0 9249.9 7662.1 8514.8 8721.2 8751.1 8922.4 2326.5 2337.7 2338.3 2356.3 2358.4 2300.5 2312.7 2375.7 2377.6 2381.4 2322.9 2329.8 2332.3 2373.4 2381.1 2308.7 2344.0 2351.8 2355.8 2358.7 2318.9 2332.4 2334.3 2347.9 2358.5 8713.5 8801.6 8829.0 8836.5 9117.9 5039.4 5086.8 5186.2 5190.5 5225.7 3351.7 3438.0 3542.3 3544.6 3554.9 1031.4 1076.2 1088.5 1092.1 1096.9 12466.1 12533.9 12552.7 12598.7 12617.7 4355.4 4439.6 4528.3 4668.3 4671.0 10504.7 10520.0 10541.2 10553.2 10579.2 5148.2 5187.1 5189.9 5192.6 5200.4 4153.6 4600.6 4676.2 4741.2 4750.3 3673.3 3704.2 3806.8 3819.9 3824.2 1193.9 1199.9 1207.5 1213.3 1215.4 869.2 952.2 968.3 994.2 1008.6 6035.6 6167.5 6189.9 6190.5 6403.5 439.9 446.7 448.5 456.5 463.7 4115.8 4121.8 4132.8 4141.8 4143.3 10953.6 11386.4 11405.1 11406.5 11467.2 11264.1 11296.8 11299.6 11315.0 11321.0 7919.6 8303.1 8313.1 8492.8 8507.1 5368.2 5544.0 5603.7 5645.3 5661.7 9543.9 9685.5 9773.0 9877.0 9903.8 10119.7 10146.8 10276.4 10282.6 10354.7 6904.1 7671.2 7829.5 7960.4 8081.4 9041.3 9113.1 9128.1 9132.4 9136.5 7688.3 7715.1 7855.8 7877.0 8006.9 7792.6 7920.4 7936.9 7938.6 7951.1 7149.8 7238.9 7244.4 7247.4 7247.5 5122.3 5198.0 5245.6 5330.4 5516.5 5389.2 5516.0 5660.2 5663.2 5738.7 17:04:03 INFO - PROCESS | 10903 | 17:04:03 INFO - PROCESS | 10903 | [#4] prototype.html Cycles:180 Average:4488.88 Median:5034.32 stddev:1318.66 (26.2%) stddev-sans-first:1284.22 17:04:03 INFO - PROCESS | 10903 | Values: 293.8 307.7 307.8 309.8 313.1 5020.7 5089.5 5188.7 5217.3 5221.6 5047.9 5077.8 5103.6 5125.2 5129.3 4041.6 4049.4 4054.3 4064.5 4091.7 3808.2 3832.8 4060.6 4062.1 4087.1 3962.1 3969.1 3981.6 3991.2 3995.0 4006.0 4006.5 4008.4 4011.4 4014.7 3557.5 3558.5 3565.5 3571.6 3576.4 4959.7 4963.5 4970.7 4985.5 4985.6 4546.5 4565.3 4570.4 4572.8 4576.8 5061.6 5340.3 5347.4 5368.4 5382.3 3906.8 3910.2 3922.7 3927.8 3944.0 5554.2 5574.9 5589.9 5597.2 5620.8 4015.1 4022.0 4030.4 4031.1 4032.7 3824.2 4037.9 4055.7 4062.5 4071.6 4575.5 4595.3 4611.7 4617.1 4620.7 5328.4 5344.3 5359.1 5366.4 5418.3 1328.8 1378.9 1397.3 1401.6 1407.1 883.5 888.2 901.6 902.7 906.2 4547.8 4549.2 4567.4 4573.6 4585.5 4855.5 4863.9 4902.4 4906.9 4914.5 4562.2 4566.2 4583.7 4586.6 4619.8 2730.5 2941.1 2941.5 2942.3 2947.2 5670.0 5675.4 5675.5 5690.1 5791.4 5545.9 5608.9 5619.7 5702.2 5739.8 5719.8 5720.4 5723.6 5730.9 5737.2 5542.2 5569.1 5584.2 5585.5 5601.9 5262.9 5465.7 5471.5 5481.2 5495.3 5656.6 5710.8 5730.3 5733.7 5757.2 3675.6 3828.0 3829.3 3853.4 3877.7 5442.5 5451.8 5456.6 5480.2 5506.5 5330.6 5405.6 5465.7 5466.5 5468.9 5275.7 5372.3 5382.9 5408.6 5435.9 5336.7 5350.4 5352.2 5359.2 5362.5 5386.6 5386.6 5395.3 5398.5 5405.6 5070.0 5293.6 5311.2 5316.8 5329.1 17:04:03 INFO - PROCESS | 10903 | 17:04:03 INFO - PROCESS | 10903 | [#5] yui.html Cycles:180 Average:22494.48 Median:4789.52 stddev:34247.09 (715.0%) stddev-sans-first:34304.02 17:04:03 INFO - PROCESS | 10903 | Values: 685.6 706.0 751.7 808.5 848.1 14289.8 14845.9 14899.6 14954.2 14988.6 15139.3 15324.9 15342.9 15384.9 15387.8 654.0 765.1 773.6 793.6 798.6 792.8 795.1 798.3 800.6 802.4 858.4 860.1 860.8 861.2 861.8 683.4 812.7 849.6 849.7 849.8 623.9 624.0 624.2 624.6 624.7 15402.0 15413.4 15444.6 15485.5 15509.1 14195.4 14433.4 14451.7 14902.8 15171.8 13567.9 13599.3 13634.9 13794.0 13855.8 4475.1 4597.6 4600.4 4695.8 4723.7 88409.4 89495.0 90126.5 90610.0 90783.5 11890.7 11905.6 12054.0 12161.9 12167.5 22673.0 22714.3 22799.3 22886.0 22891.3 7850.2 7880.0 7884.0 8225.2 8598.2 4711.8 4728.9 4773.1 4822.9 4844.5 3251.5 3350.5 3361.2 3361.6 3385.9 565.2 566.1 582.2 587.6 589.6 617.3 624.3 637.9 645.2 663.1 9421.0 9648.4 9766.0 9835.5 9894.8 649.4 660.4 682.1 691.7 703.5 4377.7 4747.2 4806.0 4815.5 4872.6 105572.5 129454.0 130153.0 133163.0 135034.3 112269.0 113757.0 114392.4 115318.0 118559.4 96020.5 96731.5 100404.0 100446.5 100907.0 8701.6 8763.9 8836.7 8892.1 9249.6 56345.0 57360.0 57476.0 58544.0 59911.7 74721.3 75942.6 83905.2 84396.0 86243.0 11672.1 11759.0 11835.8 11884.4 11921.0 12947.0 12980.0 12989.5 13527.6 13554.3 11946.1 11958.6 12222.4 12320.4 12417.1 12212.1 12311.0 12437.0 12555.7 13086.5 11530.2 11711.6 12101.4 12393.3 12420.9 9669.8 9993.6 10032.6 10344.1 10354.5 9170.8 9303.0 9306.7 9418.5 9444.8 17:04:03 INFO - PROCESS | 10903 | -------- Summary: end -------- 17:04:03 INFO - PROCESS | 10903 | 17:04:04 INFO - TEST-INFO | 10903: exit 0 17:04:04 INFO - TEST-OK | dromaeo_css | took 1115261ms 17:04:04 INFO - TEST-START | kraken 17:04:04 INFO - operating with platform_type : linux_ 17:04:04 INFO - Initialising browser for kraken test... 17:04:04 INFO - TEST-INFO | started process 11206 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp8UKdrX/profile http://localhost:58029/getInfo.html) 17:04:08 INFO - PROCESS | 11206 | __metrics Screen width/height:1600/1200 17:04:08 INFO - PROCESS | 11206 | colorDepth:24 17:04:08 INFO - PROCESS | 11206 | Browser inner width/height: 1024/697 17:04:08 INFO - PROCESS | 11206 | __metrics 17:04:08 INFO - PROCESS | 11206 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 17:04:08 INFO - PROCESS | 11206 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 155: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 17:04:09 INFO - PROCESS | 11206 | console.error: PushService: 17:04:09 INFO - PROCESS | 11206 | stateChangeProcessEnqueue: Error transitioning state 17:04:09 INFO - PROCESS | 11206 | UnknownError 17:04:09 INFO - TEST-INFO | 11206: exit 0 17:04:09 INFO - Browser initialized. 17:04:09 INFO - Running cycle 1/1 for kraken test... 17:04:09 INFO - TEST-INFO | started process 11291 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp8UKdrX/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 17:04:21 INFO - PROCESS | 11291 | RSS: Main: 155799552 17:04:21 INFO - PROCESS | 11291 | 17:04:24 INFO - PROCESS | 11291 | Cycle 1(1): loaded http://localhost:58029/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:58029/tests/kraken/driver.html?testName=audio-beat-detection) 17:04:24 INFO - PROCESS | 11291 | RSS: Main: 204333056 17:04:24 INFO - PROCESS | 11291 | 17:04:27 INFO - PROCESS | 11291 | Cycle 1(1): loaded http://localhost:58029/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:58029/tests/kraken/driver.html?testName=audio-dft) 17:04:28 INFO - PROCESS | 11291 | RSS: Main: 194924544 17:04:28 INFO - PROCESS | 11291 | 17:04:31 INFO - PROCESS | 11291 | Cycle 1(1): loaded http://localhost:58029/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:58029/tests/kraken/driver.html?testName=audio-fft) 17:04:31 INFO - PROCESS | 11291 | RSS: Main: 275316736 17:04:31 INFO - PROCESS | 11291 | 17:04:33 INFO - PROCESS | 11291 | Cycle 1(1): loaded http://localhost:58029/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:58029/tests/kraken/driver.html?testName=audio-oscillator) 17:04:34 INFO - PROCESS | 11291 | RSS: Main: 186310656 17:04:34 INFO - PROCESS | 11291 | 17:04:36 INFO - PROCESS | 11291 | Cycle 1(1): loaded http://localhost:58029/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:58029/tests/kraken/driver.html?testName=imaging-gaussian-blur) 17:04:37 INFO - PROCESS | 11291 | RSS: Main: 191541248 17:04:37 INFO - PROCESS | 11291 | 17:04:40 INFO - PROCESS | 11291 | Cycle 1(1): loaded http://localhost:58029/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:58029/tests/kraken/driver.html?testName=imaging-darkroom) 17:04:40 INFO - PROCESS | 11291 | RSS: Main: 227516416 17:04:40 INFO - PROCESS | 11291 | 17:04:44 INFO - PROCESS | 11291 | Cycle 1(1): loaded http://localhost:58029/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:58029/tests/kraken/driver.html?testName=imaging-desaturate) 17:04:44 INFO - PROCESS | 11291 | RSS: Main: 226025472 17:04:44 INFO - PROCESS | 11291 | 17:04:47 INFO - PROCESS | 11291 | Cycle 1(1): loaded http://localhost:58029/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:58029/tests/kraken/driver.html?testName=json-parse-financial) 17:04:48 INFO - PROCESS | 11291 | RSS: Main: 226906112 17:04:48 INFO - PROCESS | 11291 | 17:04:49 INFO - PROCESS | 11291 | Cycle 1(1): loaded http://localhost:58029/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:58029/tests/kraken/driver.html?testName=json-stringify-tinderbox) 17:04:50 INFO - PROCESS | 11291 | RSS: Main: 188305408 17:04:50 INFO - PROCESS | 11291 | 17:04:52 INFO - PROCESS | 11291 | Cycle 1(1): loaded http://localhost:58029/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:58029/tests/kraken/driver.html?testName=stanford-crypto-aes) 17:04:52 INFO - PROCESS | 11291 | RSS: Main: 195260416 17:04:52 INFO - PROCESS | 11291 | 17:04:54 INFO - PROCESS | 11291 | Cycle 1(1): loaded http://localhost:58029/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:58029/tests/kraken/driver.html?testName=stanford-crypto-ccm) 17:04:55 INFO - PROCESS | 11291 | RSS: Main: 193204224 17:04:55 INFO - PROCESS | 11291 | 17:04:57 INFO - PROCESS | 11291 | Cycle 1(1): loaded http://localhost:58029/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:58029/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 17:04:58 INFO - PROCESS | 11291 | RSS: Main: 187101184 17:04:58 INFO - PROCESS | 11291 | 17:05:01 INFO - PROCESS | 11291 | Cycle 1(1): loaded http://localhost:58029/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:58029/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 17:05:01 INFO - PROCESS | 11291 | RSS: Main: 192233472 17:05:01 INFO - PROCESS | 11291 | 17:05:03 INFO - PROCESS | 11291 | Cycle 1(1): loaded http://localhost:58029/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:58029/tests/kraken/driver.html?testName=ai-astar) 17:05:03 INFO - PROCESS | 11291 | RSS: Main: 242962432 17:05:03 INFO - PROCESS | 11291 | 17:05:03 INFO - PROCESS | 11291 | __start_tp_report 17:05:03 INFO - PROCESS | 11291 | _x_x_mozilla_page_load 17:05:03 INFO - PROCESS | 11291 | _x_x_mozilla_page_load_details 17:05:03 INFO - PROCESS | 11291 | |i|pagename|runs| 17:05:03 INFO - PROCESS | 11291 | |0;ai-astar;104;113;112;113;106;113;113;112;111;111 17:05:03 INFO - PROCESS | 11291 | |1;audio-beat-detection;145;116;125;190;117;123;145;116;159;117 17:05:03 INFO - PROCESS | 11291 | |2;audio-dft;160;159;161;160;160;160;159;161;162;160 17:05:03 INFO - PROCESS | 11291 | |3;audio-fft;75;75;75;136;75;74;75;75;99;76 17:05:03 INFO - PROCESS | 11291 | |4;audio-oscillator;85;86;130;85;85;86;129;86;85;137 17:05:03 INFO - PROCESS | 11291 | |5;imaging-gaussian-blur;118;117;117;117;116;117;117;117;117;117 17:05:03 INFO - PROCESS | 11291 | |6;imaging-darkroom;145;146;145;146;146;146;146;147;146;146 17:05:03 INFO - PROCESS | 11291 | |7;imaging-desaturate;96;95;95;95;95;95;96;95;95;95 17:05:03 INFO - PROCESS | 11291 | |8;json-parse-financial;51;51;52;49;51;52;50;51;51;50 17:05:03 INFO - PROCESS | 11291 | |9;json-stringify-tinderbox;62;62;62;62;63;62;63;63;62;63 17:05:03 INFO - PROCESS | 11291 | |10;stanford-crypto-aes;89;80;79;79;78;78;78;78;79;84 17:05:03 INFO - PROCESS | 11291 | |11;stanford-crypto-ccm;124;125;123;137;124;126;126;123;141;125 17:05:03 INFO - PROCESS | 11291 | |12;stanford-crypto-pbkdf2;165;166;163;163;163;161;161;162;164;164 17:05:03 INFO - PROCESS | 11291 | |13;stanford-crypto-sha256-iterative;64;66;74;68;65;64;67;65;65;63 17:05:03 INFO - PROCESS | 11291 | __end_tp_report 17:05:03 INFO - PROCESS | 11291 | __start_cc_report 17:05:03 INFO - PROCESS | 11291 | _x_x_mozilla_cycle_collect,1636 17:05:03 INFO - PROCESS | 11291 | __end_cc_report 17:05:03 INFO - PROCESS | 11291 | __startTimestamp1474416303885__endTimestamp 17:05:03 INFO - PROCESS | 11291 | 17:05:03 INFO - PROCESS | 11291 | ------- Summary: start ------- 17:05:03 INFO - PROCESS | 11291 | Number of tests: 14 17:05:03 INFO - PROCESS | 11291 | 17:05:03 INFO - PROCESS | 11291 | [#0] ai-astar Cycles:10 Average:110.80 Median:112.50 stddev:3.19 (2.8%) stddev-sans-first:2.24 17:05:03 INFO - PROCESS | 11291 | Values: 104.0 113.0 112.0 113.0 106.0 113.0 113.0 112.0 111.0 111.0 17:05:03 INFO - PROCESS | 11291 | 17:05:03 INFO - PROCESS | 11291 | [#1] audio-beat-detection Cycles:10 Average:135.30 Median:135.00 stddev:24.53 (18.2%) stddev-sans-first:25.76 17:05:03 INFO - PROCESS | 11291 | Values: 145.0 116.0 125.0 190.0 117.0 123.0 145.0 116.0 159.0 117.0 17:05:03 INFO - PROCESS | 11291 | 17:05:03 INFO - PROCESS | 11291 | [#2] audio-dft Cycles:10 Average:160.20 Median:160.00 stddev:0.92 (0.6%) stddev-sans-first:0.97 17:05:03 INFO - PROCESS | 11291 | Values: 160.0 159.0 161.0 160.0 160.0 160.0 159.0 161.0 162.0 160.0 17:05:03 INFO - PROCESS | 11291 | 17:05:03 INFO - PROCESS | 11291 | [#3] audio-fft Cycles:10 Average:83.50 Median:75.00 stddev:19.93 (26.6%) stddev-sans-first:20.91 17:05:03 INFO - PROCESS | 11291 | Values: 75.0 75.0 75.0 136.0 75.0 74.0 75.0 75.0 99.0 76.0 17:05:03 INFO - PROCESS | 11291 | 17:05:03 INFO - PROCESS | 11291 | [#4] audio-oscillator Cycles:10 Average:99.40 Median:85.00 stddev:22.59 (26.6%) stddev-sans-first:23.36 17:05:03 INFO - PROCESS | 11291 | Values: 85.0 86.0 130.0 85.0 85.0 86.0 129.0 86.0 85.0 137.0 17:05:03 INFO - PROCESS | 11291 | 17:05:03 INFO - PROCESS | 11291 | [#5] imaging-gaussian-blur Cycles:10 Average:117.00 Median:117.00 stddev:0.47 (0.4%) stddev-sans-first:0.33 17:05:03 INFO - PROCESS | 11291 | Values: 118.0 117.0 117.0 117.0 116.0 117.0 117.0 117.0 117.0 117.0 17:05:03 INFO - PROCESS | 11291 | 17:05:03 INFO - PROCESS | 11291 | [#6] imaging-darkroom Cycles:10 Average:145.90 Median:146.00 stddev:0.57 (0.4%) stddev-sans-first:0.50 17:05:03 INFO - PROCESS | 11291 | Values: 145.0 146.0 145.0 146.0 146.0 146.0 146.0 147.0 146.0 146.0 17:05:03 INFO - PROCESS | 11291 | 17:05:03 INFO - PROCESS | 11291 | [#7] imaging-desaturate Cycles:10 Average:95.20 Median:95.00 stddev:0.42 (0.4%) stddev-sans-first:0.33 17:05:03 INFO - PROCESS | 11291 | Values: 96.0 95.0 95.0 95.0 95.0 95.0 96.0 95.0 95.0 95.0 17:05:03 INFO - PROCESS | 11291 | 17:05:03 INFO - PROCESS | 11291 | [#8] json-parse-financial Cycles:10 Average:50.80 Median:51.00 stddev:0.92 (1.8%) stddev-sans-first:0.97 17:05:03 INFO - PROCESS | 11291 | Values: 51.0 51.0 52.0 49.0 51.0 52.0 50.0 51.0 51.0 50.0 17:05:03 INFO - PROCESS | 11291 | 17:05:03 INFO - PROCESS | 11291 | [#9] json-stringify-tinderbox Cycles:10 Average:62.40 Median:62.50 stddev:0.52 (0.8%) stddev-sans-first:0.53 17:05:03 INFO - PROCESS | 11291 | Values: 62.0 62.0 62.0 62.0 63.0 62.0 63.0 63.0 62.0 63.0 17:05:03 INFO - PROCESS | 11291 | 17:05:03 INFO - PROCESS | 11291 | [#10] stanford-crypto-aes Cycles:10 Average:80.20 Median:79.00 stddev:3.58 (4.5%) stddev-sans-first:1.92 17:05:03 INFO - PROCESS | 11291 | Values: 89.0 80.0 79.0 79.0 78.0 78.0 78.0 78.0 79.0 84.0 17:05:03 INFO - PROCESS | 11291 | 17:05:03 INFO - PROCESS | 11291 | [#11] stanford-crypto-ccm Cycles:10 Average:127.40 Median:125.50 stddev:6.28 (5.0%) stddev-sans-first:6.53 17:05:03 INFO - PROCESS | 11291 | Values: 124.0 125.0 123.0 137.0 124.0 126.0 126.0 123.0 141.0 125.0 17:05:03 INFO - PROCESS | 11291 | 17:05:03 INFO - PROCESS | 11291 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:163.20 Median:163.50 stddev:1.62 (1.0%) stddev-sans-first:1.58 17:05:03 INFO - PROCESS | 11291 | Values: 165.0 166.0 163.0 163.0 163.0 161.0 161.0 162.0 164.0 164.0 17:05:03 INFO - PROCESS | 11291 | 17:05:03 INFO - PROCESS | 11291 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.10 Median:65.50 stddev:3.14 (4.8%) stddev-sans-first:3.24 17:05:03 INFO - PROCESS | 11291 | Values: 64.0 66.0 74.0 68.0 65.0 64.0 67.0 65.0 65.0 63.0 17:05:03 INFO - PROCESS | 11291 | -------- Summary: end -------- 17:05:03 INFO - PROCESS | 11291 | 17:05:04 INFO - TEST-INFO | 11291: exit 0 17:05:04 INFO - TEST-OK | kraken | took 60367ms 17:05:04 INFO - SUITE-END | took 1175s 17:05:05 INFO - Completed test suite (00:19:35) 17:05:05 INFO - javascript benchmark 17:05:05 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2997.4454725875717, 3004.774641901858, 3016.7435767959723, 3035.6509001464824, 3037.043331350623, 5170.974145129269, 5215.139501982168, 5249.396319423267, 5379.757910894009, 5433.320834895638, 5271.0, 5290.788368465257, 5308.495692909168, 5333.306670132877, 5391.191321301816, 4794.1610218211845, 4798.304245884345, 4886.60907127429, 4899.681520701143, 4961.429435614897, 4874.8537543873745, 4906.386701662293, 4911.214205727067, 4921.876953076166, 4927.876803079916, 4697.412823397075, 4813.735244561548, 4816.133096042711, 4833.63747718919, 4891.559759621633, 4817.662763606549, 4839.225723884197, 4846.709197448165, 4846.7576621169155, 4945.802167913279, 4863.9513604864205, 4878.804847806119, 4900.754962251909, 4901.166801643729, 4930.630202734809, 5071.5689166420525, 5309.4955979182305, 5375.8118465853895, 5439.809606663787, 5467.043267428184, 5780.8843823123725, 5830.271216097988, 5831.416858314177, 5833.183354330397, 5833.679147646878, 5874.676892770896, 5881.85295367615, 5882.2353094097925, 5892.086726557391, 5892.823215303548, 5109.693418394908, 5210.088234558937, 5211.400688920785, 5239.502247286502, 5265.684058956398, 5745.6552606843725, 5754.798582049608, 5756.222909907193, 5757.539396848242, 5758.798442054508, 5471.753771080232, 5511.614187006871, 5516.503514683698, 5517.393086760453, 5533.3083364579425, 5363.302770639792, 5584.46947539983, 5694.402087780806, 5698.715064246771, 5786.681732504752, 5710.114932185435, 5715.057015592464, 5715.857103572361, 5718.714064296769, 5719.170720245541, 5673.659580425187, 5717.371089180187, 5733.369329373765, 5737.340205876294, 5740.68426236561, 4233.111046680232, 4289.442372491619, 4294.162638285567, 4362.411074504965, 4363.934540981888, 3811.5045044144085, 3861.227754449121, 3875.224955008953, 3883.59222281662, 3906.2968665640456, 5314.5216930476445, 5332.493413125747, 5336.4129945705945, 5339.0389729849, 5384.676919384771, 5516.420775818561, 5611.691356975324, 5692.772289108472, 5694.857628559236, 5696.772129114789, 5284.180951952453, 5320.122179840283, 5357.276767636397, 5375.838724838183, 5410.08028635133, 4933.28467372229, 4942.728149951715, 4942.802287908516, 4945.604351651859, 4947.307376967227, 5687.573431992534, 5877.23595932526, 5912.881742365043, 5915.112733089984, 5917.46742793142, 5728.684922329312, 5749.8562535936935, 5750.856228594319, 5767.625104368202, 5769.249997500298, 5854.736536855767, 5908.497777688945, 5909.5863289569315, 5912.113183022409, 5926.4666180044005, 5380.757865896122, 5522.199281104297, 5620.971895140498, 5641.182028605911, 5642.294713160855, 5657.632253903483, 5722.513586345207, 5730.5129064030025, 5754.079347304411, 5762.394948530344, 5545.473180047889, 5589.972050139723, 5600.131979543177, 5603.439656034364, 5604.243427137284, 5386.542143917811, 5464.972675136599, 5582.134769110794, 5582.162675598693, 5592.888142237214, 5456.918146227889, 5522.0, 5561.694106824001, 5588.524975377139, 5590.021746194318, 5567.0, 5574.386817450159, 5576.470235327637, 5610.410906854885, 5614.2701448811395, 5309.495597918191, 5375.0, 5453.481919217668, 5459.590530710292, 5462.071447853795], "value": 5244.0622913236875, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [556.330958152746, 592.703648175912, 600.4445887554011, 606.8998615228487, 608.358182117866, 31900.99999999997, 32330.67669323306, 42230.57769422305, 43224.13551728964, 43550.12899742003, 41742.16515669685, 45160.77419612905, 45233.7738311308, 45287.54712452875, 45336.0, 8895.377323587336, 9040.321975851804, 9052.502112383816, 9055.04921983192, 9062.320325975577, 8984.640614375417, 9069.455832650063, 9075.13786190311, 9082.0, 9082.909170908306, 9027.774305642346, 9035.909640903605, 9145.314101442385, 9145.771355716128, 9147.0, 8995.100489950952, 9016.504092274923, 9018.36871419001, 9075.818483630323, 9138.040505746934, 8905.332100092453, 8940.68707595231, 8978.50618215998, 8979.326550508738, 9009.144131307516, 42094.158116837796, 42172.0, 42314.576854231374, 42563.14873702508, 42576.0, 3499.7840558773973, 3619.6561326673923, 3650.945235821465, 3665.321915445651, 4219.6202341789385, 32373.190670233198, 32855.0, 32906.17734556631, 32952.3409531808, 32990.83504582486, 4195.958040419588, 4278.144371125756, 4373.365861949999, 4431.357453169305, 4450.777461126963, 347736.0, 347830.0, 350346.4965350339, 350438.0, 350660.2466987674, 54117.45882541124, 54583.454165457835, 54596.45403545993, 54607.18089228665, 54682.726586366814, 46539.30191047137, 46773.95969261987, 46841.531584684395, 46915.530844691115, 46971.76514117407, 15086.849131508763, 15294.923525382303, 15305.38778448872, 15324.310406031755, 15328.310226039855, 10623.628173013907, 10625.256232063835, 10629.574817007388, 10632.893671063344, 10661.307015043998, 14192.85807141936, 16120.355185792438, 16150.75773863393, 16165.67668646644, 16230.837691623168, 6048.455638992512, 6074.54440916933, 6113.510919126459, 6119.143319935212, 6146.801373732169, 754.7735679296189, 927.6104036304769, 1066.8453074304182, 1114.322943969337, 1120.9831852522218, 31739.0, 32342.548118974366, 32398.514022289684, 32513.34973300521, 32781.09561318262, 1066.4134725900878, 1066.4720963123305, 1068.9091427228773, 1136.170595465315, 1199.9400029998465, 16380.83619163817, 16792.328306867832, 17260.913695431693, 17290.827091729174, 17301.56746081358, 492415.0, 495056.0, 495119.0, 496083.0, 496528.0, 57864.71067644719, 57944.0, 57953.13070303949, 57959.0, 58036.0, 1187.3706935324292, 1338.6051114921122, 1358.2665360705307, 1359.2184493916038, 1378.9241591712353, 31413.0, 32296.515552266264, 32857.83571082225, 33131.50302745413, 33695.0, 40980.79509602433, 41253.38119928144, 41308.1738365225, 41333.173336533706, 41362.0, 402028.0, 402194.0, 404074.0, 404110.0, 406176.0, 27414.45171096527, 28356.291092722848, 28471.572926406534, 29570.852145739133, 29658.258543536584, 47052.7647361761, 47277.52722472731, 48023.279650804565, 48055.75972120257, 48888.0, 39833.0, 39938.60061399349, 40228.79313620596, 40929.0, 42268.0, 40045.0, 40267.1946561073, 40484.79757601193, 40933.79533102315, 41607.167856643304, 40949.38575921423, 41438.0, 41671.58328416677, 42304.78847605742, 42478.0, 34370.65629343774, 36880.81559592185, 37293.627063729014, 37574.57056348935, 38101.61898380981, 27528.311792204553, 27551.724482754915, 27659.446811063262, 27757.0, 27764.722352777022], "value": 19413.84493825896, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [343.7215855157321, 346.59621540904834, 351.9507268982342, 363.78718449706923, 368.5264435200768, 18857.245710171595, 19922.800771992275, 20046.899765501188, 21199.99999999996, 21240.0, 18382.632347353046, 19779.703304450446, 19784.802151978474, 19873.304434344802, 20078.498037549067, 5526.917096243559, 5765.336986246593, 5769.509591684712, 5770.451807078321, 5771.711414429283, 5430.239766432683, 5704.714764261791, 5726.3987281335485, 5726.942730572682, 5733.397993210715, 5690.800821971232, 5693.373728889839, 5697.287839020122, 5698.515626171759, 5702.743376548045, 5477.424870388611, 5575.526080283181, 5628.409017053192, 5634.183043458716, 5637.887242255173, 4927.753612319406, 4986.0, 4991.5258050485145, 4994.675346102528, 4996.300517927493, 23756.643650345257, 24062.87968560146, 24194.427362221577, 24285.271441856774, 24472.755272447226, 2331.8600883946847, 2337.111897478947, 2404.603240465321, 2617.254082586454, 2764.654418197725, 14593.562193134223, 14739.778903316459, 14745.410183592643, 15222.314995825214, 15357.0, 1902.5719213176924, 1909.1981367825547, 1942.2328180368675, 1953.6971769375768, 2030.137191693539, 65003.67498162526, 75438.62280688617, 77154.6142269285, 77767.0, 77953.27163549249, 10495.26533142688, 10755.569777208824, 10891.237613366988, 11083.390413527171, 11352.772944541062, 15220.771688424682, 15577.376904923904, 15577.766333505006, 15598.454054108279, 15619.14094724801, 7242.529235599774, 7542.962285188539, 7612.0, 7939.2060793920145, 7976.641051152712, 6817.147856517935, 6967.756128535579, 6975.197852246955, 7016.403605693471, 7109.608971506616, 4545.204589196877, 4714.316424118552, 4725.763711814396, 4731.929021064618, 4843.6367272454, 1758.4636685810694, 1763.089794921164, 1823.917923693437, 1830.3410772122024, 1837.127364501851, 951.9190868776093, 953.7424895278236, 1005.3214080495783, 1006.9628282868657, 1020.8877023527406, 19000.429987100408, 20267.493312667302, 20724.792752072288, 20738.0, 21051.473713157295, 989.4113002763344, 1002.0230275481348, 1032.83990981398, 1052.321252791945, 1079.7300674831292, 10450.041165326003, 10850.29473084247, 10860.447001018672, 12214.26714397139, 12223.816642750366, 447202.0, 454618.0, 455641.0, 475582.0, 502640.0, 68375.31624683789, 74407.62796185985, 91727.54136229276, 96558.0, 97018.51490742501, 1016.9949150254201, 1082.3397727386289, 1122.5397586989295, 1122.618309774664, 1123.8370436286693, 18114.18486168099, 18142.727859082388, 18905.243790248787, 18965.0, 19154.425367239004, 44675.77662111669, 44992.32511512395, 45678.54321456743, 46333.0, 46596.47649329029, 60257.179425644965, 60788.0, 61203.38796611977, 63007.0, 63225.0, 8595.398322117391, 8613.440126391764, 8638.481691098554, 8713.25937295337, 8813.559322034002, 11469.655910322703, 13761.0, 13918.355512453007, 14025.29873506341, 14046.227457489527, 11789.587364442203, 11840.28958262507, 12130.909669147946, 12147.939260303641, 12486.12597118193, 12034.931092571689, 12057.095717821023, 12059.0, 12297.32364719949, 12588.370581471074, 11729.0, 11914.702132446759, 12234.327112008568, 12375.0, 12504.624861254177, 7427.368673662799, 7890.48711833729, 7922.049354077317, 8503.362247831561, 8636.17956294151, 5617.831465056055, 8634.877465929389, 9051.773705657411, 9908.702738917844, 11135.387553684624], "value": 9244.174703041095, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1467.8605532474419, 1519.012641782841, 1611.8549330560247, 1714.9485515434542, 1754.7543343931852, 8569.400141990056, 9216.354855160142, 9229.723108306762, 9243.0, 9249.907500924988, 7662.118856331524, 8514.787130321745, 8721.215090641841, 8751.124887511261, 8922.42004269722, 2326.5114325991563, 2337.742848286687, 2338.286822519131, 2356.2813341930705, 2358.41039740065, 2300.493891343902, 2312.722473303206, 2375.6674065630827, 2377.6314671225987, 2381.368937231635, 2322.9419264518438, 2329.767023297665, 2332.300309907021, 2373.4303767095944, 2381.071382160959, 2308.665243539694, 2344.015513484332, 2351.8236132290062, 2355.764423557639, 2358.740538540759, 2318.9072437102495, 2332.3702600297825, 2334.2997100869843, 2347.94130146746, 2358.4929240213264, 8713.520756358397, 8801.603927823264, 8828.955855220747, 8836.469811811248, 9117.908820911773, 5039.395272567279, 5086.821961231339, 5186.196139598368, 5190.506901844319, 5225.686458812445, 3351.748618853596, 3437.9828100859586, 3542.2738338640515, 3544.61009288978, 3554.893353199408, 1031.3605564549953, 1076.2304951959386, 1088.504730347698, 1092.0771947704177, 1096.901278884896, 12466.065045121652, 12533.874661253452, 12552.748945021049, 12598.68503287416, 12617.684557886127, 4355.390245365651, 4439.578240067189, 4528.320751887243, 4668.299755036772, 4670.95329046712, 10504.737381565523, 10520.0, 10541.209409294333, 10553.208509361675, 10579.153667706565, 5148.2277658350795, 5187.118189907725, 5189.870253243624, 5192.584593232532, 5200.427952925175, 4153.626173644387, 4600.608948239437, 4676.205045142334, 4741.2176990796825, 4750.263709125091, 3673.2653469306247, 3704.2221133561716, 3806.7715937043313, 3819.904502387407, 3824.1778017726324, 1193.8985186259092, 1199.9160058795976, 1207.4928530017414, 1213.3084142038954, 1215.3862299538675, 869.1612593846968, 952.2191802721702, 968.3173362779364, 994.22450488619, 1008.5713571732131, 6035.577509574376, 6167.475764560063, 6189.938100619026, 6190.473809726223, 6403.455706264926, 439.8944253379166, 446.7319608235033, 448.53800585397096, 456.50013235507066, 463.6777439679458, 4115.753054816661, 4121.814518346681, 4132.772697501667, 4141.79291035447, 4143.254214241466, 10953.616623418302, 11386.373749443694, 11405.14461415397, 11406.543738250377, 11467.197296189186, 11264.098872090377, 11296.774064518664, 11299.604513841976, 11314.981651651391, 11321.0, 7919.604019798987, 8303.086660467343, 8313.12712165226, 8492.830143397097, 8507.106753790888, 5368.1679339702405, 5543.972280138573, 5603.691796951207, 5645.322561292671, 5661.688607126647, 9543.856842147512, 9685.467299298607, 9773.0, 9877.0, 9903.752406189902, 10119.7470063249, 10146.847797282899, 10276.383416995004, 10282.588696452058, 10354.689359319233, 6904.13698287714, 7671.232876712284, 7829.491083079582, 7960.402969777174, 8081.434299598972, 9041.276697864287, 9113.134252246025, 9128.087191280818, 9132.406393584395, 9136.543172841199, 7688.269614386624, 7715.112762032214, 7855.764327070197, 7877.015373078365, 8006.879896801669, 7792.61036948139, 7920.366370690446, 7936.880946785918, 7938.6030698466, 7951.125376208728, 7149.785506434815, 7238.927610723826, 7244.384227340524, 7247.383972362408, 7247.456440767069, 5122.334096567422, 5197.974010129925, 5245.580353571629, 5330.413654498079, 5516.531094856982, 5389.191621256843, 5516.0, 5660.179274005164, 5663.150527420919, 5738.741756620879], "value": 4575.464108593227, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [293.8339837991535, 307.7307356063444, 307.8276165347404, 309.8187560277237, 313.0748637775374, 5020.7489625518765, 5089.541941225289, 5188.740562971855, 5217.321748172737, 5221.634485586011, 5047.899042019158, 5077.79688812448, 5103.617228707843, 5125.179971204608, 5129.25625784262, 4041.555428902818, 4049.3521036634143, 4054.331035379159, 4064.451299074624, 4091.672666186713, 3808.16220431506, 3832.8083595820235, 4060.593940605945, 4062.0860306430964, 4087.1417002429525, 3962.117993952864, 3969.1466334738025, 3981.6263389130704, 3991.2017596480673, 3995.0, 4005.998500374906, 4006.479157709494, 4008.378701301303, 4011.3581826907703, 4014.739041962263, 3557.5375201223933, 3558.466230065485, 3565.5186549815962, 3571.5714114306447, 3576.445650924111, 4959.677620954626, 4963.503649635044, 4970.726610036447, 4985.476524964863, 4985.551300382983, 4546.454425468932, 4565.269556870918, 4570.405847239871, 4572.817087316504, 4576.839810606612, 5061.595072394236, 5340.279062326575, 5347.385050719139, 5368.382635996872, 5382.273393091921, 3906.7851268180525, 3910.237503686782, 3922.7450215735885, 3927.8036098194975, 3943.98028009861, 5554.222408862763, 5574.86062848428, 5589.854079913649, 5597.188407680904, 5620.803271885465, 4015.0966032642423, 4021.9597804021587, 4030.3752918297123, 4031.1053804711737, 4032.697547683935, 3824.2160357126722, 4037.9394309085387, 4055.6755459563165, 4062.532808726975, 4071.6131967463043, 4575.519570445122, 4595.287730401727, 4611.746353950565, 4617.1227466781875, 4620.653450991189, 5328.413874473805, 5344.263114487807, 5359.115745901882, 5366.443731317952, 5418.2685337479725, 1328.7873940169527, 1378.8827949624194, 1397.3292819446722, 1401.6215621782062, 1407.1205496564646, 883.4589230821938, 888.1606881497053, 901.6032945503957, 902.7156445719577, 906.1753804038293, 4547.772101532568, 4549.226631472658, 4567.38340324052, 4573.582189521193, 4585.541445855454, 4855.514448555116, 4863.927041094386, 4902.362692849907, 4906.90186196274, 4914.533119353656, 4562.224421848294, 4566.20091483989, 4583.656225783013, 4586.610138138229, 4619.769011549409, 2730.481208570365, 2941.1470673504873, 2941.4558306713325, 2942.2791416102764, 2947.204254851178, 5670.036093864053, 5675.3757086720425, 5675.460831221028, 5690.065377771578, 5791.362950075489, 5545.861353466195, 5608.906263278622, 5619.7471113799975, 5702.201691763156, 5739.7704091836695, 5719.799807006735, 5720.42795720433, 5723.599348045597, 5730.914036289459, 5737.168110623936, 5542.196381524737, 5569.081101618188, 5584.240964096297, 5585.469380408855, 5601.915971260353, 5262.947370526245, 5465.69938653362, 5471.50756431923, 5481.232627432083, 5495.258140151029, 5656.604037717485, 5710.829884643808, 5730.309558680283, 5733.713314334183, 5757.165211044291, 3675.577308609544, 3827.9808600956817, 3829.3194763664987, 3853.362321013502, 3877.651011408987, 5442.537384322377, 5451.809186678447, 5456.59075569326, 5480.177973304037, 5506.531944784738, 5330.600204984564, 5405.648632838853, 5465.72671366438, 5466.535344495763, 5468.93355795616, 5275.683458992473, 5372.328458942632, 5382.946170538401, 5408.621396502207, 5435.918461223164, 5336.706481143575, 5350.411454740053, 5352.197170424468, 5359.222912677717, 5362.463753624606, 5386.622936394571, 5386.649867758583, 5395.325584301962, 5398.514133727984, 5405.648632838853, 5070.0, 5293.570735901362, 5311.203319502106, 5316.787328506816, 5329.147336426153], "value": 4065.0997153105045, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [685.6400389795357, 706.0327351528405, 751.6692655231701, 808.4502538273975, 848.1179573243827, 14289.785653215211, 14845.851541484595, 14899.627509312273, 14954.177520236382, 14988.5503434897, 15139.31873065712, 15324.923375383136, 15342.923285383586, 15384.923075384608, 15387.846121538782, 653.993460065398, 765.1086484245875, 773.5668025905483, 793.611130546034, 798.6366203377478, 792.7661339904713, 795.0538858758089, 798.3333916179968, 800.6237068577759, 802.3581135091932, 858.3776761847673, 860.1484530314974, 860.7589874835024, 861.2033868671485, 861.7888617288774, 683.3849535418113, 812.6505602590884, 849.6389034660244, 849.6601359456267, 849.8300339932039, 623.9095331176954, 624.0389799708444, 624.2446639566131, 624.6408315218767, 624.7438550194444, 15402.0, 15413.3834646614, 15444.613884652861, 15485.535433937, 15509.146996915166, 14195.361208745631, 14433.350499227456, 14451.710965780625, 14902.776458353024, 15171.848281517154, 13567.932160339134, 13599.32003399836, 13634.86365136346, 13794.0, 13855.792163117561, 4475.10497900418, 4597.586217240464, 4600.401947746805, 4695.812167513295, 4723.669343145981, 88409.41244694618, 89495.0, 90126.5493672534, 90610.0, 90783.54608226917, 11890.702732431586, 11905.642830715093, 12054.0, 12161.939190303992, 12167.452464639113, 22673.0, 22714.318570442912, 22799.31602051941, 22886.0, 22891.313260602208, 7850.175731548219, 7880.0, 7884.0, 8225.177482251847, 8598.226159645661, 4711.811527538928, 4728.88177795551, 4773.09311230865, 4822.927656085161, 4844.515548445127, 3251.463508521115, 3350.5476760637002, 3361.159710072482, 3361.562996810399, 3385.9153521161675, 565.1720229863188, 566.0744682444151, 582.1849410824794, 587.6209844650263, 589.584343038157, 617.3301967365369, 624.2727222785495, 637.8947473666885, 645.2257291250518, 663.0617675988423, 9421.0, 9648.372855764354, 9766.0, 9835.459049752333, 9894.751557756807, 649.4155260265704, 660.3825423229296, 682.1405029662661, 691.6921969723526, 703.4723957032226, 4377.693561450668, 4747.216709243005, 4805.951940480551, 4815.470298267188, 4872.589187568716, 105572.47213763882, 129454.0, 130153.0, 133163.0, 135034.32482837522, 112269.0, 113757.0, 114392.42803786094, 115318.0, 118559.40720296516, 96020.51989740007, 96731.51634241924, 100404.0, 100446.4977675107, 100907.0, 8701.582513204385, 8763.912360876564, 8836.734897953073, 8892.066333035196, 9249.583768730288, 56345.0, 57360.0, 57476.0, 58544.0, 59911.700441497516, 74721.25278747143, 75942.6202868982, 83905.17006465774, 84396.0, 86243.0, 11672.057097290202, 11758.998450548703, 11835.775148046328, 11884.405779711153, 11921.046316294849, 12947.028102462074, 12980.0, 12989.545365912149, 13527.594172174457, 13554.322283885964, 11946.134663341645, 11958.64124076279, 12222.388880555758, 12320.445579949102, 12417.130800843854, 12212.145149839425, 12311.0, 12436.96812989762, 12555.686107847012, 13086.541971030969, 11530.192886497865, 11711.648650540497, 12101.394930253628, 12393.256404615751, 12420.875791242333, 9669.806603868024, 9993.550290237103, 10032.64885728996, 10344.069033786995, 10354.482275886327, 9170.816583668156, 9303.0, 9306.72079837606, 9418.481983490974, 9444.763880902758], "value": 7539.716975358071, "unit": "score"}], "name": "dromaeo_css", "value": 7135.524113252463, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [104.0, 113.0, 112.0, 113.0, 106.0, 113.0, 113.0, 112.0, 111.0, 111.0], "value": 110.8, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [145.0, 116.0, 125.0, 190.0, 117.0, 123.0, 145.0, 116.0, 159.0, 117.0], "value": 135.3, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 159.0, 161.0, 160.0, 160.0, 160.0, 159.0, 161.0, 162.0, 160.0], "value": 160.2, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 75.0, 75.0, 136.0, 75.0, 74.0, 75.0, 75.0, 99.0, 76.0], "value": 83.5, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 86.0, 130.0, 85.0, 85.0, 86.0, 129.0, 86.0, 85.0, 137.0], "value": 99.4, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 117.0, 117.0, 117.0, 116.0, 117.0, 117.0, 117.0, 117.0, 117.0], "value": 117.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [145.0, 146.0, 145.0, 146.0, 146.0, 146.0, 146.0, 147.0, 146.0, 146.0], "value": 145.9, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 95.0, 95.0, 95.0, 95.0, 95.0, 96.0, 95.0, 95.0, 95.0], "value": 95.2, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [51.0, 51.0, 52.0, 49.0, 51.0, 52.0, 50.0, 51.0, 51.0, 50.0], "value": 50.8, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 62.0, 62.0, 62.0, 63.0, 62.0, 63.0, 63.0, 62.0, 63.0], "value": 62.4, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [89.0, 80.0, 79.0, 79.0, 78.0, 78.0, 78.0, 78.0, 79.0, 84.0], "value": 80.2, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [124.0, 125.0, 123.0, 137.0, 124.0, 126.0, 126.0, 123.0, 141.0, 125.0], "value": 127.4, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [165.0, 166.0, 163.0, 163.0, 163.0, 161.0, 161.0, 162.0, 164.0, 164.0], "value": 163.2, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 66.0, 74.0, 68.0, 65.0, 64.0, 67.0, 65.0, 65.0, 63.0], "value": 66.1, "unit": "score"}], "name": "kraken", "value": 1497.4, "alertThreshold": 2.0}]} 17:05:05 INFO - Return code: 0 17:05:05 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 17:05:05 INFO - # TBPL SUCCESS # 17:05:05 INFO - Running post-action listener: _resource_record_post_action 17:05:05 INFO - [mozharness: 2016-09-21 00:05:05.200407Z] Finished run-tests step (success) 17:05:05 INFO - Running post-run listener: _resource_record_post_run 17:05:05 INFO - Total resource usage - Wall time: 1193s; CPU: 13.0%; Read bytes: 4096; Write bytes: 411725824; Read time: 12; Write time: 270936 17:05:05 INFO - TinderboxPrint: CPU usage
13.0% 17:05:05 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 12 17:05:05 INFO - TinderboxPrint: I/O write bytes / time
411,725,824 / 270,936 17:05:05 INFO - TinderboxPrint: CPU idle
8,280.8 (87.0%) 17:05:05 INFO - TinderboxPrint: CPU user
1,197.7 (12.6%) 17:05:05 INFO - TinderboxPrint: Swap in / out
0 / 0 17:05:05 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 118231040; Read time: 0; Write time: 90048 17:05:05 INFO - run-tests - Wall time: 1176s; CPU: 13.0%; Read bytes: 0; Write bytes: 293023744; Read time: 0; Write time: 180880 17:05:05 INFO - Running post-run listener: _upload_blobber_files 17:05:05 INFO - Blob upload gear active. 17:05:05 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 17:05:05 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 17:05:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Autoland', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 17:05:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Autoland -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 17:05:06 INFO - (blobuploader) - INFO - Open directory for files ... 17:05:06 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 17:05:06 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:05:06 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:05:10 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 17:05:10 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:05:10 INFO - (blobuploader) - INFO - Done attempting. 17:05:10 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 17:05:10 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:05:10 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:05:11 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 17:05:11 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:05:11 INFO - (blobuploader) - INFO - Done attempting. 17:05:11 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 17:05:11 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:05:11 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:05:12 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 17:05:12 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:05:12 INFO - (blobuploader) - INFO - Done attempting. 17:05:12 INFO - (blobuploader) - INFO - Iteration through files over. 17:05:12 INFO - Return code: 0 17:05:12 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 17:05:12 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 17:05:12 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/fc0d38e5ed188569dd6b5e0520289e7fc017700360f341c15375d173f6b948dafd6af200a2ff1cad0174a8582adb8f53f88718d606f01f83605b88f64a8a9220", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/5f7a38a29ea011050ed57926d0afb74e41bfb193cfbd81b5e6f009a1b619c041476a9115414cf72255a660ad3712dd30fa03b37232a2ce29e21b285e2ae08497", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/61c0abb26ac72933cdaf8f641e2c6942c8f19c0dd772dd7534c355b636168db34da2e3f9cabfc0fd2c684c6b9216352e53f88d0acdce8d71e477e026022bc216"} 17:05:12 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 17:05:12 INFO - Writing to file /builds/slave/test/properties/blobber_files 17:05:12 INFO - Contents: 17:05:12 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/fc0d38e5ed188569dd6b5e0520289e7fc017700360f341c15375d173f6b948dafd6af200a2ff1cad0174a8582adb8f53f88718d606f01f83605b88f64a8a9220", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/5f7a38a29ea011050ed57926d0afb74e41bfb193cfbd81b5e6f009a1b619c041476a9115414cf72255a660ad3712dd30fa03b37232a2ce29e21b285e2ae08497", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/61c0abb26ac72933cdaf8f641e2c6942c8f19c0dd772dd7534c355b636168db34da2e3f9cabfc0fd2c684c6b9216352e53f88d0acdce8d71e477e026022bc216"} 17:05:12 INFO - Running post-run listener: copy_logs_to_upload_dir 17:05:12 INFO - Copying logs to upload dir... 17:05:12 INFO - mkdir: /builds/slave/test/build/upload/logs 17:05:12 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1234.586212 ========= master_lag: -0.00 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 34 secs) (at 2016-09-20 17:05:12.395420) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-20 17:05:12.399120) ========= 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=e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/fc0d38e5ed188569dd6b5e0520289e7fc017700360f341c15375d173f6b948dafd6af200a2ff1cad0174a8582adb8f53f88718d606f01f83605b88f64a8a9220", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/5f7a38a29ea011050ed57926d0afb74e41bfb193cfbd81b5e6f009a1b619c041476a9115414cf72255a660ad3712dd30fa03b37232a2ce29e21b285e2ae08497", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/61c0abb26ac72933cdaf8f641e2c6942c8f19c0dd772dd7534c355b636168db34da2e3f9cabfc0fd2c684c6b9216352e53f88d0acdce8d71e477e026022bc216"} build_url:https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1474406203/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011332 build_url: 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1474406203/firefox-51.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/fc0d38e5ed188569dd6b5e0520289e7fc017700360f341c15375d173f6b948dafd6af200a2ff1cad0174a8582adb8f53f88718d606f01f83605b88f64a8a9220", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/5f7a38a29ea011050ed57926d0afb74e41bfb193cfbd81b5e6f009a1b619c041476a9115414cf72255a660ad3712dd30fa03b37232a2ce29e21b285e2ae08497", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/61c0abb26ac72933cdaf8f641e2c6942c8f19c0dd772dd7534c355b636168db34da2e3f9cabfc0fd2c684c6b9216352e53f88d0acdce8d71e477e026022bc216"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-20 17:05:12.425004) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 17:05:12.425345) ========= 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=e0e61f6f900f4dc42e3e8956000001ad-1474415075.621084-1921109775 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004525 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 17:05:12.510247) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-20 17:05:12.510981) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-20 17:05:12.511614) ========= ========= Total master_lag: 0.16 =========